[58.097106] Initializing watchdogs
[58.097155]   /dev/watchdog0
[58.111483] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[58.116173] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.118548] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.122219] [001/131] (960s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[58.247641] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[58.251792] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[58.343318] [002/131] (960s left) kms_psr (fbc-pr-dpms)
[58.437941] Starting subtest: fbc-pr-dpms
[58.442518] Subtest fbc-pr-dpms: SKIP (0.000s)
[58.508922] [003/131] (960s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180)
[58.604465] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180
[58.608617] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s)
[58.687699] [004/131] (960s left) gem_exec_reloc (basic-wc-cpu-active)
[58.751024] Subtest basic-wc-cpu-active: SKIP (0.000s)
[58.813754] [005/131] (959s left) gem_exec_balancer (waits)
[58.875713] Starting subtest: waits
[65.403864] Subtest waits: SUCCESS (6.526s)
[65.679879] [006/131] (953s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs)
[65.792022] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs
[65.794384] Starting dynamic subtest: pipe-A-eDP-1
[65.817131] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[65.826662] Starting dynamic subtest: pipe-B-eDP-1
[65.848240] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[65.855426] Starting dynamic subtest: pipe-C-eDP-1
[65.876595] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[65.884054] Starting dynamic subtest: pipe-D-eDP-1
[65.905869] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[65.909775] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[68.064241] [007/131] (950s left) kms_chamelium_color (gamma)
[68.193511] Subtest gamma: SKIP (0.000s)
[68.237713] [008/131] (950s left) sw_sync (sync_multi_timeline_wait)
[68.274060] Starting subtest: sync_multi_timeline_wait
[68.276213] Subtest sync_multi_timeline_wait: SUCCESS (0.001s)
[68.326538] [009/131] (950s left) gem_mmap_offset (close-race)
[68.387426] Starting subtest: close-race
[88.500332] Subtest close-race: SUCCESS (20.112s)
[88.639541] [010/131] (930s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-blt)
[88.752509] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-blt
[88.757128] Subtest fbc-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[88.843984] [011/131] (930s left) gem_ctx_bad_destroy (double-destroy)
[88.892695] Starting subtest: double-destroy
[88.895039] Subtest double-destroy: SUCCESS (0.000s)
[88.950332] [012/131] (930s left) i915_hangman (engine-engine-hang)
[89.014779] Starting subtest: engine-engine-hang
[89.017305] Starting dynamic subtest: rcs0
[90.867836] Dynamic subtest rcs0: SUCCESS (1.852s)
[90.879912] Starting dynamic subtest: bcs0
[92.851721] Dynamic subtest bcs0: SUCCESS (1.983s)
[92.861940] Starting dynamic subtest: vcs0
[94.834861] Dynamic subtest vcs0: SUCCESS (1.982s)
[94.845952] Starting dynamic subtest: vcs1
[96.883345] Dynamic subtest vcs1: SUCCESS (2.047s)
[96.894116] Starting dynamic subtest: vecs0
[98.867488] Dynamic subtest vecs0: SUCCESS (1.983s)
[98.879827] Starting dynamic subtest: ccs0
[100.851681] Dynamic subtest ccs0: SUCCESS (1.983s)
[100.854899] Subtest engine-engine-hang: SUCCESS (11.837s)
[100.941155] [013/131] (918s left) gem_exec_params (invalid-ring)
[101.001639] Starting subtest: invalid-ring
[101.003804] Subtest invalid-ring: SUCCESS (0.000s)
[101.106493] [014/131] (918s left) kms_cursor_edge_walk (128x128-top-bottom)
[101.208315] Starting subtest: 128x128-top-bottom
[101.210644] Starting dynamic subtest: pipe-A-eDP-1
[104.644577] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.435s)
[104.653526] Starting dynamic subtest: pipe-D-eDP-1
[107.781106] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.133s)
[107.783417] Subtest 128x128-top-bottom: SUCCESS (6.570s)
[108.591444] [015/131] (910s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-msflip-blt)
[108.689780] Starting subtest: psr-1p-primscrn-indfb-msflip-blt
[116.078936] Subtest psr-1p-primscrn-indfb-msflip-blt: SUCCESS (7.392s)
[116.203634] [016/131] (902s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-cpu)
[116.293342] Starting subtest: psr-rgb101010-draw-mmap-cpu
[123.422730] Subtest psr-rgb101010-draw-mmap-cpu: SUCCESS (7.132s)
[123.539963] [017/131] (895s left) prime_mmap (test_refcounting)
[123.590639] Starting subtest: test_refcounting
[123.592480] Starting dynamic subtest: test_refcounting-smem
[123.622424] Dynamic subtest test_refcounting-smem: SUCCESS (0.033s)
[123.624845] Subtest test_refcounting: SUCCESS (0.034s)
[123.723884] [018/131] (895s left) syncobj_timeline (wait-delayed-signal)
[123.791583] Starting subtest: wait-delayed-signal
[123.897379] Subtest wait-delayed-signal: SUCCESS (0.103s)
[123.984226] [019/131] (895s left) kms_psr (pr-cursor-mmap-gtt)
[124.073041] Starting subtest: pr-cursor-mmap-gtt
[124.077577] Subtest pr-cursor-mmap-gtt: SKIP (0.000s)
[124.144871] [020/131] (895s left) gem_ctx_param (invalid-ctx-set)
[124.190560] Starting subtest: invalid-ctx-set
[124.192808] Subtest invalid-ctx-set: SUCCESS (0.001s)
[124.286743] [021/131] (895s left) gem_partial_pwrite_pread (write-display)
[124.339075] Subtest write-display: SKIP (0.000s)
[124.418657] [022/131] (895s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc)
[124.517426] Starting subtest: fbcpsr-rgb565-draw-mmap-wc
[131.386780] Subtest fbcpsr-rgb565-draw-mmap-wc: SUCCESS (6.874s)
[131.496504] [023/131] (887s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[131.589570] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[131.593943] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[131.655881] [024/131] (887s left) prime_self_import (basic-with_fd_dup)
[131.697913] Starting subtest: basic-with_fd_dup
[131.713689] Subtest basic-with_fd_dup: SUCCESS (0.018s)
[131.803549] [025/131] (887s left) gem_fence_thrash (bo-write-verify-x)
[131.839780] Starting subtest: bo-write-verify-x
[131.852767] Subtest bo-write-verify-x: SKIP (0.013s)
[131.913096] [026/131] (887s left) kms_invalid_mode (zero-clock)
[132.003074] Starting subtest: zero-clock
[132.005265] Starting dynamic subtest: pipe-A-eDP-1
[132.291013] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.288s)
[132.299719] Starting dynamic subtest: pipe-B-eDP-1
[132.301682] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[132.308684] Starting dynamic subtest: pipe-C-eDP-1
[132.310598] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[132.318062] Starting dynamic subtest: pipe-D-eDP-1
[132.320270] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[132.322623] Subtest zero-clock: SUCCESS (0.293s)
[133.117961] [027/131] (886s left) kms_flip (nonexisting-fb-interruptible)
[133.210880] Starting subtest: nonexisting-fb-interruptible
[133.213350] Starting dynamic subtest: A-eDP1
[134.412337] Dynamic subtest A-eDP1: SUCCESS (1.200s)
[134.424720] Starting dynamic subtest: B-eDP1
[135.549072] Dynamic subtest B-eDP1: SUCCESS (1.135s)
[135.557067] Starting dynamic subtest: C-eDP1
[136.684247] Dynamic subtest C-eDP1: SUCCESS (1.134s)
[136.695548] Starting dynamic subtest: D-eDP1
[137.817208] Dynamic subtest D-eDP1: SUCCESS (1.132s)
[137.819531] Subtest nonexisting-fb-interruptible: SUCCESS (4.609s)
[138.988425] [028/131] (880s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling)
[139.083716] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-downscaling
[139.086027] Starting dynamic subtest: pipe-A-default-mode
[140.243949] Dynamic subtest pipe-A-default-mode: SKIP (1.158s)
[140.248287] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (1.159s)
[140.387223] [029/131] (879s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[140.495235] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[140.499551] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[140.594201] [030/131] (879s left) perf (oa-exponents)
[140.724177] Starting subtest: oa-exponents
[140.726382] Starting dynamic subtest: 0-rcs0
[142.492088] Dynamic subtest 0-rcs0: SUCCESS (1.768s)
[142.500586] Starting dynamic subtest: 1-vcs0
[144.319108] Dynamic subtest 1-vcs0: SUCCESS (1.826s)
[144.321526] Subtest oa-exponents: SUCCESS (3.595s)
[144.363876] [031/131] (875s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-msflip-blt)
[144.455632] Starting subtest: psr-2p-scndscrn-indfb-msflip-blt
[144.459951] Subtest psr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[144.549201] [032/131] (875s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-move)
[144.636277] Starting subtest: fbc-2p-primscrn-spr-indfb-move
[144.640455] Subtest fbc-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[144.739523] [033/131] (875s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-pwrite)
[144.844504] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-pwrite
[144.848841] Subtest fbc-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[144.949020] [034/131] (874s left) kms_psr (psr-sprite-blt)
[145.032982] Starting subtest: psr-sprite-blt
[145.035248] Starting dynamic subtest: eDP-1
[146.751457] Dynamic subtest eDP-1: SUCCESS (1.716s)
[146.753318] Subtest psr-sprite-blt: SUCCESS (1.717s)
[147.584547] [035/131] (872s left) kms_psr (fbc-psr-primary-blt)
[147.676662] Starting subtest: fbc-psr-primary-blt
[147.678927] Starting dynamic subtest: eDP-1
[147.683107] Dynamic subtest eDP-1: SKIP (0.000s)
[147.687247] Subtest fbc-psr-primary-blt: SKIP (0.001s)
[147.750635] [036/131] (872s left) gem_exec_reloc (basic-wc-cpu)
[147.818889] Subtest basic-wc-cpu: SKIP (0.000s)
[147.893712] [037/131] (872s left) kms_atomic (crtc-invalid-params)
[147.985912] Starting subtest: crtc-invalid-params
[147.988231] Starting dynamic subtest: pipe-A-eDP-1
[148.340848] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.354s)
[148.343145] Subtest crtc-invalid-params: SUCCESS (0.355s)
[149.231967] [038/131] (870s left) kms_vblank (ts-continuation-suspend)
[149.330846] Starting subtest: ts-continuation-suspend
[149.332774] Starting dynamic subtest: pipe-A-eDP-1
[165.652914] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.608s)
[165.667616] Starting dynamic subtest: pipe-D-eDP-1
[182.668845] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.216s)
[182.671186] Subtest ts-continuation-suspend: SUCCESS (3.827s)
[183.471459] [039/131] (836s left) syncobj_timeline (invalid-single-wait-all-unsubmitted)
[183.543479] Starting subtest: invalid-single-wait-all-unsubmitted
[183.545687] Subtest invalid-single-wait-all-unsubmitted: SUCCESS (0.000s)
[183.654629] [040/131] (836s left) kms_addfb_basic (legacy-format)
[183.712246] Starting subtest: legacy-format
[183.739237] Subtest legacy-format: SUCCESS (0.023s)
[183.867847] [041/131] (836s left) gem_render_copy (y-tiled-ccs-to-y-tiled)
[183.936140] Starting subtest: y-tiled-ccs-to-y-tiled
[183.941046] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s)
[184.126325] [042/131] (836s left) drm_buddy (drm_buddy)
[184.161856] Starting subtest: drm_buddy
[184.166538] Subtest drm_buddy: SKIP (0.001s)
[184.220159] [043/131] (836s left) kms_ccs (bad-pixel-format-yf-tiled-ccs)
[184.319754] Starting subtest: bad-pixel-format-yf-tiled-ccs
[184.322061] Starting dynamic subtest: pipe-A-eDP-1
[184.344173] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[184.355503] Starting dynamic subtest: pipe-B-eDP-1
[184.377483] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[184.385421] Starting dynamic subtest: pipe-C-eDP-1
[184.407732] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[184.415954] Starting dynamic subtest: pipe-D-eDP-1
[184.437761] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[184.442260] Subtest bad-pixel-format-yf-tiled-ccs: SKIP (0.004s)
[186.649211] [044/131] (833s left) gem_exec_gttfill (multigpu-basic)
[186.831038] Starting subtest: multigpu-basic
[199.628679] Subtest multigpu-basic: SUCCESS (12.796s)
[199.681131] [045/131] (820s left) kms_big_fb (linear-32bpp-rotate-90)
[199.835288] Starting subtest: linear-32bpp-rotate-90
[199.854803] Subtest linear-32bpp-rotate-90: SKIP (0.019s)
[199.999904] [046/131] (820s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render)
[200.104940] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render
[200.109134] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[200.208751] [047/131] (820s left) gem_ctx_engines (execute-one)
[200.267636] Starting subtest: execute-one
[202.875484] Subtest execute-one: SUCCESS (2.608s)
[203.065281] [048/131] (817s left) gem_huc_copy (huc-copy)
[203.139279] Starting subtest: huc-copy
[203.142044] Subtest huc-copy: SUCCESS (0.004s)
[203.276921] [049/131] (817s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted)
[203.343271] Starting subtest: multi-wait-all-for-submit-unsubmitted
[203.448132] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.102s)
[203.523585] [050/131] (817s left) kms_color_pipeline (plane-lut1d-pre-ctm3x4)
[203.620327] Starting subtest: plane-lut1d-pre-ctm3x4
[203.777747] Starting dynamic subtest: pipe-A-plane-0
[203.944269] Dynamic subtest pipe-A-plane-0: SUCCESS (0.166s)
[203.953866] Starting dynamic subtest: pipe-A-plane-1
[204.133727] Dynamic subtest pipe-A-plane-1: SUCCESS (0.188s)
[204.142748] Starting dynamic subtest: pipe-A-plane-2
[204.288892] Dynamic subtest pipe-A-plane-2: SUCCESS (0.155s)
[205.451511] Starting dynamic subtest: pipe-B-plane-0
[205.622066] Dynamic subtest pipe-B-plane-0: SUCCESS (0.177s)
[205.631929] Starting dynamic subtest: pipe-B-plane-1
[205.789039] Dynamic subtest pipe-B-plane-1: SUCCESS (0.166s)
[205.797971] Starting dynamic subtest: pipe-B-plane-2
[205.933259] Dynamic subtest pipe-B-plane-2: SUCCESS (0.144s)
[207.180554] Starting dynamic subtest: pipe-C-plane-0
[207.319048] Dynamic subtest pipe-C-plane-0: SUCCESS (0.144s)
[207.337156] Starting dynamic subtest: pipe-C-plane-1
[207.473645] Dynamic subtest pipe-C-plane-1: SUCCESS (0.154s)
[207.491647] Starting dynamic subtest: pipe-C-plane-2
[207.618573] Dynamic subtest pipe-C-plane-2: SUCCESS (0.144s)
[208.782842] Starting dynamic subtest: pipe-D-plane-0
[208.930946] Dynamic subtest pipe-D-plane-0: SUCCESS (0.155s)
[208.946493] Starting dynamic subtest: pipe-D-plane-1
[209.075370] Dynamic subtest pipe-D-plane-1: SUCCESS (0.144s)
[209.084672] Starting dynamic subtest: pipe-D-plane-2
[209.219821] Dynamic subtest pipe-D-plane-2: SUCCESS (0.144s)
[209.521001] Subtest plane-lut1d-pre-ctm3x4: SUCCESS (5.901s)
[210.359551] [051/131] (810s left) perf_pmu (frequency)
[210.401134] Starting subtest: frequency
[210.406992] Starting dynamic subtest: gt0
[212.538970] Dynamic subtest gt0: SUCCESS (2.129s)
[212.550263] Starting dynamic subtest: idle-gt0
[213.044895] Dynamic subtest idle-gt0: SUCCESS (0.504s)
[213.056959] Starting dynamic subtest: gt1
[217.411004] Dynamic subtest gt1: SUCCESS (4.362s)
[217.422083] Starting dynamic subtest: idle-gt1
[217.951087] Dynamic subtest idle-gt1: SUCCESS (0.539s)
[217.953721] Subtest frequency: SUCCESS (7.552s)
[218.063158] [052/131] (802s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-upscaling)
[218.168733] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-upscaling
[218.172906] Subtest flip-64bpp-ytile-to-32bpp-ytile-upscaling: SKIP (0.000s)
[218.238522] [053/131] (802s left) gem_exec_balancer (nop)
[218.302001] Starting subtest: nop
[264.962269] Subtest nop: SUCCESS (46.662s)
[265.273885] [054/131] (755s left) kms_dp_linktrain_fallback (dp-fallback)
[265.382548] Starting subtest: dp-fallback
[265.389038] Subtest dp-fallback: SKIP (0.000s)
[265.465658] [055/131] (755s left) dumb_buffer (map-valid)
[265.523805] Starting subtest: map-valid
[265.526076] Subtest map-valid: SUCCESS (0.000s)
[265.625302] [056/131] (755s left) core_getclient (basic)
[265.676740] Starting subtest: basic
[265.679073] Subtest basic: SUCCESS (0.000s)
[265.767162] [057/131] (755s left) kms_big_fb (y-tiled-8bpp-rotate-180)
[265.855538] Starting subtest: y-tiled-8bpp-rotate-180
[265.860032] Subtest y-tiled-8bpp-rotate-180: SKIP (0.000s)
[265.941719] [058/131] (754s left) gem_exec_fence (invalid-timeline-fence-array)
[266.527778] Starting subtest: invalid-timeline-fence-array
[266.530136] Subtest invalid-timeline-fence-array: SUCCESS (0.005s)
[267.501124] [FACT gem_exec_fence (invalid-timeline-fence-array)] new: kernel.kmod_is_loaded.vgem: true
[267.505130] [059/131] (753s left) kms_flip (flip-vs-panning-interruptible)
[267.609580] Starting subtest: flip-vs-panning-interruptible
[267.612084] Starting dynamic subtest: A-eDP1
[276.362303] Dynamic subtest A-eDP1: SUCCESS (8.752s)
[276.375138] Starting dynamic subtest: B-eDP1
[285.088033] Dynamic subtest B-eDP1: SUCCESS (8.723s)
[285.099651] Starting dynamic subtest: C-eDP1
[293.809515] Dynamic subtest C-eDP1: SUCCESS (8.719s)
[293.821676] Starting dynamic subtest: D-eDP1
[302.541964] Dynamic subtest D-eDP1: SUCCESS (8.730s)
[302.546086] Subtest flip-vs-panning-interruptible: SUCCESS (34.936s)
[303.719420] [060/131] (717s left) gem_reg_read (timestamp-moving)
[303.777196] Starting subtest: timestamp-moving
[304.778682] Subtest timestamp-moving: SUCCESS (1.001s)
[304.858412] [061/131] (716s left) gem_ctx_persistence (many-contexts)
[304.921071] Starting subtest: many-contexts
[342.592918] Subtest many-contexts: SUCCESS (37.670s)
[342.671392] [062/131] (678s left) kms_cursor_crc (cursor-alpha-transparent)
[342.788209] Starting subtest: cursor-alpha-transparent
[342.790496] Starting dynamic subtest: pipe-A-eDP-1
[343.412459] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.622s)
[343.422415] Starting dynamic subtest: pipe-D-eDP-1
[344.677125] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.265s)
[344.679308] Subtest cursor-alpha-transparent: SUCCESS (1.890s)
[345.478691] [063/131] (675s left) kms_chamelium_audio (hdmi-audio)
[345.865787] Subtest hdmi-audio: SKIP (0.000s)
[346.691554] [064/131] (674s left) kms_cursor_legacy (cursorb-vs-flipb-atomic)
[346.817222] Starting subtest: cursorB-vs-flipB-atomic
[346.821996] Subtest cursorB-vs-flipB-atomic: SKIP (0.001s)
[346.963796] [065/131] (674s left) api_intel_allocator (fork-simple-stress-signal)
[347.021493] Starting subtest: fork-simple-stress-signal
[352.424039] Subtest fork-simple-stress-signal: SUCCESS (5.403s)
[352.540917] [066/131] (668s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move)
[352.648976] Starting subtest: psr-2p-primscrn-cur-indfb-move
[352.653376] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[352.796462] [067/131] (668s left) kms_legacy_colorkey (basic)
[352.901427] Starting subtest: basic
[352.903909] Starting dynamic subtest: pipe-A
[352.944950] Dynamic subtest pipe-A: SUCCESS (0.045s)
[352.956677] Starting dynamic subtest: pipe-B
[352.958853] Dynamic subtest pipe-B: SUCCESS (0.001s)
[352.968426] Starting dynamic subtest: pipe-C
[352.970586] Dynamic subtest pipe-C: SUCCESS (0.000s)
[352.980493] Starting dynamic subtest: pipe-D
[352.982773] Dynamic subtest pipe-D: SUCCESS (0.000s)
[352.985048] Subtest basic: SUCCESS (0.050s)
[353.060267] [068/131] (668s left) gem_mmap_gtt (cpuset-big-copy-odd)
[353.141301] Subtest cpuset-big-copy-odd: SKIP (0.000s)
[353.249192] [069/131] (668s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0-hflip)
[353.353839] Starting subtest: linear-max-hw-stride-64bpp-rotate-0-hflip
[353.358563] Subtest linear-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[353.464176] [070/131] (668s left) kms_psr (psr2-cursor-plane-onoff)
[353.561520] Starting subtest: psr2-cursor-plane-onoff
[353.563333] Starting dynamic subtest: eDP-1
[355.289349] Dynamic subtest eDP-1: SUCCESS (1.728s)
[355.291691] Subtest psr2-cursor-plane-onoff: SUCCESS (1.729s)
[356.081782] [071/131] (665s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen)
[356.189893] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen
[356.194336] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[356.301371] [072/131] (665s left) i915_query (engine-info-invalid)
[356.365675] Starting subtest: engine-info-invalid
[356.367930] Subtest engine-info-invalid: SUCCESS (0.000s)
[356.496286] [073/131] (665s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc)
[356.601039] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc
[356.605178] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[356.723694] [074/131] (664s left) kms_psr (fbc-psr2-cursor-blt)
[356.819140] Starting subtest: fbc-psr2-cursor-blt
[356.821491] Starting dynamic subtest: eDP-1
[356.825855] Dynamic subtest eDP-1: SKIP (0.000s)
[356.830275] Subtest fbc-psr2-cursor-blt: SKIP (0.001s)
[356.896468] [075/131] (664s left) kms_content_protection (atomic)
[357.035308] Starting subtest: atomic
[357.039310] Subtest atomic: SKIP (0.000s)
[357.158492] [076/131] (664s left) kms_rotation_crc (primary-y-tiled-reflect-x-90)
[357.264930] Starting subtest: primary-y-tiled-reflect-x-90
[357.268625] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s)
[357.341923] [077/131] (664s left) kms_properties (colorop-properties-atomic)
[357.442837] Starting subtest: colorop-properties-atomic
[357.444838] Starting dynamic subtest: pipe-A-eDP-1
[357.802146] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.360s)
[357.815123] Starting dynamic subtest: pipe-B-eDP-1
[358.850962] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.048s)
[358.861870] Starting dynamic subtest: pipe-C-eDP-1
[359.880707] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.027s)
[359.890749] Starting dynamic subtest: pipe-D-eDP-1
[360.927144] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.046s)
[360.929066] Subtest colorop-properties-atomic: SUCCESS (3.486s)
[361.714932] [078/131] (660s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-move)
[361.808659] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-move
[361.812920] Subtest fbcpsr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[361.915347] [079/131] (660s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs)
[362.008999] Starting subtest: crc-sprite-planes-basic-4-tiled-bmg-ccs
[362.013497] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[363.146376] [080/131] (658s left) gem_pxp (create-regular-context-2)
[363.278670] Starting subtest: create-regular-context-2
[363.281161] Subtest create-regular-context-2: SUCCESS (0.002s)
[363.382846] [081/131] (658s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[363.488010] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc
[370.064506] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (6.580s)
[370.199915] [082/131] (651s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area)
[370.304015] Starting subtest: pr-primary-plane-update-sf-dmg-area
[370.308190] Subtest pr-primary-plane-update-sf-dmg-area: SKIP (0.000s)
[370.374796] [083/131] (651s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted)
[370.429893] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted
[370.535027] Subtest etime-multi-wait-all-available-unsubmitted-submitted: SUCCESS (0.105s)
[370.612549] [084/131] (651s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[370.710507] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[370.716137] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[370.812848] [085/131] (651s left) kms_plane_scaling (plane-downscale-factor-0-5-with-rotation)
[370.906257] Starting subtest: plane-downscale-factor-0-5-with-rotation
[370.908602] Starting dynamic subtest: pipe-A
[370.924834] Dynamic subtest pipe-A: SKIP (0.016s)
[370.936739] Starting dynamic subtest: pipe-B
[370.957862] Dynamic subtest pipe-B: SKIP (0.031s)
[370.967455] Starting dynamic subtest: pipe-C
[370.987665] Dynamic subtest pipe-C: SKIP (0.031s)
[370.997080] Starting dynamic subtest: pipe-D
[371.020235] Dynamic subtest pipe-D: SKIP (0.030s)
[371.024488] Subtest plane-downscale-factor-0-5-with-rotation: SKIP (0.111s)
[371.118326] [086/131] (651s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled)
[371.190103] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[371.192584] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[371.294867] [087/131] (650s left) gem_exec_store (cachelines)
[371.368072] Starting subtest: cachelines
[371.370298] Starting dynamic subtest: rcs0
[371.452154] Dynamic subtest rcs0: SUCCESS (0.086s)
[371.463946] Starting dynamic subtest: bcs0
[371.516389] Dynamic subtest bcs0: SUCCESS (0.062s)
[371.527928] Starting dynamic subtest: vcs0
[371.576269] Dynamic subtest vcs0: SUCCESS (0.058s)
[371.588826] Starting dynamic subtest: vcs1
[371.637945] Dynamic subtest vcs1: SUCCESS (0.057s)
[371.648819] Starting dynamic subtest: vecs0
[371.692746] Dynamic subtest vecs0: SUCCESS (0.054s)
[371.704069] Starting dynamic subtest: ccs0
[371.757464] Dynamic subtest ccs0: SUCCESS (0.063s)
[371.759522] Subtest cachelines: SUCCESS (0.394s)
[371.960900] [088/131] (650s left) kms_draw_crc (draw-method-pwrite)
[372.049386] Starting subtest: draw-method-pwrite
[372.051403] Starting dynamic subtest: xrgb8888-untiled
[372.661102] Dynamic subtest xrgb8888-untiled: SUCCESS (0.611s)
[372.670868] Starting dynamic subtest: rgb565-untiled
[373.127828] Dynamic subtest rgb565-untiled: SUCCESS (0.464s)
[373.138085] Starting dynamic subtest: xrgb2101010-untiled
[373.671166] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.541s)
[373.681281] Starting dynamic subtest: xbgr16161616f-untiled
[374.448837] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.777s)
[374.458227] Starting dynamic subtest: xrgb8888-xtiled
[376.304236] Dynamic subtest xrgb8888-xtiled: SUCCESS (1.855s)
[376.315514] Starting dynamic subtest: rgb565-xtiled
[377.426923] Dynamic subtest rgb565-xtiled: SUCCESS (1.121s)
[377.436616] Starting dynamic subtest: xrgb2101010-xtiled
[379.251543] Dynamic subtest xrgb2101010-xtiled: SUCCESS (1.821s)
[379.262473] Starting dynamic subtest: xbgr16161616f-xtiled
[382.627284] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (3.377s)
[382.642053] Starting dynamic subtest: xrgb8888-4tiled
[383.760248] Dynamic subtest xrgb8888-4tiled: SUCCESS (1.132s)
[383.769902] Starting dynamic subtest: rgb565-4tiled
[384.338485] Dynamic subtest rgb565-4tiled: SUCCESS (0.577s)
[384.348566] Starting dynamic subtest: xrgb2101010-4tiled
[385.485108] Dynamic subtest xrgb2101010-4tiled: SUCCESS (1.143s)
[385.494965] Starting dynamic subtest: xbgr16161616f-4tiled
[388.527575] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (3.044s)
[388.529912] Subtest draw-method-pwrite: SUCCESS (16.479s)
[388.620680] [089/131] (633s left) i915_drm_fdinfo (most-busy-check-all)
[388.669350] Starting subtest: most-busy-check-all
[388.671714] Starting dynamic subtest: rcs0
[388.676321] Dynamic subtest rcs0: SKIP (0.004s)
[388.686453] Starting dynamic subtest: bcs0
[388.690687] Dynamic subtest bcs0: SKIP (0.000s)
[388.699919] Starting dynamic subtest: vcs0
[388.704492] Dynamic subtest vcs0: SKIP (0.000s)
[388.713540] Starting dynamic subtest: vcs1
[388.717767] Dynamic subtest vcs1: SKIP (0.000s)
[388.726571] Starting dynamic subtest: vecs0
[388.730666] Dynamic subtest vecs0: SKIP (0.000s)
[388.739312] Starting dynamic subtest: ccs0
[388.743490] Dynamic subtest ccs0: SKIP (0.000s)
[388.747611] Subtest most-busy-check-all: SKIP (0.009s)
[388.785426] [090/131] (633s left) perf_pmu (busy-accuracy-50)
[388.826316] Starting subtest: busy-accuracy-50
[388.828681] Starting dynamic subtest: rcs0
[390.358941] Dynamic subtest rcs0: SUCCESS (1.532s)
[390.370617] Starting dynamic subtest: bcs0
[391.906559] Dynamic subtest bcs0: SUCCESS (1.544s)
[391.916760] Starting dynamic subtest: vcs0
[393.451662] Dynamic subtest vcs0: SUCCESS (1.542s)
[393.462519] Starting dynamic subtest: vcs1
[394.994509] Dynamic subtest vcs1: SUCCESS (1.540s)
[395.006051] Starting dynamic subtest: vecs0
[396.536023] Dynamic subtest vecs0: SUCCESS (1.538s)
[396.546700] Starting dynamic subtest: ccs0
[398.087545] Dynamic subtest ccs0: SUCCESS (1.549s)
[398.089915] Subtest busy-accuracy-50: SUCCESS (9.261s)
[398.206993] [091/131] (624s left) gem_exec_schedule (implicit-write-read)
[398.280753] Starting subtest: implicit-write-read
[398.283022] Starting dynamic subtest: rcs0
[398.472274] Dynamic subtest rcs0: SUCCESS (0.199s)
[398.485535] Starting dynamic subtest: vcs0
[398.581147] Dynamic subtest vcs0: SUCCESS (0.109s)
[398.593256] Starting dynamic subtest: vcs1
[398.728901] Dynamic subtest vcs1: SUCCESS (0.147s)
[398.742169] Starting dynamic subtest: vecs0
[398.829828] Dynamic subtest vecs0: SUCCESS (0.100s)
[398.842253] Starting dynamic subtest: ccs0
[398.948239] Dynamic subtest ccs0: SUCCESS (0.118s)
[398.950966] Subtest implicit-write-read: SUCCESS (0.677s)
[399.482891] [092/131] (622s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-msflip-blt)
[399.578848] Starting subtest: fbc-2p-scndscrn-indfb-msflip-blt
[399.583168] Subtest fbc-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[399.677761] [093/131] (622s left) kms_plane_lowres (tiling-none)
[399.772065] Starting subtest: tiling-none
[399.774404] Starting dynamic subtest: pipe-A-eDP-1
[399.778932] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[400.069793] Starting dynamic subtest: pipe-B-eDP-1
[400.074498] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[400.083946] Starting dynamic subtest: pipe-C-eDP-1
[400.088674] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[400.098904] Starting dynamic subtest: pipe-D-eDP-1
[400.103558] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[400.107974] Subtest tiling-none: SKIP (0.296s)
[400.902550] [094/131] (621s left) gem_pxp (hw-rejects-pxp-buffer)
[400.970934] Starting subtest: hw-rejects-pxp-buffer
[400.975704] Subtest hw-rejects-pxp-buffer: SKIP (0.000s)
[401.065075] [095/131] (621s left) gem_userptr_blits (set-cache-level)
[401.131762] Starting subtest: set-cache-level
[401.136205] Subtest set-cache-level: SKIP (0.000s)
[401.256306] [096/131] (621s left) drm_read (short-buffer-block)
[401.397994] Starting subtest: short-buffer-block
[401.400360] Subtest short-buffer-block: SUCCESS (0.000s)
[401.511556] [097/131] (621s left) perf_pmu (idle-no-semaphores)
[401.555807] Starting subtest: idle-no-semaphores
[401.558059] Starting dynamic subtest: rcs0
[402.097518] Dynamic subtest rcs0: SUCCESS (0.541s)
[402.110509] Starting dynamic subtest: bcs0
[402.619641] Dynamic subtest bcs0: SUCCESS (0.518s)
[402.630390] Starting dynamic subtest: vcs0
[403.144327] Dynamic subtest vcs0: SUCCESS (0.521s)
[403.155899] Starting dynamic subtest: vcs1
[403.666079] Dynamic subtest vcs1: SUCCESS (0.519s)
[403.678161] Starting dynamic subtest: vecs0
[404.184539] Dynamic subtest vecs0: SUCCESS (0.515s)
[404.196494] Starting dynamic subtest: ccs0
[404.704538] Dynamic subtest ccs0: SUCCESS (0.517s)
[404.707841] Subtest idle-no-semaphores: SUCCESS (3.150s)
[404.809513] [098/131] (617s left) prime_busy (before-wait)
[404.868577] Starting subtest: before-wait
[404.874006] Starting dynamic subtest: rcs0
[404.904851] Dynamic subtest rcs0: SUCCESS (0.032s)
[404.914924] Starting dynamic subtest: bcs0
[404.957122] Dynamic subtest bcs0: SUCCESS (0.051s)
[404.967171] Starting dynamic subtest: vcs0
[404.999331] Dynamic subtest vcs0: SUCCESS (0.042s)
[405.009091] Starting dynamic subtest: vcs1
[405.040795] Dynamic subtest vcs1: SUCCESS (0.041s)
[405.050349] Starting dynamic subtest: vecs0
[405.083243] Dynamic subtest vecs0: SUCCESS (0.042s)
[405.093140] Starting dynamic subtest: ccs0
[405.126035] Dynamic subtest ccs0: SUCCESS (0.042s)
[405.234891] Subtest before-wait: SUCCESS (0.364s)
[405.314929] [099/131] (617s left) syncobj_timeline (reset-multiple-signaled)
[405.380257] Starting subtest: reset-multiple-signaled
[405.382729] Subtest reset-multiple-signaled: SUCCESS (0.001s)
[405.492846] [100/131] (617s left) i915_pm_rps (min-max-config-loaded)
[405.559388] Starting subtest: min-max-config-loaded
[405.564236] Subtest min-max-config-loaded: SKIP (0.001s)
[405.682386] [101/131] (617s left) kms_big_fb (x-tiled-addfb-size-offset-overflow)
[405.784157] Starting subtest: x-tiled-addfb-size-offset-overflow
[405.786486] Subtest x-tiled-addfb-size-offset-overflow: SUCCESS (0.000s)
[405.881370] [102/131] (617s left) gem_ctx_param (invalid-set-ringsize)
[405.939644] Starting subtest: invalid-set-ringsize
[405.941990] Subtest invalid-set-ringsize: SUCCESS (0.000s)
[406.021004] [103/131] (616s left) gem_softpin (full)
[406.093508] Starting subtest: full
[406.107351] Subtest full: SUCCESS (0.014s)
[406.241082] [104/131] (616s left) gem_render_copy (yf-tiled-to-vebox-linear)
[406.315961] Starting subtest: yf-tiled-to-vebox-linear
[406.319839] Subtest yf-tiled-to-vebox-linear: SKIP (0.000s)
[406.513216] [105/131] (616s left) kms_pipe_crc_basic (disable-crc-after-crtc)
[406.612790] Starting subtest: disable-crc-after-crtc
[406.614720] Starting dynamic subtest: pipe-A-eDP-1
[408.259926] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.645s)
[408.270465] Starting dynamic subtest: pipe-B-eDP-1
[410.648324] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.389s)
[410.659165] Starting dynamic subtest: pipe-C-eDP-1
[412.902208] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.252s)
[412.912934] Starting dynamic subtest: pipe-D-eDP-1
[415.159654] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.256s)
[415.161883] Subtest disable-crc-after-crtc: SUCCESS (8.548s)
[415.992691] [106/131] (607s left) kms_plane_scaling (plane-upscale-20x20-with-pixel-format)
[416.088461] Starting subtest: plane-upscale-20x20-with-pixel-format
[416.090822] Starting dynamic subtest: pipe-A
[417.146829] Dynamic subtest pipe-A: SUCCESS (1.061s)
[417.156112] Starting dynamic subtest: pipe-B
[419.284908] Dynamic subtest pipe-B: SUCCESS (2.137s)
[419.297121] Starting dynamic subtest: pipe-C
[420.474559] Dynamic subtest pipe-C: SUCCESS (1.189s)
[420.484119] Starting dynamic subtest: pipe-D
[421.709590] Dynamic subtest pipe-D: SUCCESS (1.233s)
[421.711821] Subtest plane-upscale-20x20-with-pixel-format: SUCCESS (5.625s)
[422.894320] [107/131] (600s left) kms_pm_dc (dc9-dpms)
[423.994710] Starting subtest: dc9-dpms
[425.439568] Subtest dc9-dpms: SUCCESS (1.446s)
[425.515163] [108/131] (597s left) syncobj_timeline (wait-all-interrupted)
[425.580844] Starting subtest: wait-all-interrupted
[425.685388] Subtest wait-all-interrupted: SUCCESS (0.102s)
[425.775785] [109/131] (597s left) kms_sequence (get-forked-busy)
[425.866618] Starting subtest: get-forked-busy
[425.869002] Starting dynamic subtest: pipe-A-eDP-1
[427.799598] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.933s)
[427.811208] Starting dynamic subtest: pipe-B-eDP-1
[430.373698] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.574s)
[430.385218] Starting dynamic subtest: pipe-C-eDP-1
[432.977913] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.602s)
[432.989027] Starting dynamic subtest: pipe-D-eDP-1
[435.519133] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.541s)
[435.521757] Subtest get-forked-busy: SUCCESS (9.655s)
[436.400404] [110/131] (586s left) gem_render_copy_redux (interruptible)
[436.464760] Starting subtest: interruptible
[436.744419] Subtest interruptible: SUCCESS (0.280s)
[436.870181] [111/131] (586s left) kms_chamelium_hpd (vga-hpd-for-each-pipe)
[437.264287] Subtest vga-hpd-for-each-pipe: SKIP (0.000s)
[438.110560] [112/131] (585s left) sw_sync (sync_multi_consumer)
[438.154411] Starting subtest: sync_multi_consumer
[438.594240] Subtest sync_multi_consumer: SUCCESS (0.441s)
[438.668471] [113/131] (584s left) gem_partial_pwrite_pread (reads-display)
[438.726949] Subtest reads-display: SKIP (0.000s)
[438.800743] [114/131] (584s left) kms_cursor_crc (cursor-rapid-movement-128x42)
[439.017629] Starting subtest: cursor-rapid-movement-128x42
[439.067067] Subtest cursor-rapid-movement-128x42: SKIP (0.045s)
[439.277173] [115/131] (584s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180)
[439.375263] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180
[440.420853] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.046s)
[440.547429] [116/131] (582s left) gem_partial_pwrite_pread (writes-after-reads-snoop)
[440.602589] Subtest writes-after-reads-snoop: SKIP (0.000s)
[440.671986] [117/131] (582s left) gem_exec_params (invalid-bsd2-flag-on-render)
[440.731922] Starting subtest: invalid-bsd2-flag-on-render
[440.733900] Subtest invalid-bsd2-flag-on-render: SUCCESS (0.000s)
[440.831569] [118/131] (582s left) gem_exec_reloc (basic-cpu-noreloc)
[440.883429] Subtest basic-cpu-noreloc: SKIP (0.000s)
[440.954422] [119/131] (582s left) gem_exec_schedule (promotion)
[441.025907] Starting subtest: promotion
[441.027603] Starting dynamic subtest: rcs0
[441.127531] Dynamic subtest rcs0: SUCCESS (0.109s)
[441.138417] Starting dynamic subtest: vcs0
[441.219351] Dynamic subtest vcs0: SUCCESS (0.091s)
[441.229617] Starting dynamic subtest: vcs1
[441.305697] Dynamic subtest vcs1: SUCCESS (0.084s)
[441.318561] Starting dynamic subtest: vecs0
[441.383630] Dynamic subtest vecs0: SUCCESS (0.078s)
[441.396488] Starting dynamic subtest: ccs0
[441.473641] Dynamic subtest ccs0: SUCCESS (0.090s)
[441.475771] Subtest promotion: SUCCESS (0.456s)
[442.486956] [120/131] (581s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-rc-ccs)
[442.581156] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-rc-ccs
[442.583559] Starting dynamic subtest: pipe-A-eDP-1
[442.606203] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[442.618166] Starting dynamic subtest: pipe-B-eDP-1
[442.640186] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[442.649364] Starting dynamic subtest: pipe-C-eDP-1
[442.670720] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[442.679664] Starting dynamic subtest: pipe-D-eDP-1
[442.700866] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[442.705202] Subtest crc-primary-rotation-180-4-tiled-dg2-rc-ccs: SKIP (0.006s)
[444.907286] [121/131] (578s left) kms_prime (basic-modeset-hybrid)
[444.995557] Subtest basic-modeset-hybrid: SKIP (0.000s)
[445.132667] [122/131] (578s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted-signa
[445.186309] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled
[445.295154] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.108s)
[445.386728] [123/131] (578s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[445.479807] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[445.484388] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[445.574542] [124/131] (578s left) kms_atomic_transition (plane-all-transition-nonblocking)
[445.675301] Starting subtest: plane-all-transition-nonblocking
[445.677645] Starting dynamic subtest: pipe-A-eDP-1
[448.169265] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.495s)
[448.479030] Starting dynamic subtest: pipe-B-eDP-1
[451.741474] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.272s)
[452.051058] Subtest plane-all-transition-nonblocking: SUCCESS (6.377s)
[452.870106] [125/131] (571s left) gem_set_tiling_vs_blt (tiled-to-untiled)
[452.935189] Subtest tiled-to-untiled: SKIP (0.000s)
[452.992246] [126/131] (570s left) kms_getfb (getfb2-handle-not-fb)
[453.083312] Starting subtest: getfb2-handle-not-fb
[453.085677] Subtest getfb2-handle-not-fb: SUCCESS (0.000s)
[453.183693] [127/131] (570s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping)
[453.271677] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping
[453.303341] Starting dynamic subtest: pipe-A-plane-0
[453.591757] Dynamic subtest pipe-A-plane-0: SUCCESS (0.288s)
[453.603463] Starting dynamic subtest: pipe-A-plane-3
[453.824653] Dynamic subtest pipe-A-plane-3: SUCCESS (0.232s)
[454.980289] Starting dynamic subtest: pipe-B-plane-0
[455.288961] Dynamic subtest pipe-B-plane-0: SUCCESS (0.322s)
[455.300055] Starting dynamic subtest: pipe-B-plane-3
[455.533210] Dynamic subtest pipe-B-plane-3: SUCCESS (0.243s)
[455.849185] Subtest pixel-format-4-tiled-mtl-rc-ccs-modifier-source-clamping: SUCCESS (2.576s)
[456.662366] [128/131] (567s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite)
[456.761032] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite
[465.482776] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.724s)
[465.596525] [129/131] (558s left) gen7_exec_parse (oacontrol-tracking)
[465.669240] Subtest oacontrol-tracking: SKIP (0.000s)
[465.748962] [130/131] (558s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc)
[465.838723] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc
[465.843138] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[465.943572] [131/131] (558s left) perf (disabled-read-error)
[466.053647] Starting subtest: disabled-read-error
[466.067949] Subtest disabled-read-error: SUCCESS (0.014s)
[466.113147] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_psr
results: parsing output: 2/ for test: kms_big_fb
results: parsing output: 3/ for test: gem_exec_reloc
results: parsing output: 4/ for test: gem_exec_balancer
results: parsing output: 5/ for test: kms_ccs
results: parsing output: 6/ for test: kms_chamelium_color
results: parsing output: 7/ for test: sw_sync
results: parsing output: 8/ for test: gem_mmap_offset
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: gem_ctx_bad_destroy
results: parsing output: 11/ for test: i915_hangman
results: parsing output: 12/ for test: gem_exec_params
results: parsing output: 13/ for test: kms_cursor_edge_walk
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: prime_mmap
results: parsing output: 17/ for test: syncobj_timeline
results: parsing output: 18/ for test: kms_psr
results: parsing output: 19/ for test: gem_ctx_param
results: parsing output: 20/ for test: gem_partial_pwrite_pread
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: kms_flip_scaled_crc
results: parsing output: 23/ for test: prime_self_import
results: parsing output: 24/ for test: gem_fence_thrash
results: parsing output: 25/ for test: kms_invalid_mode
results: parsing output: 26/ for test: kms_flip
results: parsing output: 27/ for test: kms_flip_scaled_crc
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: perf
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_psr
results: parsing output: 34/ for test: kms_psr
results: parsing output: 35/ for test: gem_exec_reloc
results: parsing output: 36/ for test: kms_atomic
results: parsing output: 37/ for test: kms_vblank
results: parsing output: 38/ for test: syncobj_timeline
results: parsing output: 39/ for test: kms_addfb_basic
results: parsing output: 40/ for test: gem_render_copy
results: parsing output: 41/ for test: drm_buddy
results: parsing output: 42/ for test: kms_ccs
results: parsing output: 43/ for test: gem_exec_gttfill
results: parsing output: 44/ for test: kms_big_fb
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: gem_ctx_engines
results: parsing output: 47/ for test: gem_huc_copy
results: parsing output: 48/ for test: syncobj_wait
results: parsing output: 49/ for test: kms_color_pipeline
results: parsing output: 50/ for test: perf_pmu
results: parsing output: 51/ for test: kms_flip_scaled_crc
results: parsing output: 52/ for test: gem_exec_balancer
results: parsing output: 53/ for test: kms_dp_linktrain_fallback
results: parsing output: 54/ for test: dumb_buffer
results: parsing output: 55/ for test: core_getclient
results: parsing output: 56/ for test: kms_big_fb
results: parsing output: 57/ for test: gem_exec_fence
results: parsing output: 58/ for test: kms_flip
results: parsing output: 59/ for test: gem_reg_read
results: parsing output: 60/ for test: gem_ctx_persistence
results: parsing output: 61/ for test: kms_cursor_crc
results: parsing output: 62/ for test: kms_chamelium_audio
results: parsing output: 63/ for test: kms_cursor_legacy
results: parsing output: 64/ for test: api_intel_allocator
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_legacy_colorkey
results: parsing output: 67/ for test: gem_mmap_gtt
results: parsing output: 68/ for test: kms_big_fb
results: parsing output: 69/ for test: kms_psr
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: i915_query
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_psr
results: parsing output: 74/ for test: kms_content_protection
results: parsing output: 75/ for test: kms_rotation_crc
results: parsing output: 76/ for test: kms_properties
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: kms_ccs
results: parsing output: 79/ for test: gem_pxp
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: kms_psr2_sf
results: parsing output: 82/ for test: syncobj_timeline
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_plane_scaling
results: parsing output: 85/ for test: syncobj_wait
results: parsing output: 86/ for test: gem_exec_store
results: parsing output: 87/ for test: kms_draw_crc
results: parsing output: 88/ for test: i915_drm_fdinfo
results: parsing output: 89/ for test: perf_pmu
results: parsing output: 90/ for test: gem_exec_schedule
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_plane_lowres
results: parsing output: 93/ for test: gem_pxp
results: parsing output: 94/ for test: gem_userptr_blits
results: parsing output: 95/ for test: drm_read
results: parsing output: 96/ for test: perf_pmu
results: parsing output: 97/ for test: prime_busy
results: parsing output: 98/ for test: syncobj_timeline
results: parsing output: 99/ for test: i915_pm_rps
results: parsing output: 100/ for test: kms_big_fb
results: parsing output: 101/ for test: gem_ctx_param
results: parsing output: 102/ for test: gem_softpin
results: parsing output: 103/ for test: gem_render_copy
results: parsing output: 104/ for test: kms_pipe_crc_basic
results: parsing output: 105/ for test: kms_plane_scaling
results: parsing output: 106/ for test: kms_pm_dc
results: parsing output: 107/ for test: syncobj_timeline
results: parsing output: 108/ for test: kms_sequence
results: parsing output: 109/ for test: gem_render_copy_redux
results: parsing output: 110/ for test: kms_chamelium_hpd
results: parsing output: 111/ for test: sw_sync
results: parsing output: 112/ for test: gem_partial_pwrite_pread
results: parsing output: 113/ for test: kms_cursor_crc
results: parsing output: 114/ for test: kms_big_fb
results: parsing output: 115/ for test: gem_partial_pwrite_pread
results: parsing output: 116/ for test: gem_exec_params
results: parsing output: 117/ for test: gem_exec_reloc
results: parsing output: 118/ for test: gem_exec_schedule
results: parsing output: 119/ for test: kms_ccs
results: parsing output: 120/ for test: kms_prime
results: parsing output: 121/ for test: syncobj_timeline
results: parsing output: 122/ for test: kms_big_fb
results: parsing output: 123/ for test: kms_atomic_transition
results: parsing output: 124/ for test: gem_set_tiling_vs_blt
results: parsing output: 125/ for test: kms_getfb
results: parsing output: 126/ for test: kms_plane
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: gen7_exec_parse
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: perf
Done.