[103.416092] Initializing watchdogs
[103.416177]   /dev/watchdog0
[103.435196] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[103.445632] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[103.449726] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[103.452248] [001/131] (960s left) syncobj_wait (wait-all-snapshot)
[103.527852] Starting subtest: wait-all-snapshot
[103.611237] Subtest wait-all-snapshot: SUCCESS (0.082s)
[103.758190] [002/131] (960s left) kms_setmode (basic)
[103.829220] Starting subtest: basic
[103.990187] Starting dynamic subtest: pipe-A-DP-3
[106.163048] Dynamic subtest pipe-A-DP-3: SUCCESS (2.168s)
[106.292351] Starting dynamic subtest: pipe-B-DP-3
[108.454707] Dynamic subtest pipe-B-DP-3: SUCCESS (2.164s)
[108.528173] Subtest basic: SUCCESS (4.694s)
[108.773907] [003/131] (955s left) syncobj_timeline (reset-during-wait-for-submit)
[108.846521] Starting subtest: reset-during-wait-for-submit
[108.951848] Subtest reset-during-wait-for-submit: SUCCESS (0.104s)
[109.047523] [004/131] (955s left) kms_plane_scaling (plane-downscale-factor-0-5-with-modifiers)
[109.247159] Starting subtest: plane-downscale-factor-0-5-with-modifiers
[109.247983] Starting dynamic subtest: pipe-A
[109.831256] Dynamic subtest pipe-A: SUCCESS (0.583s)
[109.847403] Starting dynamic subtest: pipe-B
[110.484517] Dynamic subtest pipe-B: SUCCESS (0.652s)
[110.501662] Starting dynamic subtest: pipe-C
[111.136392] Dynamic subtest pipe-C: SUCCESS (0.651s)
[111.153971] Starting dynamic subtest: pipe-D
[111.791681] Dynamic subtest pipe-D: SUCCESS (0.654s)
[111.792854] Subtest plane-downscale-factor-0-5-with-modifiers: SUCCESS (2.543s)
[112.122535] [005/131] (952s left) i915_pm_rps (thresholds-idle)
[112.207483] Starting subtest: thresholds-idle
[112.209384] Subtest thresholds-idle: SKIP (0.001s)
[112.288757] [006/131] (951s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-gtt)
[112.488560] Starting subtest: fbcpsr-rgb101010-draw-mmap-gtt
[112.490251] Subtest fbcpsr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[112.599735] [007/131] (951s left) kms_big_fb (y-tiled-32bpp-rotate-270)
[112.810505] Starting subtest: y-tiled-32bpp-rotate-270
[112.812293] Subtest y-tiled-32bpp-rotate-270: SKIP (0.000s)
[112.932367] [008/131] (951s left) gen9_exec_parse (batch-zero-length)
[113.011707] Subtest batch-zero-length: SKIP (0.000s)
[113.079822] [009/131] (951s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[113.289376] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip
[114.530904] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip: SUCCESS (1.240s)
[114.747348] [010/131] (949s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[114.953494] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[114.956275] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.002s)
[115.038863] [011/131] (949s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[115.247222] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[115.249141] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[115.379584] [012/131] (949s left) kms_atomic (crtc-invalid-params)
[115.581153] Starting subtest: crtc-invalid-params
[115.582167] Starting dynamic subtest: pipe-A-DP-3
[116.096040] Dynamic subtest pipe-A-DP-3: SUCCESS (0.512s)
[116.097370] Subtest crtc-invalid-params: SUCCESS (0.514s)
[116.384024] [013/131] (948s left) gem_pxp (create-regular-buffer)
[118.983414] Starting subtest: create-regular-buffer
[118.986291] Subtest create-regular-buffer: SKIP (0.000s)
[119.094314] [014/131] (945s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc)
[119.294172] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc
[119.295137] Starting dynamic subtest: pipe-A-DP-3
[119.303899] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[119.311256] Starting dynamic subtest: pipe-B-DP-3
[119.320071] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[119.327277] Starting dynamic subtest: pipe-C-DP-3
[119.335836] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[119.342902] Starting dynamic subtest: pipe-D-DP-3
[119.351984] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[119.353917] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[119.743770] [015/131] (945s left) kms_big_fb (yf-tiled-8bpp-rotate-0)
[119.955201] Starting subtest: yf-tiled-8bpp-rotate-0
[119.957072] Subtest yf-tiled-8bpp-rotate-0: SKIP (0.000s)
[120.099187] [016/131] (944s left) kms_cursor_legacy (modeset-atomic-cursor-hotspot)
[120.295441] Starting subtest: modeset-atomic-cursor-hotspot
[120.297314] Subtest modeset-atomic-cursor-hotspot: SKIP (0.000s)
[120.434372] [017/131] (944s left) kms_ccs (bad-rotation-90-4-tiled-dg2-rc-ccs)
[120.633186] Starting subtest: bad-rotation-90-4-tiled-dg2-rc-ccs
[120.634158] Starting dynamic subtest: pipe-A-DP-3
[122.235186] Dynamic subtest pipe-A-DP-3: SUCCESS (1.597s)
[122.242551] Starting dynamic subtest: pipe-B-DP-3
[122.250911] Dynamic subtest pipe-B-DP-3: SUCCESS (0.001s)
[122.258381] Starting dynamic subtest: pipe-C-DP-3
[122.266952] Dynamic subtest pipe-C-DP-3: SUCCESS (0.002s)
[122.274183] Starting dynamic subtest: pipe-D-DP-3
[122.281902] Dynamic subtest pipe-D-DP-3: SUCCESS (0.003s)
[122.282786] Subtest bad-rotation-90-4-tiled-dg2-rc-ccs: SUCCESS (1.607s)
[122.733914] [018/131] (942s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[122.940360] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip
[124.158134] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.216s)
[124.378592] [019/131] (940s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-pwrite)
[124.589626] Starting subtest: fbcpsr-rgb565-draw-pwrite
[124.591439] Subtest fbcpsr-rgb565-draw-pwrite: SKIP (0.000s)
[124.721797] [020/131] (940s left) gem_softpin (evict-active)
[124.802673] Starting subtest: evict-active
[124.823630] Subtest evict-active: SUCCESS (0.021s)
[124.949139] [021/131] (940s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[125.148233] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[125.149190] Starting dynamic subtest: pipe-A-valid-mode
[125.233479] Dynamic subtest pipe-A-valid-mode: SKIP (0.083s)
[125.235463] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.084s)
[125.447842] [022/131] (939s left) kms_prop_blob (blob-multiple)
[125.523098] Starting subtest: blob-multiple
[125.544248] Subtest blob-multiple: SUCCESS (0.021s)
[125.653539] [023/131] (939s left) kms_getfb (getfb2-handle-protection)
[125.738196] Starting subtest: getfb2-handle-protection
[125.758940] Subtest getfb2-handle-protection: SUCCESS (0.021s)
[125.929333] [024/131] (939s left) gem_exec_whisper (basic-fds-all)
[126.012462] Starting subtest: basic-fds-all
[148.094493] Subtest basic-fds-all: SUCCESS (22.076s)
[148.345324] [025/131] (917s left) gem_userptr_blits (userfault)
[148.425997] Starting subtest: userfault
[148.429281] Subtest userfault: SUCCESS (0.005s)
[148.609750] [026/131] (916s left) api_intel_allocator (standalone)
[148.681163] Starting subtest: standalone
[148.721815] Subtest standalone: SUCCESS (0.041s)
[148.910773] [027/131] (916s left) syncobj_eventfd (timeline-wait-signaled)
[148.982395] Starting subtest: timeline-wait-signaled
[148.983345] Subtest timeline-wait-signaled: SUCCESS (0.000s)
[149.105982] [028/131] (916s left) gem_wait (invalid-buf)
[149.181389] Starting subtest: invalid-buf
[149.182383] Subtest invalid-buf: SUCCESS (0.000s)
[149.445321] [029/131] (916s left) kms_plane_scaling (planes-downscale-factor-0-75-unity-scaling)
[149.641215] Starting subtest: planes-downscale-factor-0-75-unity-scaling
[149.642087] Starting dynamic subtest: pipe-A
[149.736358] Dynamic subtest pipe-A: SUCCESS (0.095s)
[149.746507] Starting dynamic subtest: pipe-B
[149.956512] Dynamic subtest pipe-B: SUCCESS (0.220s)
[149.969616] Starting dynamic subtest: pipe-C
[150.176758] Dynamic subtest pipe-C: SUCCESS (0.220s)
[150.189511] Starting dynamic subtest: pipe-D
[150.396388] Dynamic subtest pipe-D: SUCCESS (0.219s)
[150.397242] Subtest planes-downscale-factor-0-75-unity-scaling: SUCCESS (0.755s)
[150.710655] [030/131] (915s left) kms_vblank (query-forked-hang)
[150.920213] Starting subtest: query-forked-hang
[150.922177] Starting dynamic subtest: pipe-A-DP-3
[177.642507] Dynamic subtest pipe-A-DP-3: SUCCESS (26.719s)
[177.652332] Starting dynamic subtest: pipe-D-DP-3
[202.571204] Dynamic subtest pipe-D-DP-3: SUCCESS (24.925s)
[202.572161] Subtest query-forked-hang: SUCCESS (51.649s)
[202.841763] [031/131] (863s left) kms_vrr (flip-dpms)
[203.039262] Starting subtest: flip-dpms
[203.041961] Subtest flip-dpms: SKIP (0.000s)
[203.136659] [032/131] (862s left) perf_pmu (busy-check-all)
[203.202102] Starting subtest: busy-check-all
[203.203144] Starting dynamic subtest: rcs0
[203.809877] Dynamic subtest rcs0: SUCCESS (0.607s)
[203.820947] Starting dynamic subtest: bcs0
[204.361407] Dynamic subtest bcs0: SUCCESS (0.551s)
[204.370545] Starting dynamic subtest: vcs0
[204.912793] Dynamic subtest vcs0: SUCCESS (0.550s)
[204.924063] Starting dynamic subtest: vcs1
[205.466807] Dynamic subtest vcs1: SUCCESS (0.553s)
[205.478250] Starting dynamic subtest: vecs0
[206.020944] Dynamic subtest vecs0: SUCCESS (0.553s)
[206.032478] Starting dynamic subtest: vecs1
[206.574719] Dynamic subtest vecs1: SUCCESS (0.552s)
[206.586462] Starting dynamic subtest: ccs0
[207.129117] Dynamic subtest ccs0: SUCCESS (0.553s)
[207.131131] Subtest busy-check-all: SUCCESS (3.927s)
[207.254044] [033/131] (858s left) kms_atomic_interruptible (legacy-cursor)
[207.461059] Starting subtest: legacy-cursor
[207.462015] Starting dynamic subtest: pipe-A-DP-3
[213.787446] Dynamic subtest pipe-A-DP-3: SUCCESS (6.326s)
[213.788333] Subtest legacy-cursor: SUCCESS (6.327s)
[214.026296] [034/131] (852s left) gem_flink_basic (bad-open)
[214.098136] Starting subtest: bad-open
[214.098991] Subtest bad-open: SUCCESS (0.000s)
[214.271207] [035/131] (851s left) kms_chamelium_frames (dp-crc-fast)
[214.552929] Subtest dp-crc-fast: SKIP (0.000s)
[214.705596] [036/131] (851s left) kms_pm_backlight (fade-with-suspend)
[214.905454] Subtest fade-with-suspend: SKIP (0.000s)
[214.956451] [037/131] (851s left) syncobj_timeline (wait-all-snapshot)
[215.026582] Starting subtest: wait-all-snapshot
[215.110031] Subtest wait-all-snapshot: SUCCESS (0.082s)
[215.248312] [038/131] (851s left) gem_exec_reloc (basic-concurrent16)
[215.325458] Subtest basic-concurrent16: SKIP (0.000s)
[215.390746] [039/131] (851s left) kms_psr (fbc-psr-cursor-mmap-gtt)
[215.592473] Subtest fbc-psr-cursor-mmap-gtt: SKIP (0.000s)
[215.641414] [040/131] (850s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-render)
[215.844795] Starting subtest: psr-2p-primscrn-spr-indfb-draw-render
[215.846411] Subtest psr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[215.998403] [041/131] (850s left) kms_psr2_sf (psr2-plane-move-sf-dmg-area)
[216.203574] Subtest psr2-plane-move-sf-dmg-area: SKIP (0.000s)
[216.257468] [042/131] (850s left) gem_exec_balancer (full-pulse)
[216.339171] Starting subtest: full-pulse
[218.211474] Subtest full-pulse: SUCCESS (1.872s)
[218.595274] [043/131] (848s left) gem_create (create-massive)
[218.665157] Starting subtest: create-massive
[218.666064] Subtest create-massive: SUCCESS (0.000s)
[218.915470] [044/131] (847s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-blt)
[219.121950] Starting subtest: fbc-rgb101010-draw-blt
[222.006568] Subtest fbc-rgb101010-draw-blt: SUCCESS (2.885s)
[222.161067] [045/131] (844s left) syncobj_wait (wait-delayed-signal)
[222.230474] Starting subtest: wait-delayed-signal
[222.334565] Subtest wait-delayed-signal: SUCCESS (0.103s)
[222.451532] [046/131] (844s left) gem_gtt_cpu_tlb
[222.636882] [047/131] (844s left) gem_exec_fence (submit3)
[222.836700] Starting subtest: submit3
[222.839210] Subtest submit3: SKIP (0.000s)
[223.587278] [FACT gem_exec_fence (submit3)] new: kernel.kmod_is_loaded.vgem: true
[223.589419] [048/131] (843s left) gem_workarounds (reset-context)
[223.681806] Starting subtest: reset-context
[223.910217] Subtest reset-context: SUCCESS (0.228s)
[224.043852] [049/131] (842s left) kms_lease (lease-unleased-crtc)
[224.252244] Starting subtest: lease-unleased-crtc
[224.253191] Starting dynamic subtest: pipe-A-DP-3
[224.396307] Dynamic subtest pipe-A-DP-3: SUCCESS (0.142s)
[224.406240] Starting dynamic subtest: pipe-B-DP-3
[224.466487] Dynamic subtest pipe-B-DP-3: SUCCESS (0.068s)
[224.475638] Starting dynamic subtest: pipe-C-DP-3
[224.531822] Dynamic subtest pipe-C-DP-3: SUCCESS (0.066s)
[224.542718] Starting dynamic subtest: pipe-D-DP-3
[224.599872] Dynamic subtest pipe-D-DP-3: SUCCESS (0.067s)
[224.600772] Subtest lease-unleased-crtc: SUCCESS (0.348s)
[224.796598] [050/131] (842s left) kms_flip (basic-flip-vs-wf_vblank)
[225.007059] Starting subtest: basic-flip-vs-wf_vblank
[225.010947] Starting dynamic subtest: A-DP3
[226.148884] Dynamic subtest A-DP3: SUCCESS (1.138s)
[226.160248] Starting dynamic subtest: B-DP3
[227.379973] Dynamic subtest B-DP3: SUCCESS (1.230s)
[227.390066] Starting dynamic subtest: C-DP3
[228.588037] Dynamic subtest C-DP3: SUCCESS (1.207s)
[228.598927] Starting dynamic subtest: D-DP3
[229.628187] Dynamic subtest D-DP3: SUCCESS (1.039s)
[229.630335] Subtest basic-flip-vs-wf_vblank: SUCCESS (4.623s)
[229.960839] [051/131] (837s left) kms_joiner (switch-modeset-ultra-joiner-big-joiner)
[230.171729] Starting subtest: switch-modeset-ultra-joiner-big-joiner
[230.173422] Subtest switch-modeset-ultra-joiner-big-joiner: SKIP (0.000s)
[230.265951] [052/131] (836s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf)
[230.480423] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[230.537849] [053/131] (836s left) kms_psr (psr-cursor-mmap-gtt)
[230.744357] Subtest psr-cursor-mmap-gtt: SKIP (0.000s)
[230.805408] [054/131] (836s left) sw_sync (sync_merge)
[230.857168] Starting subtest: sync_merge
[230.858150] Subtest sync_merge: SUCCESS (0.000s)
[230.930528] [055/131] (836s left) gem_set_tiling_vs_pwrite
[231.091763] [056/131] (836s left) kms_ccs (random-ccs-data-yf-tiled-ccs)
[231.300339] Starting subtest: random-ccs-data-yf-tiled-ccs
[231.301269] Starting dynamic subtest: pipe-A-DP-3
[231.310807] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[231.320236] Starting dynamic subtest: pipe-B-DP-3
[231.329994] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[231.339180] Starting dynamic subtest: pipe-C-DP-3
[231.348387] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[231.357586] Starting dynamic subtest: pipe-D-DP-3
[231.369163] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[231.371549] Subtest random-ccs-data-yf-tiled-ccs: SKIP (0.005s)
[231.744110] [057/131] (835s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-fullscreen)
[231.956876] Starting subtest: psr-1p-primscrn-spr-indfb-fullscreen
[231.958545] Subtest psr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[232.087683] [058/131] (835s left) gem_create (create-clear)
[232.163223] Starting subtest: create-clear
[232.164166] Starting dynamic subtest: lmem0
[269.698806] Dynamic subtest lmem0: SUCCESS (37.529s)
[269.708412] Starting dynamic subtest: smem0
[305.430265] Dynamic subtest smem0: SUCCESS (35.732s)
[305.431240] Subtest create-clear: SUCCESS (73.262s)
[305.688546] [059/131] (761s left) gem_exec_balancer (bonded-dual)
[305.782519] Starting subtest: bonded-dual
[305.784272] Subtest bonded-dual: SKIP (0.000s)
[306.106129] [060/131] (761s left) gem_lmem_swapping (verify-random-ccs)
[308.860360] Starting subtest: verify-random-ccs
[308.864054] Starting dynamic subtest: lmem0
[315.902062] Dynamic subtest lmem0: SUCCESS (7.045s)
[315.903058] Subtest verify-random-ccs: SUCCESS (7.046s)
[317.255604] [FACT gem_lmem_swapping (verify-random-ccs)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[317.256659] [FACT gem_lmem_swapping (verify-random-ccs)] deleted: kernel.kmod_is_loaded.i915: true
[317.258560] [061/131] (750s left) gem_exec_fence (syncobj-signal)
[319.280536] Starting subtest: syncobj-signal
[319.306670] Subtest syncobj-signal: SUCCESS (0.026s)
[319.636212] [FACT gem_exec_fence (syncobj-signal)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[319.639385] [FACT gem_exec_fence (syncobj-signal)] new: kernel.kmod_is_loaded.i915: true
[319.642476] [062/131] (748s left) sriov_basic (bind-unbind-vf)
[319.722159] Subtest bind-unbind-vf: SKIP (0.000s)
[319.814888] [063/131] (747s left) gem_workarounds (reset)
[319.904832] Starting subtest: reset
[320.118660] Subtest reset: SUCCESS (0.214s)
[320.241022] [064/131] (747s left) gem_ctx_shared (exec-single-timeline)
[320.328731] Starting subtest: exec-single-timeline
[320.329591] Starting dynamic subtest: rcs0
[321.401122] Dynamic subtest rcs0: SUCCESS (1.071s)
[321.412983] Starting dynamic subtest: bcs0
[322.425037] Dynamic subtest bcs0: SUCCESS (1.021s)
[322.438161] Starting dynamic subtest: vcs0
[323.449091] Dynamic subtest vcs0: SUCCESS (1.021s)
[323.460364] Starting dynamic subtest: vcs1
[324.473330] Dynamic subtest vcs1: SUCCESS (1.021s)
[324.514447] Starting dynamic subtest: vecs0
[325.561515] Dynamic subtest vecs0: SUCCESS (1.085s)
[325.572403] Starting dynamic subtest: vecs1
[326.586312] Dynamic subtest vecs1: SUCCESS (1.022s)
[326.597202] Starting dynamic subtest: ccs0
[327.609123] Dynamic subtest ccs0: SUCCESS (1.021s)
[327.611171] Subtest exec-single-timeline: SUCCESS (7.281s)
[327.913277] [065/131] (739s left) gem_exec_reloc (basic-write-gtt-active)
[327.995555] Subtest basic-write-gtt-active: SKIP (0.000s)
[328.083883] [066/131] (739s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-yf-tiled)
[328.169448] Starting subtest: yf-tiled-mc-ccs-to-vebox-yf-tiled
[328.171482] Subtest yf-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[328.421601] [067/131] (739s left) gem_mmap_gtt (basic-write-read-distinct)
[328.503402] Subtest basic-write-read-distinct: SKIP (0.000s)
[328.565596] [068/131] (739s left) kms_cursor_crc (cursor-rapid-movement-max-size)
[329.019644] Starting subtest: cursor-rapid-movement-max-size
[329.022332] Subtest cursor-rapid-movement-max-size: SKIP (0.000s)
[329.218919] [069/131] (738s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[329.430124] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[329.431914] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[329.562606] [070/131] (738s left) drm_fdinfo (virtual-busy-idle)
[329.637210] Starting subtest: virtual-busy-idle
[329.639187] Subtest virtual-busy-idle: SKIP (0.000s)
[329.721881] [071/131] (738s left) kms_pipe_b_c_ivb (enable-pipe-c-while-b-has-3-lanes)
[329.800488] Subtest enable-pipe-C-while-B-has-3-lanes: SKIP (0.000s)
[329.869277] [072/131] (738s left) gem_exec_suspend (basic)
[329.959799] Starting subtest: basic
[329.960774] Starting dynamic subtest: smem
[331.008748] Dynamic subtest smem: SUCCESS (1.049s)
[331.018645] Starting dynamic subtest: lmem0
[331.953300] Dynamic subtest lmem0: SUCCESS (0.944s)
[331.954599] Subtest basic: SUCCESS (1.994s)
[332.235010] [073/131] (736s left) gem_render_copy (y-tiled-ccs-to-y-tiled-mc-ccs)
[332.322444] Starting subtest: y-tiled-ccs-to-y-tiled-mc-ccs
[332.324545] Subtest y-tiled-ccs-to-y-tiled-mc-ccs: SKIP (0.000s)
[332.566522] [074/131] (735s left) kms_plane_scaling (2x-scaler-multi-pipe)
[332.787152] Starting subtest: 2x-scaler-multi-pipe
[332.788968] Subtest 2x-scaler-multi-pipe: SKIP (0.002s)
[332.949073] [075/131] (735s left) kms_fbcon_fbt (fbc)
[333.035504] Starting subtest: fbc
[336.627204] Subtest fbc: SUCCESS (3.590s)
[336.722196] [076/131] (731s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted)
[336.804601] Starting subtest: multi-wait-all-for-submit-unsubmitted
[336.912607] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.107s)
[337.047556] [077/131] (731s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[337.260071] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[337.261818] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[337.367569] [078/131] (731s left) kms_rotation_crc (primary-4-tiled-reflect-x-180)
[337.573419] Starting subtest: primary-4-tiled-reflect-x-180
[348.034974] Subtest primary-4-tiled-reflect-x-180: SUCCESS (10.460s)
[348.401458] [079/131] (720s left) kms_big_fb (linear-64bpp-rotate-0)
[348.615037] Starting subtest: linear-64bpp-rotate-0
[350.468195] Subtest linear-64bpp-rotate-0: SUCCESS (1.852s)
[350.713535] [080/131] (718s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render)
[350.926038] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render
[354.068107] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (3.143s)
[354.271359] [081/131] (714s left) kms_ccs (bad-rotation-90-4-tiled-mtl-mc-ccs)
[354.493428] Starting subtest: bad-rotation-90-4-tiled-mtl-mc-ccs
[354.495568] Starting dynamic subtest: pipe-A-DP-3
[354.503966] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[354.513794] Starting dynamic subtest: pipe-B-DP-3
[354.522268] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[354.531990] Starting dynamic subtest: pipe-C-DP-3
[354.540509] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[354.549943] Starting dynamic subtest: pipe-D-DP-3
[354.561365] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[354.563357] Subtest bad-rotation-90-4-tiled-mtl-mc-ccs: SKIP (0.005s)
[354.961503] [082/131] (714s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted)
[355.043734] Starting subtest: multi-wait-all-for-submit-available-submitted
[355.044618] Subtest multi-wait-all-for-submit-available-submitted: SUCCESS (0.001s)
[355.238099] [083/131] (713s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-pgflip-blt)
[355.465914] Starting subtest: fbc-2p-scndscrn-shrfb-pgflip-blt
[355.467514] Subtest fbc-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[355.596943] [084/131] (713s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[355.680154] Subtest no-spare-fences-interruptible: SKIP (0.000s)
[355.768906] [085/131] (713s left) i915_pm_freq_api (freq-reset-multiple)
[355.858037] Starting subtest: freq-reset-multiple
[355.858958] Starting dynamic subtest: gt0
[378.211512] Dynamic subtest gt0: SUCCESS (22.352s)
[378.212426] Subtest freq-reset-multiple: SUCCESS (22.353s)
[378.306970] [086/131] (690s left) kms_content_protection (dp-mst-type-0)
[378.580748] Starting subtest: dp-mst-type-0
[378.582474] Subtest dp-mst-type-0: SKIP (0.000s)
[378.793460] [087/131] (690s left) syncobj_wait (wait-all-for-submit-complex)
[378.873916] Starting subtest: wait-all-for-submit-complex
[379.092630] Subtest wait-all-for-submit-complex: SUCCESS (0.217s)
[379.192748] [088/131] (690s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling)
[379.395497] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling
[379.397708] Starting dynamic subtest: pipe-A-valid-mode
[379.486470] Dynamic subtest pipe-A-valid-mode: SKIP (0.088s)
[379.488479] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling: SKIP (0.090s)
[379.723395] [089/131] (689s left) gem_exec_parallel (contexts)
[379.815281] Starting subtest: contexts
[379.816253] Starting dynamic subtest: rcs0
[383.830368] Dynamic subtest rcs0: SUCCESS (4.014s)
[383.840825] Starting dynamic subtest: bcs0
[387.389368] Dynamic subtest bcs0: SUCCESS (3.558s)
[387.399412] Starting dynamic subtest: vcs0
[391.523749] Dynamic subtest vcs0: SUCCESS (4.133s)
[391.534235] Starting dynamic subtest: vcs1
[395.829400] Dynamic subtest vcs1: SUCCESS (4.305s)
[395.840148] Starting dynamic subtest: vecs0
[399.526248] Dynamic subtest vecs0: SUCCESS (3.696s)
[399.536849] Starting dynamic subtest: vecs1
[404.028956] Dynamic subtest vecs1: SUCCESS (4.502s)
[404.040107] Starting dynamic subtest: ccs0
[407.961136] Dynamic subtest ccs0: SUCCESS (3.931s)
[407.962426] Subtest contexts: SUCCESS (28.145s)
[408.256643] [090/131] (661s left) kms_atomic_transition (plane-all-transition-fencing)
[408.463627] Starting subtest: plane-all-transition-fencing
[408.465926] Starting dynamic subtest: pipe-A-DP-3
[412.190936] Dynamic subtest pipe-A-DP-3: SUCCESS (3.724s)
[412.279519] Starting dynamic subtest: pipe-B-DP-3
[416.043076] Dynamic subtest pipe-B-DP-3: SUCCESS (3.776s)
[416.096037] Subtest plane-all-transition-fencing: SUCCESS (7.631s)
[416.334035] [091/131] (653s left) perf (mi-rpc)
[416.697425] Starting subtest: mi-rpc
[416.699174] Subtest mi-rpc: SKIP (0.000s)
[416.747940] [092/131] (652s left) gem_exec_reloc (basic-gtt-read-active)
[416.833260] Subtest basic-gtt-read-active: SKIP (0.000s)
[416.931059] [093/131] (652s left) kms_psr (fbc-pr-dpms)
[417.138333] Subtest fbc-pr-dpms: SKIP (0.000s)
[417.197331] [094/131] (652s left) kms_flip (blocking-absolute-wf_vblank)
[417.407167] Starting subtest: blocking-absolute-wf_vblank
[417.411451] Starting dynamic subtest: A-DP3
[425.259297] Dynamic subtest A-DP3: SUCCESS (7.847s)
[425.272441] Starting dynamic subtest: B-DP3
[433.020487] Dynamic subtest B-DP3: SUCCESS (7.759s)
[433.033350] Starting dynamic subtest: C-DP3
[440.776379] Dynamic subtest C-DP3: SUCCESS (7.754s)
[440.788533] Starting dynamic subtest: D-DP3
[448.530399] Dynamic subtest D-DP3: SUCCESS (7.752s)
[448.532762] Subtest blocking-absolute-wf_vblank: SUCCESS (31.124s)
[448.870176] [095/131] (621s left) kms_psr (pr-dpms)
[449.078389] Subtest pr-dpms: SKIP (0.000s)
[449.166739] [096/131] (620s left) kms_flip (2x-dpms-vs-vblank-race-interruptible)
[449.379265] Starting subtest: 2x-dpms-vs-vblank-race-interruptible
[449.394250] Subtest 2x-dpms-vs-vblank-race-interruptible: SKIP (0.014s)
[449.481101] [097/131] (620s left) kms_color (legacy-gamma)
[449.688515] Starting subtest: legacy-gamma
[449.689456] Starting dynamic subtest: pipe-A-DP-3
[450.386445] Dynamic subtest pipe-A-DP-3: SUCCESS (0.695s)
[450.409749] Starting dynamic subtest: pipe-B-DP-3
[450.993729] Dynamic subtest pipe-B-DP-3: SUCCESS (0.607s)
[451.011691] Starting dynamic subtest: pipe-C-DP-3
[451.595209] Dynamic subtest pipe-C-DP-3: SUCCESS (0.600s)
[451.611652] Starting dynamic subtest: pipe-D-DP-3
[452.224034] Dynamic subtest pipe-D-DP-3: SUCCESS (0.623s)
[452.225440] Subtest legacy-gamma: SUCCESS (2.533s)
[452.491070] [098/131] (617s left) kms_display_modes (mst-extended-mode-negative)
[452.700695] Starting subtest: mst-extended-mode-negative
[452.702729] Subtest mst-extended-mode-negative: SKIP (0.000s)
[452.764951] [099/131] (617s left) kms_ccs (crc-sprite-planes-basic-4-tiled-lnl-ccs)
[452.971548] Starting subtest: crc-sprite-planes-basic-4-tiled-lnl-ccs
[452.973352] Subtest crc-sprite-planes-basic-4-tiled-lnl-ccs: SKIP (0.000s)
[453.262841] [100/131] (616s left) kms_psr (pr-suspend)
[453.471385] Subtest pr-suspend: SKIP (0.000s)
[453.533128] [101/131] (616s left) gem_eio (wait-wedge-immediate)
[453.887069] Starting subtest: wait-wedge-immediate
[454.945617] Subtest wait-wedge-immediate: SUCCESS (1.059s)
[455.181045] [102/131] (615s left) drm_fdinfo (memory-info-active)
[455.250859] Starting subtest: memory-info-active
[455.251798] Starting dynamic subtest: lmem0
[458.650380] Dynamic subtest lmem0: SUCCESS (3.398s)
[458.687385] Starting dynamic subtest: smem0
[463.027042] Dynamic subtest smem0: SUCCESS (4.373s)
[463.028044] Subtest memory-info-active: SUCCESS (7.776s)
[463.122910] [103/131] (607s left) gem_eio (wait-10ms)
[463.439051] Starting subtest: wait-10ms
[464.072942] Subtest wait-10ms: SUCCESS (0.635s)
[464.301172] [104/131] (606s left) gem_lmem_swapping (heavy-verify-random-ccs)
[467.067843] Starting subtest: heavy-verify-random-ccs
[467.068742] Starting dynamic subtest: lmem0
[482.195881] Dynamic subtest lmem0: SUCCESS (15.126s)
[482.196872] Subtest heavy-verify-random-ccs: SUCCESS (15.127s)
[483.898203] [FACT gem_lmem_swapping (heavy-verify-random-ccs)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[483.899187] [FACT gem_lmem_swapping (heavy-verify-random-ccs)] deleted: kernel.kmod_is_loaded.i915: true
[483.901199] [105/131] (586s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[485.856138] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[485.858166] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[485.994060] [FACT kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[485.997224] [FACT kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)] new: kernel.kmod_is_loaded.i915: true
[485.998047] [FACT kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)] new: kernel.kmod_is_loaded.xe: true
[485.999953] [106/131] (584s left) syncobj_wait (single-wait-signaled)
[486.080980] Starting subtest: single-wait-signaled
[486.081941] Subtest single-wait-signaled: SUCCESS (0.000s)
[486.226192] [107/131] (584s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-render)
[486.439388] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-render
[486.441404] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[486.605931] [108/131] (584s left) kms_properties (invalid-properties-atomic)
[486.814488] Starting subtest: invalid-properties-atomic
[487.177871] Subtest invalid-properties-atomic: SUCCESS (0.363s)
[487.290158] [109/131] (583s left) kms_cursor_crc (cursor-random-max-size)
[487.754976] Starting subtest: cursor-random-max-size
[487.757780] Subtest cursor-random-max-size: SKIP (0.000s)
[487.991250] [110/131] (582s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-blt)
[488.207055] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-blt
[488.208918] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[488.366752] [111/131] (582s left) gem_mmap_wc (pf-nonblock)
[488.448558] Subtest pf-nonblock: SKIP (0.000s)
[488.513828] [112/131] (582s left) syncobj_timeline (invalid-query-bad-pad)
[488.593197] Starting subtest: invalid-query-bad-pad
[488.594144] Subtest invalid-query-bad-pad: SUCCESS (0.000s)
[488.768823] [113/131] (582s left) i915_suspend (basic-s3-without-i915)
[488.820824] Starting subtest: basic-s3-without-i915
[509.915452] Subtest basic-s3-without-i915: SUCCESS (5.912s)
[510.045920] [114/131] (576s left) kms_pm_rpm (modeset-lpsp-stress)
[512.278478] Starting subtest: modeset-lpsp-stress
[512.687237] Subtest modeset-lpsp-stress: SKIP (0.407s)
[513.538857] [115/131] (572s left) gem_exec_schedule (timeslicing)
[513.637785] Starting subtest: timeslicing
[513.638753] Starting dynamic subtest: rcs0
[513.658898] Dynamic subtest rcs0: SUCCESS (0.022s)
[513.671009] Starting dynamic subtest: bcs0
[513.679521] Dynamic subtest bcs0: SUCCESS (0.020s)
[513.690802] Starting dynamic subtest: vcs0
[513.700875] Dynamic subtest vcs0: SUCCESS (0.020s)
[513.711920] Starting dynamic subtest: vcs1
[513.723883] Dynamic subtest vcs1: SUCCESS (0.022s)
[513.736136] Starting dynamic subtest: vecs0
[513.744929] Dynamic subtest vecs0: SUCCESS (0.020s)
[513.757316] Starting dynamic subtest: vecs1
[513.765900] Dynamic subtest vecs1: SUCCESS (0.020s)
[513.776919] Starting dynamic subtest: ccs0
[513.786681] Dynamic subtest ccs0: SUCCESS (0.020s)
[513.787621] Subtest timeslicing: SUCCESS (0.151s)
[514.170724] [116/131] (572s left) gem_ctx_persistence (engines-mixed-process)
[514.256410] Starting subtest: engines-mixed-process
[514.257523] Starting dynamic subtest: rcs0
[516.080665] Dynamic subtest rcs0: SUCCESS (1.824s)
[516.095175] Starting dynamic subtest: bcs0
[518.127169] Dynamic subtest bcs0: SUCCESS (2.045s)
[518.140949] Starting dynamic subtest: vcs0
[520.105356] Dynamic subtest vcs0: SUCCESS (1.977s)
[520.119007] Starting dynamic subtest: vcs1
[522.090697] Dynamic subtest vcs1: SUCCESS (1.984s)
[522.104766] Starting dynamic subtest: vecs0
[524.074381] Dynamic subtest vecs0: SUCCESS (1.982s)
[524.088425] Starting dynamic subtest: vecs1
[526.130294] Dynamic subtest vecs1: SUCCESS (2.054s)
[526.144785] Starting dynamic subtest: ccs0
[528.108498] Dynamic subtest ccs0: SUCCESS (1.977s)
[528.109609] Subtest engines-mixed-process: SUCCESS (13.852s)
[528.249670] [117/131] (558s left) sysfs_heartbeat_interval (mixed)
[528.333309] Starting subtest: mixed
[528.334347] Starting dynamic subtest: vecs0
[533.565567] Dynamic subtest vecs0: SUCCESS (5.231s)
[533.581753] Starting dynamic subtest: ccs0
[538.820884] Dynamic subtest ccs0: SUCCESS (5.252s)
[538.860817] Starting dynamic subtest: vcs0
[544.034618] Dynamic subtest vcs0: SUCCESS (5.209s)
[544.048978] Starting dynamic subtest: bcs0
[549.244916] Dynamic subtest bcs0: SUCCESS (5.206s)
[549.265479] Starting dynamic subtest: vecs1
[554.428206] Dynamic subtest vecs1: SUCCESS (5.179s)
[554.444296] Starting dynamic subtest: rcs0
[559.613792] Dynamic subtest rcs0: SUCCESS (5.183s)
[559.632532] Starting dynamic subtest: vcs1
[564.780126] Dynamic subtest vcs1: SUCCESS (5.163s)
[564.781183] Subtest mixed: SUCCESS (36.443s)
[564.956623] [118/131] (521s left) kms_chamelium_frames (vga-frame-dump)
[565.253741] Subtest vga-frame-dump: SKIP (0.000s)
[565.413480] [119/131] (521s left) kms_frontbuffer_tracking (psr-slowdraw)
[565.625854] Starting subtest: psr-slowdraw
[565.627610] Subtest psr-slowdraw: SKIP (0.000s)
[565.765063] [120/131] (520s left) perf_pmu (pmu-read)
[565.837634] Starting subtest: pmu-read
[565.841353] Subtest pmu-read: SUCCESS (0.004s)
[565.992056] [121/131] (520s left) kms_pipe_crc_basic (suspend-read-crc)
[566.196925] Starting subtest: suspend-read-crc
[566.199337] Starting dynamic subtest: pipe-A-DP-3
[586.972008] Dynamic subtest pipe-A-DP-3: SUCCESS (5.154s)
[586.991627] Starting dynamic subtest: pipe-B-DP-3
[607.126847] Dynamic subtest pipe-B-DP-3: SUCCESS (4.638s)
[607.141860] Starting dynamic subtest: pipe-C-DP-3
[627.323592] Dynamic subtest pipe-C-DP-3: SUCCESS (4.538s)
[627.339785] Starting dynamic subtest: pipe-D-DP-3
[647.508110] Dynamic subtest pipe-D-DP-3: SUCCESS (4.539s)
[647.509129] Subtest suspend-read-crc: SUCCESS (18.879s)
[647.802718] [122/131] (501s left) kms_frontbuffer_tracking (fbc-suspend)
[648.032280] Starting subtest: fbc-suspend
[689.885041] Subtest fbc-suspend: SUCCESS (10.617s)
[690.109085] [123/131] (490s left) kms_atomic (plane-primary-legacy)
[690.318837] Starting subtest: plane-primary-legacy
[690.321175] Starting dynamic subtest: pipe-A-DP-3
[691.277525] Dynamic subtest pipe-A-DP-3: SUCCESS (0.956s)
[691.278557] Subtest plane-primary-legacy: SUCCESS (0.958s)
[691.559522] [124/131] (489s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-plflip-blt)
[691.773461] Starting subtest: fbc-1p-primscrn-shrfb-plflip-blt
[694.711408] Subtest fbc-1p-primscrn-shrfb-plflip-blt: SUCCESS (2.938s)
[694.886592] [125/131] (485s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-move)
[695.106845] Starting subtest: psr-1p-primscrn-cur-indfb-move
[695.108656] Subtest psr-1p-primscrn-cur-indfb-move: SKIP (0.000s)
[695.222168] [126/131] (485s left) kms_fbc_dirty_rect (fbc-dirty-rectangle-out-visible-area)
[695.310814] Subtest fbc-dirty-rectangle-out-visible-area: SKIP (0.000s)
[695.407164] [127/131] (485s left) gem_userptr_blits (nohangcheck)
[695.513406] Starting subtest: nohangcheck
[695.797881] Subtest nohangcheck: SUCCESS (0.283s)
[695.946288] [128/131] (484s left) kms_flip (2x-wf_vblank-ts-check)
[696.152347] Starting subtest: 2x-wf_vblank-ts-check
[696.167105] Subtest 2x-wf_vblank-ts-check: SKIP (0.014s)
[696.293847] [129/131] (484s left) core_setmaster (master-drop-set-root)
[698.727660] Starting subtest: master-drop-set-root
[698.743532] Subtest master-drop-set-root: SUCCESS (0.016s)
[698.804444] [FACT core_setmaster (master-drop-set-root)] new: kernel.kmod_is_loaded.amdgpu: true
[698.807281] [130/131] (482s left) gem_exec_schedule (preemptive-hang)
[699.026203] Starting subtest: preemptive-hang
[699.028082] Starting dynamic subtest: rcs0
[708.038828] Dynamic subtest rcs0: SUCCESS (9.011s)
[708.051416] Starting dynamic subtest: bcs0
[717.000917] Dynamic subtest bcs0: SUCCESS (8.960s)
[717.013407] Starting dynamic subtest: vcs0
[726.026245] Dynamic subtest vcs0: SUCCESS (9.025s)
[726.038788] Starting dynamic subtest: vcs1
[735.045162] Dynamic subtest vcs1: SUCCESS (9.019s)
[735.057702] Starting dynamic subtest: vecs0
[744.008065] Dynamic subtest vecs0: SUCCESS (8.961s)
[744.020723] Starting dynamic subtest: vecs1
[753.039939] Dynamic subtest vecs1: SUCCESS (9.031s)
[753.052463] Starting dynamic subtest: ccs0
[761.988009] Dynamic subtest ccs0: SUCCESS (8.946s)
[761.988868] Subtest preemptive-hang: SUCCESS (62.962s)
[762.265103] [131/131] (418s left) prime_vgem (basic-read)
[762.366810] Starting subtest: basic-read
[762.375336] Subtest basic-read: SKIP (0.007s)
[762.540308] Closing watchdogs
Done.