[60.748844] Initializing watchdogs
[60.748893]   /dev/watchdog0
[60.763005] [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]
[60.767371] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[60.769797] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.771803] [001/134] (960s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-20x20)
[60.878047] Starting subtest: planes-downscale-factor-0-75-upscale-20x20
[60.878963] Starting dynamic subtest: pipe-A
[60.964070] Dynamic subtest pipe-A: SUCCESS (0.087s)
[60.971932] Starting dynamic subtest: pipe-B
[62.080056] Dynamic subtest pipe-B: SUCCESS (1.116s)
[62.090416] Starting dynamic subtest: pipe-C
[63.190735] Dynamic subtest pipe-C: SUCCESS (1.110s)
[63.199536] Starting dynamic subtest: pipe-D
[64.321111] Dynamic subtest pipe-D: SUCCESS (1.130s)
[64.322173] Subtest planes-downscale-factor-0-75-upscale-20x20: SUCCESS (3.445s)
[65.495521] [002/134] (955s left) gem_userptr_blits (forbidden-operations)
[65.556981] Starting subtest: forbidden-operations
[65.559102] Subtest forbidden-operations: SKIP (0.000s)
[65.718400] [003/134] (955s left) gem_mmap_gtt (big-bo)
[65.770550] Subtest big-bo: SKIP (0.000s)
[65.833711] [004/134] (955s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[65.924311] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[73.196297] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.274s)
[73.346687] [005/134] (948s left) kms_fence_pin_leak
[73.526230] [006/134] (947s left) kms_big_fb (x-tiled-16bpp-rotate-180)
[73.624244] Starting subtest: x-tiled-16bpp-rotate-180
[74.824784] Subtest x-tiled-16bpp-rotate-180: SUCCESS (1.201s)
[74.999528] [007/134] (946s left) gem_mmap_wc (write-cpu-read-wc-unflushed)
[75.047051] Subtest write-cpu-read-wc-unflushed: SKIP (0.000s)
[75.102182] [008/134] (946s left) kms_flip (2x-flip-vs-expired-vblank-interruptible)
[75.189474] Starting subtest: 2x-flip-vs-expired-vblank-interruptible
[75.201311] Subtest 2x-flip-vs-expired-vblank-interruptible: SKIP (0.011s)
[75.292197] [009/134] (946s left) perf_pmu (busy-check-all)
[75.327258] Starting subtest: busy-check-all
[75.328150] Starting dynamic subtest: rcs0
[75.905387] Dynamic subtest rcs0: SUCCESS (0.578s)
[75.914242] Starting dynamic subtest: bcs0
[76.453571] Dynamic subtest bcs0: SUCCESS (0.547s)
[76.462350] Starting dynamic subtest: vcs0
[77.910633] Dynamic subtest vcs0: SUCCESS (1.455s)
[77.920719] Starting dynamic subtest: vcs1
[79.896783] Dynamic subtest vcs1: SUCCESS (1.983s)
[79.905991] Starting dynamic subtest: vecs0
[81.880758] Dynamic subtest vecs0: SUCCESS (1.983s)
[81.889860] Starting dynamic subtest: ccs0
[82.434622] Dynamic subtest ccs0: SUCCESS (0.555s)
[82.436062] Subtest busy-check-all: SUCCESS (7.108s)
[82.547424] [010/134] (938s left) gem_mmap_wc (coherency)
[82.605115] Subtest coherency: SKIP (0.000s)
[82.663410] [011/134] (938s left) kms_big_fb (yf-tiled-addfb)
[82.775751] Starting subtest: yf-tiled-addfb
[82.777686] Subtest yf-tiled-addfb: SKIP (0.000s)
[82.886257] [012/134] (938s left) kms_busy (extended-modeset-hang-oldfb-with-reset)
[82.992926] Starting subtest: extended-modeset-hang-oldfb-with-reset
[82.993839] Starting dynamic subtest: pipe-A
[94.661540] Dynamic subtest pipe-A: SUCCESS (11.668s)
[94.670299] Starting dynamic subtest: pipe-D
[106.946884] Dynamic subtest pipe-D: SUCCESS (12.284s)
[106.947877] Subtest extended-modeset-hang-oldfb-with-reset: SUCCESS (23.955s)
[107.758355] [013/134] (913s left) kms_plane_alpha_blend (constant-alpha-min)
[107.858956] Starting subtest: constant-alpha-min
[108.143549] Starting dynamic subtest: pipe-A-eDP-1
[108.879804] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.735s)
[108.887402] Starting dynamic subtest: pipe-D-eDP-1
[110.307189] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.427s)
[110.308202] Subtest constant-alpha-min: SUCCESS (2.448s)
[111.120815] [014/134] (910s left) sysfs_timeslice_duration (duration)
[111.176417] Starting subtest: duration
[111.177313] Starting dynamic subtest: vecs0
[125.876795] Dynamic subtest vecs0: SUCCESS (14.697s)
[125.889655] Starting dynamic subtest: ccs0
[139.025356] Dynamic subtest ccs0: SUCCESS (13.146s)
[139.037677] Starting dynamic subtest: vcs0
[153.846612] Dynamic subtest vcs0: SUCCESS (14.818s)
[153.856405] Starting dynamic subtest: bcs0
[167.029481] Dynamic subtest bcs0: SUCCESS (13.181s)
[167.045302] Starting dynamic subtest: rcs0
[180.204885] Dynamic subtest rcs0: SUCCESS (13.173s)
[180.214681] Starting dynamic subtest: vcs1
[193.845476] Dynamic subtest vcs1: SUCCESS (13.636s)
[193.846996] Subtest duration: SUCCESS (82.664s)
[193.936410] [015/134] (827s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-cpu)
[194.054703] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-cpu
[197.702317] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (3.648s)
[198.932234] [016/134] (822s left) kms_cursor_crc (cursor-onscreen-64x64)
[199.094786] Starting subtest: cursor-onscreen-64x64
[199.097757] Starting dynamic subtest: pipe-A-eDP-1
[201.206515] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.108s)
[201.231368] Starting dynamic subtest: pipe-D-eDP-1
[203.972943] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.747s)
[203.973899] Subtest cursor-onscreen-64x64: SUCCESS (4.878s)
[204.795728] [017/134] (816s left) kms_color (ctm-red-to-blue)
[204.876316] Starting subtest: ctm-red-to-blue
[204.877239] Starting dynamic subtest: pipe-A-eDP-1
[205.578422] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.702s)
[205.585674] Starting dynamic subtest: pipe-B-eDP-1
[206.970681] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.391s)
[206.977590] Starting dynamic subtest: pipe-C-eDP-1
[208.349431] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.378s)
[208.356531] Starting dynamic subtest: pipe-D-eDP-1
[209.715947] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.367s)
[209.716949] Subtest ctm-red-to-blue: SUCCESS (4.840s)
[210.536272] [018/134] (811s left) gem_partial_pwrite_pread (writes-after-reads-uncached)
[210.593985] Subtest writes-after-reads-uncached: SKIP (0.000s)
[210.663183] [019/134] (811s left) dumb_buffer (invalid-bpp)
[210.715166] Starting subtest: invalid-bpp
[210.716215] Subtest invalid-bpp: SUCCESS (0.000s)
[210.835937] [020/134] (811s left) gem_mmap_gtt (ptrace)
[210.896714] Subtest ptrace: SKIP (0.000s)
[210.949342] [021/134] (810s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions-varying-s
[211.073760] Starting subtest: short-busy-flip-before-cursor-atomic-transitions-varying-size
[211.075611] Subtest short-busy-flip-before-cursor-atomic-transitions-varying-size: SKIP (0.000s)
[211.231829] [022/134] (810s left) gem_lmem_swapping (verify)
[211.281415] Subtest verify: SKIP (0.000s)
[211.316373] [023/134] (810s left) gem_spin_batch (resubmit-new)
[211.377454] Starting subtest: resubmit-new
[211.378425] Starting dynamic subtest: rcs0
[211.390604] Dynamic subtest rcs0: SUCCESS (0.013s)
[211.401980] Starting dynamic subtest: bcs0
[211.403336] Dynamic subtest bcs0: SUCCESS (0.006s)
[211.412382] Starting dynamic subtest: vcs0
[211.413234] Dynamic subtest vcs0: SUCCESS (0.004s)
[211.420282] Starting dynamic subtest: vcs1
[211.421071] Dynamic subtest vcs1: SUCCESS (0.004s)
[211.427600] Starting dynamic subtest: vecs0
[211.428443] Dynamic subtest vecs0: SUCCESS (0.004s)
[211.434729] Starting dynamic subtest: ccs0
[211.435550] Dynamic subtest ccs0: SUCCESS (0.003s)
[211.436400] Subtest resubmit-new: SUCCESS (0.037s)
[212.941333] [024/134] (809s left) kms_cursor_crc (cursor-random-512x512)
[213.242257] Starting subtest: cursor-random-512x512
[213.245256] Subtest cursor-random-512x512: SKIP (0.001s)
[213.440894] [025/134] (808s left) kms_properties (plane-properties-legacy)
[213.531461] Starting subtest: plane-properties-legacy
[213.532413] Starting dynamic subtest: pipe-A-eDP-1
[214.074131] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.543s)
[214.081555] Starting dynamic subtest: pipe-B-eDP-1
[215.383600] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.307s)
[215.390836] Starting dynamic subtest: pipe-C-eDP-1
[216.622848] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.238s)
[216.634229] Starting dynamic subtest: pipe-D-eDP-1
[217.856719] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.233s)
[217.857666] Subtest plane-properties-legacy: SUCCESS (4.326s)
[218.690243] [026/134] (803s left) kms_vrr (flipline)
[218.785310] Starting subtest: flipline
[218.787961] Subtest flipline: SKIP (0.000s)
[218.873110] [027/134] (803s left) gem_exec_params (secure-non-master)
[218.935329] Starting subtest: secure-non-master
[218.937257] Subtest secure-non-master: SKIP (0.000s)
[219.059411] [028/134] (803s left) gem_exec_balancer (parallel-dmabuf-import-out-fence)
[219.317884] Starting subtest: parallel-dmabuf-import-out-fence
[220.392789] Subtest parallel-dmabuf-import-out-fence: SUCCESS (1.075s)
[220.539565] [029/134] (801s left) kms_pm_dc (dc5-dpms-negative)
[221.656024] Starting subtest: dc5-dpms-negative
[221.657737] Subtest dc5-dpms-negative: SKIP (0.000s)
[221.743716] [030/134] (800s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[221.844615] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[221.846294] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[221.963966] [031/134] (800s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite)
[222.047860] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite
[228.805221] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.758s)
[228.942154] [032/134] (793s left) kms_frontbuffer_tracking (psr-argb161616f-draw-mmap-cpu)
[229.059017] Starting subtest: psr-argb161616f-draw-mmap-cpu
[229.060762] Subtest psr-argb161616f-draw-mmap-cpu: SKIP (0.000s)
[229.201243] [033/134] (793s left) gem_exec_whisper (basic-fds-all)
[229.272585] Starting subtest: basic-fds-all
[240.885940] Subtest basic-fds-all: SUCCESS (11.611s)
[241.083674] [034/134] (781s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[241.181065] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[241.182846] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[241.314219] [035/134] (781s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[241.427906] Starting subtest: psr-rgb565-draw-render
[248.491192] Subtest psr-rgb565-draw-render: SUCCESS (7.065s)
[248.645167] [036/134] (773s left) gem_render_copy_redux (flink)
[248.705334] Starting subtest: flink
[249.489991] Subtest flink: SUCCESS (0.786s)
[249.655181] [037/134] (772s left) gem_mmap_wc (bad-offset)
[249.708644] Subtest bad-offset: SKIP (0.000s)
[249.758966] [038/134] (772s left) gem_pxp (reject-modify-context-protection-off-2)
[249.874690] Starting subtest: reject-modify-context-protection-off-2
[249.875677] Subtest reject-modify-context-protection-off-2: SUCCESS (0.002s)
[249.997447] [039/134] (772s left) kms_3d (basic)
[250.047959] Starting subtest: basic
[252.007854] Subtest basic: SUCCESS (1.960s)
[252.522904] [040/134] (769s left) gem_ctx_persistence (smoketest)
[252.577026] Starting subtest: smoketest
[291.831750] Subtest smoketest: SUCCESS (39.249s)
[291.923413] [041/134] (730s left) kms_psr (fbc-pr-suspend)
[292.024582] Starting subtest: fbc-pr-suspend
[292.026428] Subtest fbc-pr-suspend: SKIP (0.000s)
[292.123953] [042/134] (730s left) syncobj_timeline (multi-wait-for-submit-signaled)
[292.180149] Starting subtest: multi-wait-for-submit-signaled
[292.181222] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[292.317228] [043/134] (730s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-upscaling)
[292.410401] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-upscaling
[292.411237] Starting dynamic subtest: pipe-A-default-mode
[295.152340] Dynamic subtest pipe-A-default-mode: SUCCESS (2.739s)
[295.153312] Subtest flip-64bpp-4tile-to-32bpp-4tile-upscaling: SUCCESS (2.741s)
[295.999801] [044/134] (726s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling)
[296.093484] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-upscaling
[296.094425] Starting dynamic subtest: pipe-A-default-mode
[298.762417] Dynamic subtest pipe-A-default-mode: SUCCESS (2.668s)
[298.763313] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SUCCESS (2.670s)
[299.588805] [045/134] (723s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-cpu)
[299.674620] Starting subtest: psr-rgb565-draw-mmap-cpu
[306.347490] Subtest psr-rgb565-draw-mmap-cpu: SUCCESS (6.673s)
[306.476036] [046/134] (716s left) vgem_basic (mmap)
[306.590580] Starting subtest: mmap
[306.597100] Subtest mmap: SUCCESS (0.007s)
[306.668444] [FACT vgem_basic (mmap)] new: kernel.kmod_is_loaded.vgem: true
[306.670604] [047/134] (716s left) gem_userptr_blits (sync-unmap-after-close)
[306.725216] Starting subtest: sync-unmap-after-close
[306.737793] Subtest sync-unmap-after-close: SUCCESS (0.013s)
[306.917461] [048/134] (715s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode)
[307.309447] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s)
[308.138333] [049/134] (714s left) kms_frontbuffer_tracking (basic)
[308.232984] Starting subtest: basic
[311.317408] Subtest basic: SUCCESS (3.086s)
[311.470352] [050/134] (711s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[311.564620] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[318.554209] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (6.990s)
[318.684042] [051/134] (704s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-blt)
[318.774780] Starting subtest: fbc-rgb101010-draw-blt
[323.349158] Subtest fbc-rgb101010-draw-blt: SUCCESS (4.574s)
[324.504827] [052/134] (698s left) kms_lease (lease-unleased-connector)
[324.595270] Starting subtest: lease-unleased-connector
[324.596122] Starting dynamic subtest: pipe-A-eDP-1
[324.603052] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.007s)
[324.610977] Starting dynamic subtest: pipe-B-eDP-1
[324.611982] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.006s)
[324.619591] Starting dynamic subtest: pipe-C-eDP-1
[324.620436] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.008s)
[324.627897] Starting dynamic subtest: pipe-D-eDP-1
[324.628763] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.006s)
[324.629695] Subtest lease-unleased-connector: SUCCESS (0.034s)
[324.766626] [053/134] (698s left) gem_tiled_partial_pwrite_pread (reads)
[324.824692] Subtest reads: SKIP (0.000s)
[324.887238] [054/134] (698s left) kms_dp_link_training (uhbr-sst)
[324.979414] Starting subtest: uhbr-sst
[324.982753] Subtest uhbr-sst: SKIP (0.000s)
[325.068921] [055/134] (697s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[325.128028] Starting subtest: etime-multi-wait-all-submitted-signaled
[325.236311] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.106s)
[325.328169] [056/134] (697s left) kms_invalid_mode (overflow-vrefresh)
[325.417484] Starting subtest: overflow-vrefresh
[325.419522] Starting dynamic subtest: pipe-A-eDP-1
[325.703239] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[325.711296] Starting dynamic subtest: pipe-B-eDP-1
[325.712307] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[325.719558] Starting dynamic subtest: pipe-C-eDP-1
[325.720466] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[325.727867] Starting dynamic subtest: pipe-D-eDP-1
[325.728753] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[325.729709] Subtest overflow-vrefresh: SUCCESS (0.292s)
[326.592120] [057/134] (696s left) kms_pm_rpm (i2c)
[328.115440] Starting subtest: i2c
[333.855587] Subtest i2c: SUCCESS (5.743s)
[333.962375] [058/134] (689s left) gem_exec_balancer (busy)
[334.023896] Starting subtest: busy
[335.927072] Subtest busy: SUCCESS (1.900s)
[336.271954] [059/134] (686s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-sf)
[341.335274] Starting subtest: fbc-pr-cursor-plane-move-continuous-exceed-sf
[341.338086] Subtest fbc-pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.002s)
[342.202667] [060/134] (680s left) gen9_exec_parse (batch-without-end)
[342.262032] Subtest batch-without-end: SKIP (0.000s)
[342.326158] [061/134] (680s left) gem_ctx_shared (exec-shared-gtt)
[342.390436] Starting subtest: exec-shared-gtt
[342.391444] Starting dynamic subtest: rcs0
[342.397958] Dynamic subtest rcs0: SUCCESS (0.008s)
[342.406991] Starting dynamic subtest: bcs0
[342.407936] Dynamic subtest bcs0: SUCCESS (0.006s)
[342.416113] Starting dynamic subtest: vcs0
[342.417187] Dynamic subtest vcs0: SUCCESS (0.007s)
[342.435442] Starting dynamic subtest: vcs1
[342.436464] Dynamic subtest vcs1: SUCCESS (0.008s)
[342.451627] Starting dynamic subtest: vecs0
[342.452782] Dynamic subtest vecs0: SUCCESS (0.004s)
[342.462540] Starting dynamic subtest: ccs0
[342.463468] Dynamic subtest ccs0: SUCCESS (0.005s)
[342.464370] Subtest exec-shared-gtt: SUCCESS (0.042s)
[342.633618] [062/134] (680s left) perf (invalid-oa-metric-set-id)
[342.762459] Starting subtest: invalid-oa-metric-set-id
[342.773324] Subtest invalid-oa-metric-set-id: SUCCESS (0.011s)
[342.814559] [063/134] (680s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-signaled)
[342.870219] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[342.871049] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[343.001253] [064/134] (680s left) gem_tiled_pread_pwrite
[343.123540] [065/134] (680s left) i915_pm_rps (thresholds-park)
[343.184078] Starting subtest: thresholds-park
[343.186086] Subtest thresholds-park: SKIP (0.001s)
[343.318273] [066/134] (680s left) gem_ctx_engines (invalid-engines)
[343.378320] Starting subtest: invalid-engines
[343.386205] Subtest invalid-engines: SUCCESS (0.008s)
[343.650696] [067/134] (679s left) vgem_basic (create)
[343.695127] Starting subtest: create
[343.696234] Subtest create: SUCCESS (0.000s)
[343.771439] [068/134] (679s left) kms_psr (fbc-psr2-sprite-mmap-cpu)
[343.864405] Starting subtest: fbc-psr2-sprite-mmap-cpu
[343.865321] Starting dynamic subtest: eDP-1
[343.867080] Dynamic subtest eDP-1: SKIP (0.000s)
[343.868712] Subtest fbc-psr2-sprite-mmap-cpu: SKIP (0.001s)
[343.956099] [069/134] (679s left) gem_mmap_gtt (big-copy-odd)
[344.008273] Subtest big-copy-odd: SKIP (0.000s)
[344.070893] [070/134] (679s left) gem_exec_reloc (basic-gtt-cpu-active)
[344.127975] Subtest basic-gtt-cpu-active: SKIP (0.000s)
[344.205240] [071/134] (679s left) prime_busy (before-wait)
[344.262428] Starting subtest: before-wait
[344.264346] Starting dynamic subtest: rcs0
[344.315956] Dynamic subtest rcs0: SUCCESS (0.051s)
[344.331877] Starting dynamic subtest: bcs0
[344.379967] Dynamic subtest bcs0: SUCCESS (0.062s)
[344.388774] Starting dynamic subtest: vcs0
[344.422753] Dynamic subtest vcs0: SUCCESS (0.042s)
[344.435588] Starting dynamic subtest: vcs1
[344.466538] Dynamic subtest vcs1: SUCCESS (0.042s)
[344.474950] Starting dynamic subtest: vecs0
[344.507041] Dynamic subtest vecs0: SUCCESS (0.040s)
[344.516274] Starting dynamic subtest: ccs0
[344.548575] Dynamic subtest ccs0: SUCCESS (0.041s)
[344.656640] Subtest before-wait: SUCCESS (0.393s)
[344.748279] [072/134] (678s left) gem_exec_fence (keep-in-fence)
[344.938353] Starting subtest: keep-in-fence
[344.939462] Starting dynamic subtest: rcs0
[344.994043] Dynamic subtest rcs0: SUCCESS (0.056s)
[345.005562] Starting dynamic subtest: bcs0
[345.047304] Dynamic subtest bcs0: SUCCESS (0.051s)
[345.058080] Starting dynamic subtest: vcs0
[346.904730] Dynamic subtest vcs0: SUCCESS (1.853s)
[346.914956] Starting dynamic subtest: vcs1
[348.889947] Dynamic subtest vcs1: SUCCESS (1.982s)
[348.900742] Starting dynamic subtest: vecs0
[350.873788] Dynamic subtest vecs0: SUCCESS (1.981s)
[350.884547] Starting dynamic subtest: ccs0
[351.105474] Dynamic subtest ccs0: SUCCESS (0.231s)
[351.106843] Subtest keep-in-fence: SUCCESS (6.168s)
[353.057024] [073/134] (670s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-blt)
[353.148528] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-blt
[356.866762] Subtest fbc-1p-primscrn-spr-indfb-draw-blt: SUCCESS (3.718s)
[358.035911] [074/134] (665s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[358.138819] Starting subtest: 4-tiled-8bpp-rotate-270
[358.162270] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.023s)
[358.328734] [075/134] (665s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf)
[363.291132] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf
[363.293023] Starting dynamic subtest: pipe-A-eDP-1
[364.077742] Dynamic subtest pipe-A-eDP-1: SKIP (0.784s)
[364.086915] Starting dynamic subtest: pipe-B-eDP-1
[365.206962] Dynamic subtest pipe-B-eDP-1: SKIP (1.127s)
[365.208607] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (1.916s)
[366.410361] [076/134] (657s left) gem_ccs (block-multicopy-inplace)
[366.463129] Starting subtest: block-multicopy-inplace
[366.464872] Subtest block-multicopy-inplace: SKIP (0.000s)
[366.592556] [077/134] (657s left) kms_big_fb (x-tiled-addfb-size-offset-overflow)
[366.700471] Starting subtest: x-tiled-addfb-size-offset-overflow
[366.701422] Subtest x-tiled-addfb-size-offset-overflow: SUCCESS (0.000s)
[366.807157] [078/134] (656s left) kms_atomic (crtc-invalid-params)
[366.888090] Starting subtest: crtc-invalid-params
[366.888899] Starting dynamic subtest: pipe-A-eDP-1
[367.244070] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.355s)
[367.245058] Subtest crtc-invalid-params: SUCCESS (0.357s)
[368.143998] [079/134] (655s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[368.238372] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[368.239337] Starting dynamic subtest: pipe-A-eDP-1
[368.259534] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.021s)
[368.268454] Starting dynamic subtest: pipe-B-eDP-1
[368.281174] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.020s)
[368.289827] Starting dynamic subtest: pipe-C-eDP-1
[368.301966] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.020s)
[368.310837] Starting dynamic subtest: pipe-D-eDP-1
[368.322831] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.019s)
[368.323790] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SUCCESS (0.086s)
[370.602401] [080/134] (653s left) gem_lmem_swapping (heavy-verify-multi)
[370.637529] Subtest heavy-verify-multi: SKIP (0.000s)
[370.675864] [081/134] (653s left) kms_chamelium_frames (hdmi-crc-fast)
[371.056431] Subtest hdmi-crc-fast: SKIP (0.000s)
[371.889337] [082/134] (651s left) kms_vblank (query-forked-busy-hang)
[371.983100] Starting subtest: query-forked-busy-hang
[371.983905] Starting dynamic subtest: pipe-A-eDP-1
[398.685983] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.702s)
[398.696221] Starting dynamic subtest: pipe-D-eDP-1
[413.719357] Dynamic subtest pipe-D-eDP-1: SUCCESS (15.029s)
[413.720276] Subtest query-forked-busy-hang: SUCCESS (41.736s)
[414.581684] [083/134] (609s left) kms_big_fb (linear-16bpp-rotate-90)
[414.688801] Starting subtest: linear-16bpp-rotate-90
[414.712730] Subtest linear-16bpp-rotate-90: SKIP (0.024s)
[414.862303] [084/134] (609s left) gem_flink_race (flink_close)
[414.894399] Starting subtest: flink_close
[419.994426] Subtest flink_close: SUCCESS (5.102s)
[420.098806] [085/134] (603s left) kms_frontbuffer_tracking (fbcpsr-modesetfrombusy)
[420.202905] Starting subtest: fbcpsr-modesetfrombusy
[426.301015] Subtest fbcpsr-modesetfrombusy: SUCCESS (6.099s)
[426.480346] [086/134] (597s left) gem_exec_schedule (thriceslice)
[426.544953] Starting subtest: thriceslice
[426.545845] Starting dynamic subtest: rcs0
[426.574904] Dynamic subtest rcs0: SUCCESS (0.030s)
[426.584306] Starting dynamic subtest: bcs0
[426.604048] Dynamic subtest bcs0: SUCCESS (0.029s)
[426.611928] Starting dynamic subtest: vcs0
[426.635962] Dynamic subtest vcs0: SUCCESS (0.031s)
[426.645103] Starting dynamic subtest: vcs1
[426.687843] Dynamic subtest vcs1: SUCCESS (0.049s)
[426.697235] Starting dynamic subtest: vecs0
[426.739823] Dynamic subtest vecs0: SUCCESS (0.050s)
[426.750679] Starting dynamic subtest: ccs0
[426.770990] Dynamic subtest ccs0: SUCCESS (0.029s)
[426.771896] Subtest thriceslice: SUCCESS (0.228s)
[427.089940] [087/134] (596s left) kms_flip (flip-vs-dpms-off-vs-modeset)
[427.168602] Starting subtest: flip-vs-dpms-off-vs-modeset
[427.170847] Starting dynamic subtest: A-eDP1
[430.704580] Dynamic subtest A-eDP1: SUCCESS (3.533s)
[430.712852] Starting dynamic subtest: B-eDP1
[433.909959] Dynamic subtest B-eDP1: SUCCESS (3.204s)
[433.917832] Starting dynamic subtest: C-eDP1
[437.115381] Dynamic subtest C-eDP1: SUCCESS (3.205s)
[437.123276] Starting dynamic subtest: D-eDP1
[440.226697] Dynamic subtest D-eDP1: SUCCESS (3.110s)
[440.227943] Subtest flip-vs-dpms-off-vs-modeset: SUCCESS (13.059s)
[441.044192] [088/134] (583s left) i915_pm_rps (min-max-config-idle)
[441.113366] Starting subtest: min-max-config-idle
[441.115256] Subtest min-max-config-idle: SKIP (0.000s)
[441.252115] [089/134] (582s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[441.356489] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[447.819372] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.461s)
[447.972998] [090/134] (576s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-sf)
[452.930234] Starting subtest: psr2-overlay-plane-move-continuous-sf
[452.931488] Starting dynamic subtest: pipe-A-eDP-1
[459.606708] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.675s)
[459.614524] Starting dynamic subtest: pipe-B-eDP-1
[466.263219] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.655s)
[466.264085] Subtest psr2-overlay-plane-move-continuous-sf: SUCCESS (13.334s)
[467.161869] [091/134] (557s left) kms_concurrent (multi-plane-atomic-lowres)
[467.258352] Starting subtest: multi-plane-atomic-lowres
[467.259193] Starting dynamic subtest: pipe-A-eDP-1
[467.777170] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.518s)
[467.778072] Subtest multi-plane-atomic-lowres: SUCCESS (0.519s)
[468.593788] [092/134] (555s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[468.673828] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-gtt
[468.675518] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[468.786987] [093/134] (555s left) api_intel_allocator (reopen)
[468.841851] Starting subtest: reopen
[468.845988] Subtest reopen: SUCCESS (0.005s)
[469.005328] [094/134] (555s left) kms_flip (dpms-vs-vblank-race)
[469.103097] Starting subtest: dpms-vs-vblank-race
[469.105018] Starting dynamic subtest: A-eDP1
[474.053032] Dynamic subtest A-eDP1: SUCCESS (4.948s)
[474.060916] Starting dynamic subtest: B-eDP1
[477.566325] Dynamic subtest B-eDP1: SUCCESS (3.511s)
[477.574552] Starting dynamic subtest: C-eDP1
[482.175031] Dynamic subtest C-eDP1: SUCCESS (4.609s)
[482.182790] Starting dynamic subtest: D-eDP1
[485.689344] Dynamic subtest D-eDP1: SUCCESS (3.513s)
[485.691523] Subtest dpms-vs-vblank-race: SUCCESS (16.589s)
[486.586275] [095/134] (537s left) syncobj_timeline (single-wait-all-available-signaled)
[486.638720] Starting subtest: single-wait-all-available-signaled
[486.639733] Subtest single-wait-all-available-signaled: SUCCESS (0.000s)
[486.772077] [096/134] (537s left) kms_atomic_transition (plane-all-modeset-transition-fencing-internal-panels)
[486.858404] Starting subtest: plane-all-modeset-transition-fencing-internal-panels
[486.859305] Starting dynamic subtest: pipe-A-eDP-1
[488.212885] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.352s)
[488.488956] Starting dynamic subtest: pipe-B-eDP-1
[489.540601] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.058s)
[489.812469] Subtest plane-all-modeset-transition-fencing-internal-panels: SUCCESS (2.953s)
[490.654924] [097/134] (533s left) gem_exec_params (rs-invalid)
[490.716249] Starting subtest: rs-invalid
[490.719047] Subtest rs-invalid: SUCCESS (0.003s)
[490.875825] [098/134] (533s left) kms_scaling_modes (scaling-mode-full-aspect)
[490.965294] Starting subtest: scaling-mode-full-aspect
[490.966215] Starting dynamic subtest: pipe-A-eDP-1
[491.057802] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.092s)
[491.068292] Starting dynamic subtest: pipe-B-eDP-1
[492.268988] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.209s)
[492.279052] Starting dynamic subtest: pipe-C-eDP-1
[493.383999] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.112s)
[493.393559] Starting dynamic subtest: pipe-D-eDP-1
[494.524622] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.139s)
[494.525551] Subtest scaling-mode-full-aspect: SUCCESS (3.560s)
[495.704252] [099/134] (528s left) kms_plane (plane-panning-top-left)
[495.802066] Starting subtest: plane-panning-top-left
[495.802903] Starting dynamic subtest: pipe-A
[497.426992] Dynamic subtest pipe-A: SUCCESS (1.623s)
[497.443742] Starting dynamic subtest: pipe-B
[499.722880] Dynamic subtest pipe-B: SUCCESS (2.294s)
[499.723691] Subtest plane-panning-top-left: SUCCESS (3.920s)
[500.537257] [100/134] (523s left) kms_psr (psr2-sprite-mmap-cpu)
[500.646892] Starting subtest: psr2-sprite-mmap-cpu
[500.648889] Starting dynamic subtest: eDP-1
[502.422950] Dynamic subtest eDP-1: SUCCESS (1.774s)
[502.424347] Subtest psr2-sprite-mmap-cpu: SUCCESS (1.775s)
[503.314642] [101/134] (521s left) gem_exec_params (rel-constants-invalid-ring)
[503.373444] Starting subtest: rel-constants-invalid-ring
[503.374442] Subtest rel-constants-invalid-ring: SUCCESS (0.000s)
[503.482225] [102/134] (521s left) i915_query (query-garbage)
[503.536182] Starting subtest: query-garbage
[503.537063] Subtest query-garbage: SUCCESS (0.000s)
[503.653550] [103/134] (520s left) kms_psr (psr-cursor-mmap-cpu)
[503.734059] Starting subtest: psr-cursor-mmap-cpu
[503.734865] Starting dynamic subtest: eDP-1
[505.488336] Dynamic subtest eDP-1: SUCCESS (1.752s)
[505.489243] Subtest psr-cursor-mmap-cpu: SUCCESS (1.753s)
[506.365517] [104/134] (518s left) kms_big_fb (y-tiled-16bpp-rotate-90)
[506.477800] Starting subtest: y-tiled-16bpp-rotate-90
[506.479602] Subtest y-tiled-16bpp-rotate-90: SKIP (0.000s)
[506.609931] [105/134] (518s left) kms_ccs (crc-primary-suspend-4-tiled-bmg-ccs)
[506.712567] Starting subtest: crc-primary-suspend-4-tiled-bmg-ccs
[506.714567] Subtest crc-primary-suspend-4-tiled-bmg-ccs: SKIP (0.000s)
[507.881996] [106/134] (516s left) kms_cursor_legacy (flip-vs-cursor-legacy)
[508.004807] Starting subtest: flip-vs-cursor-legacy
[515.086852] Subtest flip-vs-cursor-legacy: SUCCESS (7.079s)
[515.920470] [107/134] (508s left) kms_frontbuffer_tracking (fbcpsr-argb161616f-draw-blt)
[516.017297] Starting subtest: fbcpsr-argb161616f-draw-blt
[516.019141] Subtest fbcpsr-argb161616f-draw-blt: SKIP (0.000s)
[516.140561] [108/134] (508s left) kms_flip (flip-vs-fences)
[516.222646] Starting subtest: flip-vs-fences
[516.224756] Subtest flip-vs-fences: SKIP (0.000s)
[516.357905] [109/134] (508s left) gem_exec_reloc (basic-gtt-cpu-noreloc)
[516.416920] Subtest basic-gtt-cpu-noreloc: SKIP (0.000s)
[516.498056] [110/134] (508s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs-cc)
[516.587739] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs-cc
[516.588738] Starting dynamic subtest: pipe-A-eDP-1
[517.420375] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.830s)
[517.428242] Starting dynamic subtest: pipe-B-eDP-1
[518.916134] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.494s)
[518.928743] Starting dynamic subtest: pipe-C-eDP-1
[520.484249] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.566s)
[520.492037] Starting dynamic subtest: pipe-D-eDP-1
[521.987863] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.502s)
[521.988854] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.398s)
[523.255583] [111/134] (501s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-gtt)
[523.357820] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-gtt
[523.359467] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[523.464264] [112/134] (501s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs)
[523.561240] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs
[523.562260] Starting dynamic subtest: pipe-A-eDP-1
[524.299107] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.736s)
[524.307776] Starting dynamic subtest: pipe-B-eDP-1
[526.076035] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.776s)
[526.084085] Starting dynamic subtest: pipe-C-eDP-1
[527.909919] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.832s)
[527.918743] Starting dynamic subtest: pipe-D-eDP-1
[529.748942] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.838s)
[529.749918] Subtest random-ccs-data-4-tiled-mtl-rc-ccs: SUCCESS (6.186s)
[530.899507] [113/134] (494s left) i915_drm_fdinfo (memory-info-shared)
[530.933423] Starting subtest: memory-info-shared
[530.934310] Starting dynamic subtest: smem0
[530.984436] Dynamic subtest smem0: SUCCESS (0.050s)
[530.985600] Subtest memory-info-shared: SUCCESS (0.051s)
[531.078900] [114/134] (493s left) gem_exec_flush (basic-wb-set-default)
[531.130423] Starting subtest: basic-wb-set-default
[536.583134] Subtest basic-wb-set-default: SUCCESS (5.453s)
[536.784953] [115/134] (488s left) sysfs_timeslice_duration (timeout)
[536.846851] Starting subtest: timeout
[536.848021] Starting dynamic subtest: vecs0
[546.921452] Dynamic subtest vecs0: SUCCESS (10.073s)
[546.932242] Starting dynamic subtest: ccs0
[548.367334] Dynamic subtest ccs0: SUCCESS (1.442s)
[548.377729] Starting dynamic subtest: vcs0
[557.920660] Dynamic subtest vcs0: SUCCESS (9.548s)
[557.930884] Starting dynamic subtest: bcs0
[558.627510] Dynamic subtest bcs0: SUCCESS (0.708s)
[558.638940] Starting dynamic subtest: rcs0
[560.022465] Dynamic subtest rcs0: SUCCESS (1.392s)
[560.032088] Starting dynamic subtest: vcs1
[569.959415] Dynamic subtest vcs1: SUCCESS (9.932s)
[569.960690] Subtest timeout: SUCCESS (33.108s)
[570.052034] [116/134] (454s left) sriov_basic (enable-vfs-bind-unbind-each)
[570.100972] Starting subtest: enable-vfs-bind-unbind-each
[570.101956] Starting dynamic subtest: numvfs-1
[570.135557] Dynamic subtest numvfs-1: FAIL (0.017s)
[570.144122] Starting dynamic subtest: numvfs-2
[570.171629] Dynamic subtest numvfs-2: FAIL (0.004s)
[570.179186] Starting dynamic subtest: numvfs-3
[570.206570] Dynamic subtest numvfs-3: FAIL (0.004s)
[570.214514] Starting dynamic subtest: numvfs-4
[570.242826] Dynamic subtest numvfs-4: FAIL (0.004s)
[570.250884] Starting dynamic subtest: numvfs-5
[570.278234] Dynamic subtest numvfs-5: FAIL (0.003s)
[570.285371] Starting dynamic subtest: numvfs-6
[570.313481] Dynamic subtest numvfs-6: FAIL (0.004s)
[570.320630] Starting dynamic subtest: numvfs-7
[570.349304] Dynamic subtest numvfs-7: FAIL (0.003s)
[570.356688] Starting dynamic subtest: numvfs-random
[570.385256] Dynamic subtest numvfs-random: FAIL (0.004s)
[570.386111] Subtest enable-vfs-bind-unbind-each: FAIL (0.047s)
[570.414422] [117/134] (454s left) kms_ccs (bad-rotation-90-4-tiled-lnl-ccs)
[570.513927] Starting subtest: bad-rotation-90-4-tiled-lnl-ccs
[570.515731] Subtest bad-rotation-90-4-tiled-lnl-ccs: SKIP (0.000s)
[571.623971] [118/134] (453s left) kms_getfb (getfb-handle-not-fb)
[571.715077] Starting subtest: getfb-handle-not-fb
[571.715899] Subtest getfb-handle-not-fb: SUCCESS (0.000s)
[571.845189] [119/134] (453s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-mc-ccs)
[571.907760] Starting subtest: y-tiled-ccs-to-yf-tiled-mc-ccs
[571.909608] Subtest y-tiled-ccs-to-yf-tiled-mc-ccs: SKIP (0.000s)
[572.112211] [120/134] (453s left) gem_workarounds (reset-context)
[572.177819] Starting subtest: reset-context
[572.345095] Subtest reset-context: SUCCESS (0.169s)
[572.500262] [121/134] (452s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[572.595475] Starting subtest: psr-farfromfence-mmap-gtt
[572.597203] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[572.707052] [122/134] (452s left) gem_wait (write-busy)
[572.776301] Starting subtest: write-busy
[572.777305] Starting dynamic subtest: all-engines
[573.396030] Dynamic subtest all-engines: SUCCESS (0.619s)
[573.413129] Starting dynamic subtest: rcs0
[573.951568] Dynamic subtest rcs0: SUCCESS (0.553s)
[573.967433] Starting dynamic subtest: bcs0
[574.502104] Dynamic subtest bcs0: SUCCESS (0.549s)
[574.517520] Starting dynamic subtest: vcs0
[575.896072] Dynamic subtest vcs0: SUCCESS (1.390s)
[575.911382] Starting dynamic subtest: vcs1
[577.878073] Dynamic subtest vcs1: SUCCESS (1.981s)
[577.894668] Starting dynamic subtest: vecs0
[579.928112] Dynamic subtest vecs0: SUCCESS (2.045s)
[579.943594] Starting dynamic subtest: ccs0
[580.478020] Dynamic subtest ccs0: SUCCESS (0.550s)
[580.479438] Subtest write-busy: SUCCESS (7.701s)
[580.691449] [123/134] (444s left) i915_hangman (detector)
[580.762510] Starting subtest: detector
[580.763396] Starting dynamic subtest: rcs0
[591.862238] Dynamic subtest rcs0: SUCCESS (11.097s)
[591.874693] Starting dynamic subtest: bcs0
[602.869398] Dynamic subtest bcs0: SUCCESS (11.004s)
[602.881662] Starting dynamic subtest: vcs0
[614.839447] Dynamic subtest vcs0: SUCCESS (11.965s)
[614.850265] Starting dynamic subtest: vcs1
[625.845232] Dynamic subtest vcs1: SUCCESS (11.004s)
[625.857503] Starting dynamic subtest: vecs0
[637.834947] Dynamic subtest vecs0: SUCCESS (11.963s)
[637.843060] Starting dynamic subtest: ccs0
[647.863068] Dynamic subtest ccs0: SUCCESS (10.048s)
[647.864524] Subtest detector: SUCCESS (67.095s)
[647.963775] [124/134] (377s left) kms_frontbuffer_tracking (fbcpsr-2p-pri-indfb-multidraw)
[648.061177] Starting subtest: fbcpsr-2p-pri-indfb-multidraw
[648.062795] Subtest fbcpsr-2p-pri-indfb-multidraw: SKIP (0.000s)
[648.202264] [125/134] (377s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions-varying-size)
[648.320477] Starting subtest: cursorA-vs-flipB-atomic-transitions-varying-size
[648.322136] Subtest cursorA-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s)
[648.484548] [126/134] (376s left) gem_mmap_gtt (basic-write-cpu-read-gtt)
[648.536720] Subtest basic-write-cpu-read-gtt: SKIP (0.000s)
[648.592410] [127/134] (376s left) gem_exec_schedule (noreorder-corked)
[648.764528] Starting subtest: noreorder-corked
[648.765535] Starting dynamic subtest: rcs0
[649.918104] Dynamic subtest rcs0: SUCCESS (1.153s)
[649.929663] Starting dynamic subtest: vcs0
[651.934406] Dynamic subtest vcs0: SUCCESS (2.013s)
[651.946510] Starting dynamic subtest: vcs1
[653.895650] Dynamic subtest vcs1: SUCCESS (1.958s)
[653.906468] Starting dynamic subtest: vecs0
[655.927337] Dynamic subtest vecs0: SUCCESS (2.027s)
[655.937983] Starting dynamic subtest: ccs0
[657.105949] Dynamic subtest ccs0: SUCCESS (1.178s)
[657.107469] Subtest noreorder-corked: SUCCESS (8.342s)
[657.309547] [128/134] (368s left) kms_psr (pr-cursor-mmap-cpu)
[657.403245] Starting subtest: pr-cursor-mmap-cpu
[657.404999] Subtest pr-cursor-mmap-cpu: SKIP (0.000s)
[657.497500] [129/134] (367s left) perf (invalid-oa-format-id)
[657.602502] Starting subtest: invalid-oa-format-id
[657.611512] Subtest invalid-oa-format-id: SUCCESS (0.009s)
[657.645953] [130/134] (367s left) gem_eio (in-flight-internal-immediate)
[657.842093] Starting subtest: in-flight-internal-immediate
[658.966722] Subtest in-flight-internal-immediate: SUCCESS (1.125s)
[659.138196] [131/134] (366s left) kms_cursor_edge_walk (256x256-top-edge)
[659.225503] Starting subtest: 256x256-top-edge
[659.226429] Starting dynamic subtest: pipe-A-eDP-1
[662.673118] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.448s)
[662.682244] Starting dynamic subtest: pipe-D-eDP-1
[665.799148] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.125s)
[665.799995] Subtest 256x256-top-edge: SUCCESS (6.575s)
[666.619610] [132/134] (358s left) gem_ctx_persistence (engines-persistence)
[666.690560] Starting subtest: engines-persistence
[666.691545] Starting dynamic subtest: rcs0
[667.512308] Dynamic subtest rcs0: SUCCESS (0.820s)
[667.524922] Starting dynamic subtest: bcs0
[668.292649] Dynamic subtest bcs0: SUCCESS (0.777s)
[668.303259] Starting dynamic subtest: vcs0
[669.169705] Dynamic subtest vcs0: SUCCESS (0.875s)
[669.181545] Starting dynamic subtest: vcs1
[669.997517] Dynamic subtest vcs1: SUCCESS (0.824s)
[670.009294] Starting dynamic subtest: vecs0
[670.835631] Dynamic subtest vecs0: SUCCESS (0.835s)
[670.847710] Starting dynamic subtest: ccs0
[671.622467] Dynamic subtest ccs0: SUCCESS (0.784s)
[671.625495] Subtest engines-persistence: SUCCESS (4.933s)
[671.794458] [133/134] (353s left) api_intel_bb (render-ccs)
[671.841147] Starting subtest: render-ccs
[672.211457] Subtest render-ccs: SUCCESS (0.368s)
[672.375508] [134/134] (353s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-plflip-blt)
[672.464066] Starting subtest: fbcpsr-2p-primscrn-shrfb-plflip-blt
[672.465782] Subtest fbcpsr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[672.596941] Closing watchdogs
results: parsing output: 0/ for test: kms_plane_scaling
results: parsing output: 1/ for test: gem_userptr_blits
results: parsing output: 2/ for test: gem_mmap_gtt
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: kms_fence_pin_leak
results: parsing output: 5/ for test: kms_big_fb
results: parsing output: 6/ for test: gem_mmap_wc
results: parsing output: 7/ for test: kms_flip
results: parsing output: 8/ for test: perf_pmu
results: parsing output: 9/ for test: gem_mmap_wc
results: parsing output: 10/ for test: kms_big_fb
results: parsing output: 11/ for test: kms_busy
results: parsing output: 12/ for test: kms_plane_alpha_blend
results: parsing output: 13/ for test: sysfs_timeslice_duration
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_cursor_crc
results: parsing output: 16/ for test: kms_color
results: parsing output: 17/ for test: gem_partial_pwrite_pread
results: parsing output: 18/ for test: dumb_buffer
results: parsing output: 19/ for test: gem_mmap_gtt
results: parsing output: 20/ for test: kms_cursor_legacy
results: parsing output: 21/ for test: gem_lmem_swapping
results: parsing output: 22/ for test: gem_spin_batch
results: parsing output: 23/ for test: kms_cursor_crc
results: parsing output: 24/ for test: kms_properties
results: parsing output: 25/ for test: kms_vrr
results: parsing output: 26/ for test: gem_exec_params
results: parsing output: 27/ for test: gem_exec_balancer
results: parsing output: 28/ for test: kms_pm_dc
results: parsing output: 29/ for test: kms_frontbuffer_tracking
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: gem_exec_whisper
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: gem_render_copy_redux
results: parsing output: 36/ for test: gem_mmap_wc
results: parsing output: 37/ for test: gem_pxp
results: parsing output: 38/ for test: kms_3d
results: parsing output: 39/ for test: gem_ctx_persistence
results: parsing output: 40/ for test: kms_psr
results: parsing output: 41/ for test: syncobj_timeline
results: parsing output: 42/ for test: kms_flip_scaled_crc
results: parsing output: 43/ for test: kms_flip_scaled_crc
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: vgem_basic
results: parsing output: 46/ for test: gem_userptr_blits
results: parsing output: 47/ for test: kms_chamelium_hpd
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: kms_lease
results: parsing output: 52/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 53/ for test: kms_dp_link_training
results: parsing output: 54/ for test: syncobj_timeline
results: parsing output: 55/ for test: kms_invalid_mode
results: parsing output: 56/ for test: kms_pm_rpm
results: parsing output: 57/ for test: gem_exec_balancer
results: parsing output: 58/ for test: kms_psr2_sf
results: parsing output: 59/ for test: gen9_exec_parse
results: parsing output: 60/ for test: gem_ctx_shared
results: parsing output: 61/ for test: perf
results: parsing output: 62/ for test: syncobj_timeline
results: parsing output: 63/ for test: gem_tiled_pread_pwrite
results: parsing output: 64/ for test: i915_pm_rps
results: parsing output: 65/ for test: gem_ctx_engines
results: parsing output: 66/ for test: vgem_basic
results: parsing output: 67/ for test: kms_psr
results: parsing output: 68/ for test: gem_mmap_gtt
results: parsing output: 69/ for test: gem_exec_reloc
results: parsing output: 70/ for test: prime_busy
results: parsing output: 71/ for test: gem_exec_fence
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_big_fb
results: parsing output: 74/ for test: kms_psr2_sf
results: parsing output: 75/ for test: gem_ccs
results: parsing output: 76/ for test: kms_big_fb
results: parsing output: 77/ for test: kms_atomic
results: parsing output: 78/ for test: kms_ccs
results: parsing output: 79/ for test: gem_lmem_swapping
results: parsing output: 80/ for test: kms_chamelium_frames
results: parsing output: 81/ for test: kms_vblank
results: parsing output: 82/ for test: kms_big_fb
results: parsing output: 83/ for test: gem_flink_race
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: gem_exec_schedule
results: parsing output: 86/ for test: kms_flip
results: parsing output: 87/ for test: i915_pm_rps
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: kms_psr2_sf
results: parsing output: 90/ for test: kms_concurrent
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: api_intel_allocator
results: parsing output: 93/ for test: kms_flip
results: parsing output: 94/ for test: syncobj_timeline
results: parsing output: 95/ for test: kms_atomic_transition
results: parsing output: 96/ for test: gem_exec_params
results: parsing output: 97/ for test: kms_scaling_modes
results: parsing output: 98/ for test: kms_plane
results: parsing output: 99/ for test: kms_psr
results: parsing output: 100/ for test: gem_exec_params
results: parsing output: 101/ for test: i915_query
results: parsing output: 102/ for test: kms_psr
results: parsing output: 103/ for test: kms_big_fb
results: parsing output: 104/ for test: kms_ccs
results: parsing output: 105/ for test: kms_cursor_legacy
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_flip
results: parsing output: 108/ for test: gem_exec_reloc
results: parsing output: 109/ for test: kms_ccs
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_ccs
results: parsing output: 112/ for test: i915_drm_fdinfo
results: parsing output: 113/ for test: gem_exec_flush
results: parsing output: 114/ for test: sysfs_timeslice_duration
results: parsing output: 115/ for test: sriov_basic
results: parsing output: 116/ for test: kms_ccs
results: parsing output: 117/ for test: kms_getfb
results: parsing output: 118/ for test: gem_render_copy
results: parsing output: 119/ for test: gem_workarounds
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: gem_wait
results: parsing output: 122/ for test: i915_hangman
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_cursor_legacy
results: parsing output: 125/ for test: gem_mmap_gtt
results: parsing output: 126/ for test: gem_exec_schedule
results: parsing output: 127/ for test: kms_psr
results: parsing output: 128/ for test: perf
results: parsing output: 129/ for test: gem_eio
results: parsing output: 130/ for test: kms_cursor_edge_walk
results: parsing output: 131/ for test: gem_ctx_persistence
results: parsing output: 132/ for test: api_intel_bb
results: parsing output: 133/ for test: kms_frontbuffer_tracking
Done.