[62.520066] Initializing watchdogs
[62.520132]   /dev/watchdog0
[62.540835] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[62.551841] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[62.555569] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[62.558034] [001/134] (960s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-20x20)
[62.739338] Starting subtest: planes-downscale-factor-0-75-upscale-20x20
[62.740189] Starting dynamic subtest: pipe-A
[62.845700] Dynamic subtest pipe-A: SUCCESS (0.107s)
[62.855624] Starting dynamic subtest: pipe-B
[63.041382] Dynamic subtest pipe-B: SUCCESS (0.196s)
[63.050069] Starting dynamic subtest: pipe-C
[63.237692] Dynamic subtest pipe-C: SUCCESS (0.197s)
[63.250117] Starting dynamic subtest: pipe-D
[63.449573] Dynamic subtest pipe-D: SUCCESS (0.212s)
[63.450465] Subtest planes-downscale-factor-0-75-upscale-20x20: SUCCESS (0.713s)
[63.784571] [002/134] (959s left) gem_userptr_blits (forbidden-operations)
[63.872730] Starting subtest: forbidden-operations
[63.874417] Subtest forbidden-operations: SKIP (0.000s)
[64.053065] [003/134] (959s left) gem_mmap_gtt (big-bo)
[64.123081] Subtest big-bo: SKIP (0.000s)
[64.200248] [004/134] (959s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[64.382624] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[64.384256] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[64.568263] [005/134] (958s left) kms_fence_pin_leak
[64.830096] [006/134] (958s left) kms_big_fb (x-tiled-16bpp-rotate-180)
[65.020954] Starting subtest: x-tiled-16bpp-rotate-180
[66.817548] Subtest x-tiled-16bpp-rotate-180: SUCCESS (1.802s)
[67.566650] [007/134] (955s left) gem_mmap_wc (write-cpu-read-wc-unflushed)
[67.831204] Subtest write-cpu-read-wc-unflushed: SKIP (0.000s)
[67.923025] [008/134] (955s left) kms_flip (2x-flip-vs-expired-vblank-interruptible)
[68.108086] Starting subtest: 2x-flip-vs-expired-vblank-interruptible
[68.123640] Subtest 2x-flip-vs-expired-vblank-interruptible: SKIP (0.015s)
[68.283890] [009/134] (955s left) perf_pmu (busy-check-all)
[68.349918] Starting subtest: busy-check-all
[68.350868] Starting dynamic subtest: rcs0
[68.956966] Dynamic subtest rcs0: SUCCESS (0.608s)
[68.969467] Starting dynamic subtest: bcs0
[69.512550] Dynamic subtest bcs0: SUCCESS (0.555s)
[69.524183] Starting dynamic subtest: vcs0
[70.067474] Dynamic subtest vcs0: SUCCESS (0.555s)
[70.079279] Starting dynamic subtest: vcs1
[70.623161] Dynamic subtest vcs1: SUCCESS (0.555s)
[70.634518] Starting dynamic subtest: vecs0
[71.178673] Dynamic subtest vecs0: SUCCESS (0.555s)
[71.190525] Starting dynamic subtest: vecs1
[71.735937] Dynamic subtest vecs1: SUCCESS (0.557s)
[71.747055] Starting dynamic subtest: ccs0
[72.288414] Dynamic subtest ccs0: SUCCESS (0.553s)
[72.289429] Subtest busy-check-all: SUCCESS (3.945s)
[72.450910] [010/134] (951s left) gem_mmap_wc (coherency)
[72.518161] Subtest coherency: SKIP (0.000s)
[72.579425] [011/134] (951s left) kms_big_fb (yf-tiled-addfb)
[72.767268] Starting subtest: yf-tiled-addfb
[72.769123] Subtest yf-tiled-addfb: SKIP (0.000s)
[72.954580] [012/134] (950s left) kms_busy (extended-modeset-hang-oldfb-with-reset)
[73.152829] Starting subtest: extended-modeset-hang-oldfb-with-reset
[73.153649] Starting dynamic subtest: pipe-A
[83.845456] Dynamic subtest pipe-A: SUCCESS (10.694s)
[83.862949] Starting dynamic subtest: pipe-D
[94.556134] Dynamic subtest pipe-D: SUCCESS (10.705s)
[94.558733] Subtest extended-modeset-hang-oldfb-with-reset: SUCCESS (21.407s)
[94.885502] [013/134] (928s left) kms_plane_alpha_blend (constant-alpha-min)
[95.072919] Starting subtest: constant-alpha-min
[95.337362] Starting dynamic subtest: pipe-A-DP-3
[96.028985] Dynamic subtest pipe-A-DP-3: SUCCESS (0.691s)
[96.042037] Starting dynamic subtest: pipe-D-DP-3
[96.769296] Dynamic subtest pipe-D-DP-3: SUCCESS (0.738s)
[96.770163] Subtest constant-alpha-min: SUCCESS (1.696s)
[97.080930] [014/134] (926s left) sysfs_timeslice_duration (duration)
[97.154830] Starting subtest: duration
[97.155745] Starting dynamic subtest: vecs0
[110.327758] Dynamic subtest vecs0: SUCCESS (13.171s)
[110.339661] Starting dynamic subtest: ccs0
[123.465686] Dynamic subtest ccs0: SUCCESS (13.137s)
[123.476839] Starting dynamic subtest: vcs0
[136.607620] Dynamic subtest vcs0: SUCCESS (13.141s)
[136.618548] Starting dynamic subtest: bcs0
[149.749992] Dynamic subtest bcs0: SUCCESS (13.141s)
[149.761591] Starting dynamic subtest: vecs1
[162.896221] Dynamic subtest vecs1: SUCCESS (13.144s)
[162.907813] Starting dynamic subtest: rcs0
[176.039793] Dynamic subtest rcs0: SUCCESS (13.143s)
[176.051777] Starting dynamic subtest: vcs1
[189.168329] Dynamic subtest vcs1: SUCCESS (13.128s)
[189.169296] Subtest duration: SUCCESS (92.011s)
[189.286933] [015/134] (834s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-cpu)
[189.468602] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-cpu
[194.790521] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (5.322s)
[195.022354] [016/134] (828s left) kms_cursor_crc (cursor-onscreen-64x64)
[195.339704] Starting subtest: cursor-onscreen-64x64
[195.343938] Starting dynamic subtest: pipe-A-DP-3
[197.953658] Dynamic subtest pipe-A-DP-3: SUCCESS (2.609s)
[198.004153] Starting dynamic subtest: pipe-D-DP-3
[200.662961] Dynamic subtest pipe-D-DP-3: SUCCESS (2.667s)
[200.663998] Subtest cursor-onscreen-64x64: SUCCESS (5.323s)
[201.178509] [017/134] (822s left) kms_color (ctm-red-to-blue)
[201.355192] Starting subtest: ctm-red-to-blue
[201.356122] Starting dynamic subtest: pipe-A-DP-3
[202.027400] Dynamic subtest pipe-A-DP-3: SUCCESS (0.671s)
[202.040571] Starting dynamic subtest: pipe-B-DP-3
[202.659509] Dynamic subtest pipe-B-DP-3: SUCCESS (0.632s)
[202.670382] Starting dynamic subtest: pipe-C-DP-3
[203.245517] Dynamic subtest pipe-C-DP-3: SUCCESS (0.586s)
[203.256822] Starting dynamic subtest: pipe-D-DP-3
[203.851654] Dynamic subtest pipe-D-DP-3: SUCCESS (0.605s)
[203.852644] Subtest ctm-red-to-blue: SUCCESS (2.496s)
[204.171484] [018/134] (820s left) gem_partial_pwrite_pread (writes-after-reads-uncached)
[204.247618] Subtest writes-after-reads-uncached: SKIP (0.000s)
[204.327512] [019/134] (819s left) dumb_buffer (invalid-bpp)
[204.402048] Starting subtest: invalid-bpp
[204.402982] Subtest invalid-bpp: SUCCESS (0.000s)
[204.602204] [020/134] (819s left) gem_mmap_gtt (ptrace)
[204.673008] Subtest ptrace: SKIP (0.000s)
[204.745985] [021/134] (819s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions-varying-s
[204.930925] Starting subtest: short-busy-flip-before-cursor-atomic-transitions-varying-size
[204.932705] Subtest short-busy-flip-before-cursor-atomic-transitions-varying-size: SKIP (0.000s)
[205.088861] [022/134] (819s left) gem_lmem_swapping (verify)
[207.700409] Starting subtest: verify
[207.701216] Starting dynamic subtest: lmem0
[243.928269] Dynamic subtest lmem0: SUCCESS (36.228s)
[243.929202] Subtest verify: SUCCESS (36.228s)
[245.240549] [FACT gem_lmem_swapping (verify)] deleted: kernel.kmod_is_loaded.i915: true
[245.242892] [023/134] (779s left) gem_spin_batch (resubmit-new)
[246.839870] Starting subtest: resubmit-new
[246.841137] Starting dynamic subtest: rcs0
[246.881613] Dynamic subtest rcs0: SUCCESS (0.045s)
[246.891499] Starting dynamic subtest: bcs0
[246.892397] Dynamic subtest bcs0: SUCCESS (0.006s)
[246.902773] Starting dynamic subtest: vcs0
[246.903609] Dynamic subtest vcs0: SUCCESS (0.006s)
[246.913411] Starting dynamic subtest: vcs1
[246.914297] Dynamic subtest vcs1: SUCCESS (0.005s)
[246.923172] Starting dynamic subtest: vecs0
[246.924162] Dynamic subtest vecs0: SUCCESS (0.005s)
[246.933237] Starting dynamic subtest: vecs1
[246.934225] Dynamic subtest vecs1: SUCCESS (0.005s)
[246.943203] Starting dynamic subtest: ccs0
[246.944137] Dynamic subtest ccs0: SUCCESS (0.005s)
[246.945177] Subtest resubmit-new: SUCCESS (0.080s)
[247.217132] [FACT gem_spin_batch (resubmit-new)] new: kernel.kmod_is_loaded.i915: true
[247.219904] [024/134] (777s left) kms_cursor_crc (cursor-random-512x512)
[247.666906] Starting subtest: cursor-random-512x512
[247.668670] Subtest cursor-random-512x512: SKIP (0.001s)
[247.927234] [025/134] (776s left) kms_properties (plane-properties-legacy)
[248.105247] Starting subtest: plane-properties-legacy
[248.106199] Starting dynamic subtest: pipe-A-DP-3
[248.616272] Dynamic subtest pipe-A-DP-3: SUCCESS (0.509s)
[248.638238] Starting dynamic subtest: pipe-B-DP-3
[249.149977] Dynamic subtest pipe-B-DP-3: SUCCESS (0.531s)
[249.159598] Starting dynamic subtest: pipe-C-DP-3
[249.666935] Dynamic subtest pipe-C-DP-3: SUCCESS (0.516s)
[249.677698] Starting dynamic subtest: pipe-D-DP-3
[250.183418] Dynamic subtest pipe-D-DP-3: SUCCESS (0.515s)
[250.184276] Subtest plane-properties-legacy: SUCCESS (2.078s)
[250.470648] [026/134] (774s left) kms_vrr (flipline)
[250.646851] Starting subtest: flipline
[250.649475] Subtest flipline: SKIP (0.000s)
[250.804202] [027/134] (774s left) gem_exec_params (secure-non-master)
[250.884186] Starting subtest: secure-non-master
[250.886218] Subtest secure-non-master: SKIP (0.000s)
[251.040714] [028/134] (773s left) gem_exec_balancer (parallel-dmabuf-import-out-fence)
[251.431697] Starting subtest: parallel-dmabuf-import-out-fence
[253.754583] Subtest parallel-dmabuf-import-out-fence: SUCCESS (2.323s)
[253.932251] [029/134] (770s left) kms_pm_dc (dc5-dpms-negative)
[255.120101] Starting subtest: dc5-dpms-negative
[259.347843] Subtest dc5-dpms-negative: SUCCESS (4.227s)
[259.467377] [030/134] (765s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[259.652870] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[259.654511] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[259.836040] [031/134] (765s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite)
[260.019578] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite
[260.021232] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[260.219707] [032/134] (764s left) kms_frontbuffer_tracking (psr-argb161616f-draw-mmap-cpu)
[260.402585] Starting subtest: psr-argb161616f-draw-mmap-cpu
[260.404261] Subtest psr-argb161616f-draw-mmap-cpu: SKIP (0.000s)
[260.604288] [033/134] (764s left) gem_exec_whisper (basic-fds-all)
[260.687400] Starting subtest: basic-fds-all
[282.827203] Subtest basic-fds-all: SUCCESS (22.138s)
[283.124486] [034/134] (742s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[283.303887] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[283.305502] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[283.500136] [035/134] (741s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[283.677539] Starting subtest: psr-rgb565-draw-render
[283.679182] Subtest psr-rgb565-draw-render: SKIP (0.000s)
[283.866699] [036/134] (741s left) gem_render_copy_redux (flink)
[283.946043] Starting subtest: flink
[286.687495] Subtest flink: SUCCESS (2.742s)
[286.881424] [037/134] (738s left) gem_mmap_wc (bad-offset)
[286.957020] Subtest bad-offset: SKIP (0.000s)
[287.042381] [038/134] (738s left) gem_pxp (reject-modify-context-protection-off-2)
[289.641182] Starting subtest: reject-modify-context-protection-off-2
[289.643921] Subtest reject-modify-context-protection-off-2: SKIP (0.000s)
[289.783206] [039/134] (735s left) kms_3d (basic)
[289.855195] Starting subtest: basic
[291.861610] Subtest basic: SUCCESS (2.005s)
[292.308272] [040/134] (733s left) gem_ctx_persistence (smoketest)
[292.387279] Starting subtest: smoketest
[331.142569] Subtest smoketest: SUCCESS (38.754s)
[331.329409] [041/134] (694s left) kms_psr (fbc-pr-suspend)
[331.506710] Subtest fbc-pr-suspend: SKIP (0.000s)
[331.570201] [042/134] (694s left) syncobj_timeline (multi-wait-for-submit-signaled)
[331.639139] Starting subtest: multi-wait-for-submit-signaled
[331.640093] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[331.845665] [043/134] (694s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-upscaling)
[332.023167] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-upscaling
[332.024057] Starting dynamic subtest: pipe-A-valid-mode
[333.740643] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.717s)
[333.741504] Subtest flip-64bpp-4tile-to-32bpp-4tile-upscaling: SUCCESS (1.718s)
[334.068404] [044/134] (691s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling)
[334.246602] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-upscaling
[334.248831] Starting dynamic subtest: pipe-A-valid-mode
[336.527559] Dynamic subtest pipe-A-valid-mode: SUCCESS (2.276s)
[336.529102] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SUCCESS (2.279s)
[336.841475] [045/134] (689s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-cpu)
[337.025911] Starting subtest: psr-rgb565-draw-mmap-cpu
[337.027605] Subtest psr-rgb565-draw-mmap-cpu: SKIP (0.000s)
[337.221949] [046/134] (688s left) vgem_basic (mmap)
[337.360291] Starting subtest: mmap
[337.366513] Subtest mmap: SUCCESS (0.007s)
[337.482172] [FACT vgem_basic (mmap)] new: kernel.kmod_is_loaded.vgem: true
[337.484371] [047/134] (688s left) gem_userptr_blits (sync-unmap-after-close)
[337.575052] Starting subtest: sync-unmap-after-close
[337.596419] Subtest sync-unmap-after-close: SUCCESS (0.021s)
[337.835877] [048/134] (688s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode)
[338.103039] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s)
[338.253145] [049/134] (688s left) kms_frontbuffer_tracking (basic)
[338.449983] Starting subtest: basic
[341.146574] Subtest basic: SUCCESS (2.697s)
[341.396100] [050/134] (685s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[341.589927] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[341.591626] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[341.781260] [051/134] (684s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-blt)
[341.969743] Starting subtest: fbc-rgb101010-draw-blt
[344.863507] Subtest fbc-rgb101010-draw-blt: SUCCESS (2.894s)
[345.028938] [052/134] (681s left) kms_lease (lease-unleased-connector)
[345.211766] Starting subtest: lease-unleased-connector
[345.214050] Starting dynamic subtest: pipe-A-DP-3
[345.316512] Dynamic subtest pipe-A-DP-3: SUCCESS (0.102s)
[345.326898] Starting dynamic subtest: pipe-B-DP-3
[345.420315] Dynamic subtest pipe-B-DP-3: SUCCESS (0.103s)
[345.432443] Starting dynamic subtest: pipe-C-DP-3
[345.525971] Dynamic subtest pipe-C-DP-3: SUCCESS (0.104s)
[345.538158] Starting dynamic subtest: pipe-D-DP-3
[345.628748] Dynamic subtest pipe-D-DP-3: SUCCESS (0.101s)
[345.629573] Subtest lease-unleased-connector: SUCCESS (0.418s)
[345.789347] [053/134] (680s left) gem_tiled_partial_pwrite_pread (reads)
[345.875332] Subtest reads: SKIP (0.000s)
[345.962394] [054/134] (680s left) kms_dp_link_training (uhbr-sst)
[346.144493] Starting subtest: uhbr-sst
[346.146272] Subtest uhbr-sst: SKIP (0.000s)
[346.324698] [055/134] (680s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[346.403435] Starting subtest: etime-multi-wait-all-submitted-signaled
[346.510328] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.105s)
[346.658654] [056/134] (680s left) kms_invalid_mode (overflow-vrefresh)
[346.843264] Starting subtest: overflow-vrefresh
[346.844174] Starting dynamic subtest: pipe-A-DP-3
[346.920218] Dynamic subtest pipe-A-DP-3: SUCCESS (0.075s)
[346.932716] Starting dynamic subtest: pipe-B-DP-3
[346.933840] Dynamic subtest pipe-B-DP-3: SUCCESS (0.001s)
[346.945801] Starting dynamic subtest: pipe-C-DP-3
[346.946726] Dynamic subtest pipe-C-DP-3: SUCCESS (0.001s)
[346.958655] Starting dynamic subtest: pipe-D-DP-3
[346.959550] Dynamic subtest pipe-D-DP-3: SUCCESS (0.001s)
[346.960432] Subtest overflow-vrefresh: SUCCESS (0.085s)
[347.197100] [057/134] (679s left) kms_pm_rpm (i2c)
[348.991820] Starting subtest: i2c
[350.250246] Subtest i2c: SUCCESS (1.256s)
[350.534626] [058/134] (676s left) gem_exec_balancer (busy)
[350.621188] Starting subtest: busy
[351.538488] Subtest busy: SUCCESS (0.917s)
[351.977188] [059/134] (675s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-sf)
[352.169551] Subtest fbc-pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[352.222693] [060/134] (674s left) gen9_exec_parse (batch-without-end)
[352.303164] Subtest batch-without-end: SKIP (0.000s)
[352.395126] [061/134] (674s left) gem_ctx_shared (exec-shared-gtt)
[352.483558] Starting subtest: exec-shared-gtt
[352.484472] Starting dynamic subtest: rcs0
[352.493058] Dynamic subtest rcs0: SUCCESS (0.009s)
[352.504190] Starting dynamic subtest: bcs0
[352.505162] Dynamic subtest bcs0: SUCCESS (0.008s)
[352.516209] Starting dynamic subtest: vcs0
[352.517181] Dynamic subtest vcs0: SUCCESS (0.007s)
[352.528450] Starting dynamic subtest: vcs1
[352.529847] Dynamic subtest vcs1: SUCCESS (0.007s)
[352.540982] Starting dynamic subtest: vecs0
[352.541941] Dynamic subtest vecs0: SUCCESS (0.007s)
[352.553235] Starting dynamic subtest: vecs1
[352.554524] Dynamic subtest vecs1: SUCCESS (0.006s)
[352.565630] Starting dynamic subtest: ccs0
[352.566774] Dynamic subtest ccs0: SUCCESS (0.007s)
[352.567907] Subtest exec-shared-gtt: SUCCESS (0.058s)
[352.783237] [062/134] (674s left) perf (invalid-oa-metric-set-id)
[353.168903] Starting subtest: invalid-oa-metric-set-id
[353.186906] Subtest invalid-oa-metric-set-id: SUCCESS (0.019s)
[353.242137] [063/134] (674s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-signaled)
[353.320339] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[353.321271] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[353.530602] [064/134] (673s left) gem_tiled_pread_pwrite
[353.694253] [065/134] (673s left) i915_pm_rps (thresholds-park)
[353.781419] Starting subtest: thresholds-park
[353.783285] Subtest thresholds-park: SKIP (0.001s)
[353.949848] [066/134] (673s left) gem_ctx_engines (invalid-engines)
[354.036950] Starting subtest: invalid-engines
[354.070520] Subtest invalid-engines: SUCCESS (0.033s)
[354.395545] [067/134] (673s left) vgem_basic (create)
[354.461365] Starting subtest: create
[354.462267] Subtest create: SUCCESS (0.000s)
[354.618946] [068/134] (673s left) kms_psr (fbc-psr2-sprite-mmap-cpu)
[354.808284] Subtest fbc-psr2-sprite-mmap-cpu: SKIP (0.000s)
[354.872824] [069/134] (672s left) gem_mmap_gtt (big-copy-odd)
[354.953168] Subtest big-copy-odd: SKIP (0.000s)
[355.022846] [070/134] (672s left) gem_exec_reloc (basic-gtt-cpu-active)
[355.105408] Subtest basic-gtt-cpu-active: SKIP (0.000s)
[355.188577] [071/134] (672s left) prime_busy (before-wait)
[355.272276] Starting subtest: before-wait
[355.277260] Starting dynamic subtest: rcs0
[355.328278] Dynamic subtest rcs0: SUCCESS (0.051s)
[355.339800] Starting dynamic subtest: bcs0
[355.380016] Dynamic subtest bcs0: SUCCESS (0.051s)
[355.398880] Starting dynamic subtest: vcs0
[355.422671] Dynamic subtest vcs0: SUCCESS (0.041s)
[355.447827] Starting dynamic subtest: vcs1
[355.463848] Dynamic subtest vcs1: SUCCESS (0.039s)
[355.484582] Starting dynamic subtest: vecs0
[355.504759] Dynamic subtest vecs0: SUCCESS (0.039s)
[355.521172] Starting dynamic subtest: vecs1
[355.545502] Dynamic subtest vecs1: SUCCESS (0.040s)
[355.561799] Starting dynamic subtest: ccs0
[355.586016] Dynamic subtest ccs0: SUCCESS (0.039s)
[355.709460] Subtest before-wait: SUCCESS (0.428s)
[355.922704] [072/134] (671s left) gem_exec_fence (keep-in-fence)
[356.132991] Starting subtest: keep-in-fence
[356.133985] Starting dynamic subtest: rcs0
[356.229529] Dynamic subtest rcs0: SUCCESS (0.104s)
[356.245091] Starting dynamic subtest: bcs0
[356.285609] Dynamic subtest bcs0: SUCCESS (0.054s)
[356.307612] Starting dynamic subtest: vcs0
[356.343979] Dynamic subtest vcs0: SUCCESS (0.056s)
[356.359891] Starting dynamic subtest: vcs1
[356.400395] Dynamic subtest vcs1: SUCCESS (0.054s)
[356.420192] Starting dynamic subtest: vecs0
[356.454737] Dynamic subtest vecs0: SUCCESS (0.053s)
[356.488180] Starting dynamic subtest: vecs1
[356.522462] Dynamic subtest vecs1: SUCCESS (0.066s)
[356.547718] Starting dynamic subtest: ccs0
[356.747239] Dynamic subtest ccs0: SUCCESS (0.223s)
[356.748340] Subtest keep-in-fence: SUCCESS (0.623s)
[357.476838] [073/134] (670s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-blt)
[357.682032] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-blt
[360.428948] Subtest fbc-1p-primscrn-spr-indfb-draw-blt: SUCCESS (2.747s)
[360.661226] [074/134] (667s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[360.857344] Starting subtest: 4-tiled-8bpp-rotate-270
[360.912460] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.054s)
[361.128492] [075/134] (666s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf)
[361.319011] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[361.382536] [076/134] (666s left) gem_ccs (block-multicopy-inplace)
[361.466958] Starting subtest: block-multicopy-inplace
[361.469165] Starting dynamic subtest: linear-compressed-compfmt0-smem-lmem0-multicopy
[361.511371] Dynamic subtest linear-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.043s)
[361.522667] Starting dynamic subtest: linear-compressed-compfmt0-lmem0-lmem0-multicopy
[361.613673] Dynamic subtest linear-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.101s)
[361.626425] Starting dynamic subtest: xmajor-compressed-compfmt0-smem-lmem0-multicopy
[361.630775] Dynamic subtest xmajor-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.016s)
[361.642171] Starting dynamic subtest: xmajor-compressed-compfmt0-lmem0-lmem0-multicopy
[361.731089] Dynamic subtest xmajor-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.099s)
[361.743964] Starting dynamic subtest: tile4-compressed-compfmt0-smem-lmem0-multicopy
[361.748254] Dynamic subtest tile4-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.016s)
[361.759547] Starting dynamic subtest: tile4-compressed-compfmt0-lmem0-lmem0-multicopy
[361.856298] Dynamic subtest tile4-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.107s)
[361.869040] Starting dynamic subtest: tile64-compressed-compfmt0-smem-lmem0-multicopy
[361.873366] Dynamic subtest tile64-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.016s)
[361.884597] Starting dynamic subtest: tile64-compressed-compfmt0-lmem0-lmem0-multicopy
[361.972246] Dynamic subtest tile64-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.098s)
[361.973191] Subtest block-multicopy-inplace: SUCCESS (0.506s)
[362.151490] [077/134] (666s left) kms_big_fb (x-tiled-addfb-size-offset-overflow)
[362.358101] Starting subtest: x-tiled-addfb-size-offset-overflow
[362.358923] Subtest x-tiled-addfb-size-offset-overflow: SUCCESS (0.001s)
[362.547311] [078/134] (665s left) kms_atomic (crtc-invalid-params)
[362.736225] Starting subtest: crtc-invalid-params
[362.737188] Starting dynamic subtest: pipe-A-DP-3
[363.270006] Dynamic subtest pipe-A-DP-3: SUCCESS (0.533s)
[363.270976] Subtest crtc-invalid-params: SUCCESS (0.535s)
[363.613571] [079/134] (664s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[363.800318] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[363.801180] Starting dynamic subtest: pipe-A-DP-3
[363.809466] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[363.820499] Starting dynamic subtest: pipe-B-DP-3
[363.828863] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[363.839669] Starting dynamic subtest: pipe-C-DP-3
[363.847815] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[363.858568] Starting dynamic subtest: pipe-D-DP-3
[363.868926] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[363.871339] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SKIP (0.007s)
[364.283653] [080/134] (664s left) gem_lmem_swapping (heavy-verify-multi)
[366.968709] Starting subtest: heavy-verify-multi
[366.969476] Starting dynamic subtest: lmem0
[380.550744] Dynamic subtest lmem0: SUCCESS (13.583s)
[380.551580] Subtest heavy-verify-multi: SUCCESS (13.585s)
[381.757759] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[381.758753] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: kernel.kmod_is_loaded.i915: true
[381.760524] [081/134] (646s left) kms_chamelium_frames (hdmi-crc-fast)
[383.304170] Subtest hdmi-crc-fast: SKIP (0.000s)
[383.484907] [FACT kms_chamelium_frames (hdmi-crc-fast)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[383.487476] [FACT kms_chamelium_frames (hdmi-crc-fast)] new: kernel.kmod_is_loaded.i915: true
[383.490082] [082/134] (645s left) kms_vblank (query-forked-busy-hang)
[383.680874] Starting subtest: query-forked-busy-hang
[383.683119] Starting dynamic subtest: pipe-A-DP-3
[410.570188] Dynamic subtest pipe-A-DP-3: SUCCESS (26.886s)
[410.590705] Starting dynamic subtest: pipe-D-DP-3
[435.571103] Dynamic subtest pipe-D-DP-3: SUCCESS (24.995s)
[435.571995] Subtest query-forked-busy-hang: SUCCESS (51.889s)
[435.847522] [083/134] (592s left) kms_big_fb (linear-16bpp-rotate-90)
[436.057563] Starting subtest: linear-16bpp-rotate-90
[436.110523] Subtest linear-16bpp-rotate-90: SKIP (0.052s)
[436.342615] [084/134] (592s left) gem_flink_race (flink_close)
[436.389576] Starting subtest: flink_close
[441.475450] Subtest flink_close: SUCCESS (5.086s)
[441.700345] [085/134] (587s left) kms_frontbuffer_tracking (fbcpsr-modesetfrombusy)
[441.899932] Starting subtest: fbcpsr-modesetfrombusy
[441.901630] Subtest fbcpsr-modesetfrombusy: SKIP (0.000s)
[442.104996] [086/134] (586s left) gem_exec_schedule (thriceslice)
[442.200494] Starting subtest: thriceslice
[442.201432] Starting dynamic subtest: rcs0
[442.232789] Dynamic subtest rcs0: SUCCESS (0.032s)
[442.244437] Starting dynamic subtest: bcs0
[442.287105] Dynamic subtest bcs0: SUCCESS (0.053s)
[442.305230] Starting dynamic subtest: vcs0
[442.324575] Dynamic subtest vcs0: SUCCESS (0.036s)
[442.344948] Starting dynamic subtest: vcs1
[442.364231] Dynamic subtest vcs1: SUCCESS (0.038s)
[442.384442] Starting dynamic subtest: vecs0
[442.403991] Dynamic subtest vecs0: SUCCESS (0.038s)
[442.423976] Starting dynamic subtest: vecs1
[442.464720] Dynamic subtest vecs1: SUCCESS (0.058s)
[442.482909] Starting dynamic subtest: ccs0
[442.505283] Dynamic subtest ccs0: SUCCESS (0.037s)
[442.506220] Subtest thriceslice: SUCCESS (0.305s)
[442.930088] [087/134] (586s left) kms_flip (flip-vs-dpms-off-vs-modeset)
[443.116968] Starting subtest: flip-vs-dpms-off-vs-modeset
[443.120280] Starting dynamic subtest: A-DP3
[443.921396] Dynamic subtest A-DP3: SUCCESS (0.799s)
[443.947783] Starting dynamic subtest: B-DP3
[444.696894] Dynamic subtest B-DP3: SUCCESS (0.772s)
[444.719663] Starting dynamic subtest: C-DP3
[445.454189] Dynamic subtest C-DP3: SUCCESS (0.756s)
[445.465650] Starting dynamic subtest: D-DP3
[446.216534] Dynamic subtest D-DP3: SUCCESS (0.759s)
[446.220075] Subtest flip-vs-dpms-off-vs-modeset: SUCCESS (3.103s)
[446.563509] [088/134] (582s left) i915_pm_rps (min-max-config-idle)
[446.653189] Starting subtest: min-max-config-idle
[446.655026] Subtest min-max-config-idle: SKIP (0.001s)
[446.826923] [089/134] (582s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[447.016246] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[447.017900] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[447.213242] [090/134] (582s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-sf)
[447.412516] Subtest psr2-overlay-plane-move-continuous-sf: SKIP (0.000s)
[447.473319] [091/134] (581s left) kms_concurrent (multi-plane-atomic-lowres)
[447.663280] Starting subtest: multi-plane-atomic-lowres
[447.665467] Starting dynamic subtest: pipe-A-DP-3
[448.163237] Dynamic subtest pipe-A-DP-3: SUCCESS (0.498s)
[448.164170] Subtest multi-plane-atomic-lowres: SUCCESS (0.499s)
[448.465526] [092/134] (580s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[448.657276] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-gtt
[448.658979] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[448.864721] [093/134] (580s left) api_intel_allocator (reopen)
[448.941331] Starting subtest: reopen
[448.970866] Subtest reopen: SUCCESS (0.029s)
[449.182120] [094/134] (580s left) kms_flip (dpms-vs-vblank-race)
[449.367348] Starting subtest: dpms-vs-vblank-race
[449.372161] Starting dynamic subtest: A-DP3
[452.589595] Dynamic subtest A-DP3: SUCCESS (3.217s)
[452.609127] Starting dynamic subtest: B-DP3
[455.751626] Dynamic subtest B-DP3: SUCCESS (3.160s)
[455.766119] Starting dynamic subtest: C-DP3
[458.897457] Dynamic subtest C-DP3: SUCCESS (3.144s)
[458.914576] Starting dynamic subtest: D-DP3
[461.992611] Dynamic subtest D-DP3: SUCCESS (3.093s)
[461.995344] Subtest dpms-vs-vblank-race: SUCCESS (12.627s)
[462.345005] [095/134] (567s left) syncobj_timeline (single-wait-all-available-signaled)
[462.430412] Starting subtest: single-wait-all-available-signaled
[462.431487] Subtest single-wait-all-available-signaled: SUCCESS (0.000s)
[462.634796] [096/134] (567s left) kms_atomic_transition (plane-all-modeset-transition-fencing-internal-panels)
[462.821431] Starting subtest: plane-all-modeset-transition-fencing-internal-panels
[462.823172] Subtest plane-all-modeset-transition-fencing-internal-panels: SKIP (0.000s)
[462.977300] [097/134] (566s left) gem_exec_params (rs-invalid)
[463.062007] Starting subtest: rs-invalid
[463.064298] Subtest rs-invalid: SUCCESS (0.002s)
[463.241060] [098/134] (566s left) kms_scaling_modes (scaling-mode-full-aspect)
[463.426549] Starting subtest: scaling-mode-full-aspect
[463.431799] Subtest scaling-mode-full-aspect: SKIP (0.001s)
[463.597835] [099/134] (566s left) kms_plane (plane-panning-top-left)
[463.784290] Starting subtest: plane-panning-top-left
[463.785186] Starting dynamic subtest: pipe-A
[464.568961] Dynamic subtest pipe-A: SUCCESS (0.784s)
[464.581115] Starting dynamic subtest: pipe-B
[465.226847] Dynamic subtest pipe-B: SUCCESS (0.656s)
[465.227752] Subtest plane-panning-top-left: SUCCESS (1.443s)
[465.521405] [100/134] (564s left) kms_psr (psr2-sprite-mmap-cpu)
[465.709297] Subtest psr2-sprite-mmap-cpu: SKIP (0.000s)
[465.763369] [101/134] (564s left) gem_exec_params (rel-constants-invalid-ring)
[465.847201] Starting subtest: rel-constants-invalid-ring
[465.848135] Subtest rel-constants-invalid-ring: SUCCESS (0.000s)
[466.054409] [102/134] (564s left) i915_query (query-garbage)
[466.132584] Starting subtest: query-garbage
[466.133485] Subtest query-garbage: SUCCESS (0.000s)
[466.331911] [103/134] (563s left) kms_psr (psr-cursor-mmap-cpu)
[466.521424] Subtest psr-cursor-mmap-cpu: SKIP (0.000s)
[466.579791] [104/134] (563s left) kms_big_fb (y-tiled-16bpp-rotate-90)
[466.780480] Starting subtest: y-tiled-16bpp-rotate-90
[466.782259] Subtest y-tiled-16bpp-rotate-90: SKIP (0.000s)
[466.986411] [105/134] (563s left) kms_ccs (crc-primary-suspend-4-tiled-bmg-ccs)
[467.171416] Starting subtest: crc-primary-suspend-4-tiled-bmg-ccs
[467.173175] Subtest crc-primary-suspend-4-tiled-bmg-ccs: SKIP (0.000s)
[467.498659] [106/134] (563s left) kms_cursor_legacy (flip-vs-cursor-legacy)
[467.686285] Starting subtest: flip-vs-cursor-legacy
[477.737825] Subtest flip-vs-cursor-legacy: SUCCESS (10.052s)
[478.032398] [107/134] (552s left) kms_frontbuffer_tracking (fbcpsr-argb161616f-draw-blt)
[478.225050] Starting subtest: fbcpsr-argb161616f-draw-blt
[478.226883] Subtest fbcpsr-argb161616f-draw-blt: SKIP (0.000s)
[478.434426] [108/134] (552s left) kms_flip (flip-vs-fences)
[478.622305] Starting subtest: flip-vs-fences
[478.624014] Subtest flip-vs-fences: SKIP (0.000s)
[478.835248] [109/134] (551s left) gem_exec_reloc (basic-gtt-cpu-noreloc)
[478.925588] Subtest basic-gtt-cpu-noreloc: SKIP (0.000s)
[479.021502] [110/134] (551s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs-cc)
[479.205787] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs-cc
[479.208165] Starting dynamic subtest: pipe-A-DP-3
[479.216476] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[479.226827] Starting dynamic subtest: pipe-B-DP-3
[479.235278] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[479.245326] Starting dynamic subtest: pipe-C-DP-3
[479.253472] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[479.263740] Starting dynamic subtest: pipe-D-DP-3
[479.274534] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[479.276527] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs-cc: SKIP (0.009s)
[479.693904] [111/134] (551s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-gtt)
[479.883893] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-gtt
[479.885571] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[480.071098] [112/134] (550s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs)
[480.258311] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs
[480.259223] Starting dynamic subtest: pipe-A-DP-3
[480.268407] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[480.278536] Starting dynamic subtest: pipe-B-DP-3
[480.287947] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[480.297923] Starting dynamic subtest: pipe-C-DP-3
[480.306909] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[480.316976] Starting dynamic subtest: pipe-D-DP-3
[480.327683] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[480.329704] Subtest random-ccs-data-4-tiled-mtl-rc-ccs: SKIP (0.007s)
[480.732370] [113/134] (550s left) i915_drm_fdinfo (memory-info-shared)
[480.802017] Starting subtest: memory-info-shared
[480.802925] Starting dynamic subtest: lmem0
[480.948430] Dynamic subtest lmem0: SUCCESS (0.145s)
[480.963916] Starting dynamic subtest: smem0
[480.995980] Dynamic subtest smem0: SUCCESS (0.045s)
[480.996935] Subtest memory-info-shared: SUCCESS (0.195s)
[481.174697] [114/134] (550s left) gem_exec_flush (basic-wb-set-default)
[481.261388] Subtest basic-wb-set-default: SKIP (0.000s)
[481.334014] [115/134] (549s left) sysfs_timeslice_duration (timeout)
[481.420800] Starting subtest: timeout
[481.423150] Starting dynamic subtest: vecs0
[483.232228] Dynamic subtest vecs0: SUCCESS (1.810s)
[483.243124] Starting dynamic subtest: ccs0
[484.980146] Dynamic subtest ccs0: SUCCESS (1.747s)
[484.990572] Starting dynamic subtest: vcs0
[486.684205] Dynamic subtest vcs0: SUCCESS (1.703s)
[486.695250] Starting dynamic subtest: bcs0
[487.794696] Dynamic subtest bcs0: SUCCESS (1.109s)
[487.808270] Starting dynamic subtest: vecs1
[489.592161] Dynamic subtest vecs1: SUCCESS (1.795s)
[489.602536] Starting dynamic subtest: rcs0
[491.295108] Dynamic subtest rcs0: SUCCESS (1.702s)
[491.305528] Starting dynamic subtest: vcs1
[492.974291] Dynamic subtest vcs1: SUCCESS (1.678s)
[492.975235] Subtest timeout: SUCCESS (11.553s)
[493.156243] [116/134] (538s left) sriov_basic (enable-vfs-bind-unbind-each)
[493.233144] Subtest enable-vfs-bind-unbind-each: SKIP (0.000s)
[493.300372] [117/134] (538s left) kms_ccs (bad-rotation-90-4-tiled-lnl-ccs)
[493.483944] Starting subtest: bad-rotation-90-4-tiled-lnl-ccs
[493.485705] Subtest bad-rotation-90-4-tiled-lnl-ccs: SKIP (0.000s)
[493.821622] [118/134] (537s left) kms_getfb (getfb-handle-not-fb)
[494.005286] Starting subtest: getfb-handle-not-fb
[494.006188] Subtest getfb-handle-not-fb: SUCCESS (0.000s)
[494.222022] [119/134] (537s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-mc-ccs)
[494.307618] Starting subtest: y-tiled-ccs-to-yf-tiled-mc-ccs
[494.309416] Subtest y-tiled-ccs-to-yf-tiled-mc-ccs: SKIP (0.000s)
[494.600956] [120/134] (537s left) gem_workarounds (reset-context)
[494.697285] Starting subtest: reset-context
[494.919514] Subtest reset-context: SUCCESS (0.223s)
[495.116881] [121/134] (536s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[495.322234] Starting subtest: psr-farfromfence-mmap-gtt
[495.323959] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[495.520955] [122/134] (536s left) gem_wait (write-busy)
[495.609180] Starting subtest: write-busy
[495.610078] Starting dynamic subtest: all-engines
[496.223417] Dynamic subtest all-engines: SUCCESS (0.613s)
[496.237488] Starting dynamic subtest: rcs0
[496.770214] Dynamic subtest rcs0: SUCCESS (0.545s)
[496.781948] Starting dynamic subtest: bcs0
[497.313161] Dynamic subtest bcs0: SUCCESS (0.542s)
[497.324700] Starting dynamic subtest: vcs0
[497.855210] Dynamic subtest vcs0: SUCCESS (0.541s)
[497.866654] Starting dynamic subtest: vcs1
[498.397057] Dynamic subtest vcs1: SUCCESS (0.541s)
[498.408606] Starting dynamic subtest: vecs0
[498.941023] Dynamic subtest vecs0: SUCCESS (0.543s)
[498.952388] Starting dynamic subtest: vecs1
[499.484417] Dynamic subtest vecs1: SUCCESS (0.542s)
[499.497393] Starting dynamic subtest: ccs0
[500.026719] Dynamic subtest ccs0: SUCCESS (0.541s)
[500.027575] Subtest write-busy: SUCCESS (4.418s)
[500.343762] [123/134] (531s left) i915_hangman (detector)
[500.441577] Starting subtest: detector
[500.442479] Starting dynamic subtest: rcs0
[510.240648] Dynamic subtest rcs0: SUCCESS (9.799s)
[510.255174] Starting dynamic subtest: bcs0
[519.226787] Dynamic subtest bcs0: SUCCESS (8.984s)
[519.242344] Starting dynamic subtest: vcs0
[529.267624] Dynamic subtest vcs0: SUCCESS (10.039s)
[529.282558] Starting dynamic subtest: vcs1
[539.171395] Dynamic subtest vcs1: SUCCESS (9.902s)
[539.183950] Starting dynamic subtest: vecs0
[549.145376] Dynamic subtest vecs0: SUCCESS (9.973s)
[549.157978] Starting dynamic subtest: vecs1
[559.195374] Dynamic subtest vecs1: SUCCESS (10.049s)
[559.206349] Starting dynamic subtest: ccs0
[569.222766] Dynamic subtest ccs0: SUCCESS (10.026s)
[569.223853] Subtest detector: SUCCESS (68.782s)
[569.443241] [124/134] (462s left) kms_frontbuffer_tracking (fbcpsr-2p-pri-indfb-multidraw)
[569.636116] Starting subtest: fbcpsr-2p-pri-indfb-multidraw
[569.637842] Subtest fbcpsr-2p-pri-indfb-multidraw: SKIP (0.000s)
[569.843239] [125/134] (462s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions-varying-size)
[570.036963] Starting subtest: cursorA-vs-flipB-atomic-transitions-varying-size
[570.040225] Subtest cursorA-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s)
[570.212636] [126/134] (461s left) gem_mmap_gtt (basic-write-cpu-read-gtt)
[570.295230] Subtest basic-write-cpu-read-gtt: SKIP (0.000s)
[570.367514] [127/134] (461s left) gem_exec_schedule (noreorder-corked)
[570.618881] Starting subtest: noreorder-corked
[570.620285] Starting dynamic subtest: rcs0
[571.803396] Dynamic subtest rcs0: SUCCESS (1.186s)
[571.816696] Starting dynamic subtest: bcs0
[572.946374] Dynamic subtest bcs0: SUCCESS (1.142s)
[572.960138] Starting dynamic subtest: vcs0
[574.084423] Dynamic subtest vcs0: SUCCESS (1.137s)
[574.100198] Starting dynamic subtest: vcs1
[575.230407] Dynamic subtest vcs1: SUCCESS (1.145s)
[575.243420] Starting dynamic subtest: vecs0
[576.369499] Dynamic subtest vecs0: SUCCESS (1.138s)
[576.383208] Starting dynamic subtest: vecs1
[577.505430] Dynamic subtest vecs1: SUCCESS (1.135s)
[577.518981] Starting dynamic subtest: ccs0
[578.647382] Dynamic subtest ccs0: SUCCESS (1.141s)
[578.648502] Subtest noreorder-corked: SUCCESS (8.032s)
[578.941966] [128/134] (453s left) kms_psr (pr-cursor-mmap-cpu)
[579.124210] Subtest pr-cursor-mmap-cpu: SKIP (0.000s)
[579.185119] [129/134] (453s left) perf (invalid-oa-format-id)
[579.566553] Starting subtest: invalid-oa-format-id
[579.584757] Subtest invalid-oa-format-id: SUCCESS (0.019s)
[579.642540] [130/134] (452s left) gem_eio (in-flight-internal-immediate)
[579.899457] Starting subtest: in-flight-internal-immediate
[580.863214] Subtest in-flight-internal-immediate: SUCCESS (0.965s)
[581.146267] [131/134] (451s left) kms_cursor_edge_walk (256x256-top-edge)
[581.331393] Starting subtest: 256x256-top-edge
[581.332253] Starting dynamic subtest: pipe-A-DP-3
[584.816848] Dynamic subtest pipe-A-DP-3: SUCCESS (3.484s)
[584.835042] Starting dynamic subtest: pipe-D-DP-3
[588.165373] Dynamic subtest pipe-D-DP-3: SUCCESS (3.345s)
[588.166546] Subtest 256x256-top-edge: SUCCESS (6.835s)
[588.533563] [132/134] (443s left) gem_ctx_persistence (engines-persistence)
[588.625274] Starting subtest: engines-persistence
[588.626211] Starting dynamic subtest: rcs0
[589.519788] Dynamic subtest rcs0: SUCCESS (0.894s)
[589.536058] Starting dynamic subtest: bcs0
[590.308260] Dynamic subtest bcs0: SUCCESS (0.786s)
[590.321753] Starting dynamic subtest: vcs0
[591.095107] Dynamic subtest vcs0: SUCCESS (0.785s)
[591.110250] Starting dynamic subtest: vcs1
[591.874369] Dynamic subtest vcs1: SUCCESS (0.774s)
[591.889513] Starting dynamic subtest: vecs0
[592.642470] Dynamic subtest vecs0: SUCCESS (0.763s)
[592.658229] Starting dynamic subtest: vecs1
[593.411280] Dynamic subtest vecs1: SUCCESS (0.764s)
[593.426575] Starting dynamic subtest: ccs0
[594.178110] Dynamic subtest ccs0: SUCCESS (0.762s)
[594.183136] Subtest engines-persistence: SUCCESS (5.554s)
[594.361527] [133/134] (438s left) api_intel_bb (render-ccs)
[594.439599] Starting subtest: render-ccs
[594.534123] Subtest render-ccs: SUCCESS (0.096s)
[594.710883] [134/134] (437s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-plflip-blt)
[594.903818] Starting subtest: fbcpsr-2p-primscrn-shrfb-plflip-blt
[594.905405] Subtest fbcpsr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[595.108670] 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.