[63.833915] Initializing watchdogs
[63.833977]   /dev/watchdog0
[63.853145] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[63.863570] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[63.867522] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[63.869800] [001/134] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc)
[65.376468] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc
[65.378098] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[65.584504] [002/134] (958s left) kms_hdr (bpc-switch)
[67.098465] Starting subtest: bpc-switch
[67.102697] Subtest bpc-switch: SKIP (0.001s)
[67.265701] [003/134] (957s left) i915_module_load (reload)
[67.344936] Starting subtest: reload
[72.314397] Subtest reload: SUCCESS (4.978s)
[72.356228] [004/134] (952s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)
[73.908564] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[73.950585] [005/134] (950s left) kms_pm_rpm (cursor)
[78.009784] Starting subtest: cursor
[78.012155] Subtest cursor: SKIP (0.000s)
[78.965924] [006/134] (945s left) kms_rotation_crc (cursor-rotation-180)
[80.468967] Starting subtest: cursor-rotation-180
[81.304580] Subtest cursor-rotation-180: SUCCESS (0.835s)
[81.624942] [007/134] (943s left) vgem_basic (bad-pad)
[81.710322] Starting subtest: bad-pad
[81.711234] Subtest bad-pad: SUCCESS (0.000s)
[81.855547] [FACT vgem_basic (bad-pad)] new: kernel.kmod_is_loaded.vgem: true
[81.857212] [008/134] (943s left) kms_addfb_basic (invalid-get-prop)
[81.935899] Starting subtest: invalid-get-prop
[81.936812] Subtest invalid-get-prop: SUCCESS (0.000s)
[83.607285] [009/134] (941s left) gem_mmap_gtt (hang-busy)
[83.691958] Subtest hang-busy: SKIP (0.000s)
[83.754422] [010/134] (941s left) gem_eio (in-flight-1us)
[84.041037] Starting subtest: in-flight-1us
[88.784275] Subtest in-flight-1us: SUCCESS (4.742s)
[90.371896] [011/134] (934s left) gem_ctx_shared (disjoint-timelines)
[90.486469] Starting subtest: disjoint-timelines
[90.524065] Subtest disjoint-timelines: SUCCESS (0.037s)
[90.819891] [012/134] (934s left) kms_rotation_crc (bad-tiling)
[92.330343] Starting subtest: bad-tiling
[92.332160] Subtest bad-tiling: SKIP (0.001s)
[92.511231] [013/134] (932s left) gem_exec_fence (syncobj-channel)
[93.069380] Starting subtest: syncobj-channel
[94.089662] Subtest syncobj-channel: SUCCESS (1.019s)
[94.536481] [014/134] (930s left) kms_big_fb (y-tiled-64bpp-rotate-270)
[96.061280] Starting subtest: y-tiled-64bpp-rotate-270
[96.063058] Subtest y-tiled-64bpp-rotate-270: SKIP (0.000s)
[96.278378] [015/134] (929s left) kms_psr (psr2-cursor-plane-move)
[97.792189] Subtest psr2-cursor-plane-move: SKIP (0.000s)
[97.855059] [016/134] (927s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-pwrite)
[99.380984] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-pwrite
[99.382758] Subtest fbc-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[99.600099] [017/134] (926s left) i915_pm_rpm (gem-execbuf)
[104.047634] Starting subtest: gem-execbuf
[104.049264] Starting dynamic subtest: lmem0
[109.153382] Dynamic subtest lmem0: SUCCESS (5.105s)
[109.164731] Starting dynamic subtest: smem0
[114.076782] Dynamic subtest smem0: SUCCESS (4.922s)
[114.078028] Subtest gem-execbuf: SUCCESS (10.029s)
[115.031462] [018/134] (910s left) syncobj_timeline (wait-zero-handles)
[115.126218] Starting subtest: wait-zero-handles
[115.127139] Subtest wait-zero-handles: SUCCESS (0.000s)
[115.319375] [019/134] (910s left) kms_pm_rpm (dpms-non-lpsp)
[119.061387] Starting subtest: dpms-non-lpsp
[119.232360] Subtest dpms-non-lpsp: SUCCESS (0.170s)
[119.360783] [020/134] (906s left) kms_big_fb (yf-tiled-addfb-size-offset-overflow)
[121.459441] Starting subtest: yf-tiled-addfb-size-offset-overflow
[121.461267] Subtest yf-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[121.673464] [021/134] (904s left) gem_render_copy (linear)
[121.760100] Starting subtest: linear
[121.761039] Starting dynamic subtest: smem
[121.869408] Dynamic subtest smem: SUCCESS (0.109s)
[121.878678] Starting dynamic subtest: lmem0
[122.192292] Dynamic subtest lmem0: SUCCESS (0.322s)
[122.193307] Subtest linear: SUCCESS (0.432s)
[122.517421] [022/134] (903s left) i915_drm_fdinfo (basics)
[122.587527] Starting subtest: basics
[122.588438] Subtest basics: SUCCESS (0.000s)
[122.744856] [023/134] (903s left) kms_cursor_edge_walk (64x64-top-bottom)
[124.254181] Starting subtest: 64x64-top-bottom
[124.255157] Starting dynamic subtest: pipe-A-HDMI-A-3
[127.595952] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (3.340s)
[127.605580] Starting dynamic subtest: pipe-D-HDMI-A-3
[130.811128] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (3.214s)
[130.811933] Subtest 64x64-top-bottom: SUCCESS (6.557s)
[131.025093] [024/134] (895s left) kms_big_fb (4-tiled-addfb-size-offset-overflow)
[132.550118] Starting subtest: 4-tiled-addfb-size-offset-overflow
[132.550997] Subtest 4-tiled-addfb-size-offset-overflow: SUCCESS (0.001s)
[132.772198] [025/134] (893s left) kms_psr (fbc-pr-primary-blt)
[134.291123] Subtest fbc-pr-primary-blt: SKIP (0.000s)
[134.343131] [026/134] (891s left) kms_cursor_crc (cursor-size-hints)
[135.929935] Starting subtest: cursor-size-hints
[135.930862] Starting dynamic subtest: pipe-A-HDMI-A-3
[136.446912] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.517s)
[136.457271] Starting dynamic subtest: pipe-D-HDMI-A-3
[136.870327] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.422s)
[136.871270] Subtest cursor-size-hints: SUCCESS (0.941s)
[137.398667] [027/134] (888s left) kms_color (ctm-green-to-red)
[138.910163] Starting subtest: ctm-green-to-red
[138.911049] Starting dynamic subtest: pipe-A-HDMI-A-3
[139.566334] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.656s)
[139.575957] Starting dynamic subtest: pipe-B-HDMI-A-3
[140.059622] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.492s)
[140.069493] Starting dynamic subtest: pipe-C-HDMI-A-3
[140.540390] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.480s)
[140.549944] Starting dynamic subtest: pipe-D-HDMI-A-3
[141.026426] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.486s)
[141.027320] Subtest ctm-green-to-red: SUCCESS (2.116s)
[141.275959] [028/134] (885s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic)
[142.783377] Starting subtest: 2x-flip-vs-cursor-atomic
[142.786273] Subtest 2x-flip-vs-cursor-atomic: SKIP (0.002s)
[142.947720] [029/134] (883s left) kms_psr (fbc-psr2-sprite-mmap-gtt)
[144.489653] Subtest fbc-psr2-sprite-mmap-gtt: SKIP (0.000s)
[144.549956] [030/134] (882s left) gem_create (create-clear)
[144.627962] Starting subtest: create-clear
[144.629072] Starting dynamic subtest: lmem0
[180.110934] Dynamic subtest lmem0: SUCCESS (35.479s)
[180.120657] Starting dynamic subtest: smem0
[215.536841] Dynamic subtest smem0: SUCCESS (35.421s)
[215.537678] Subtest create-clear: SUCCESS (70.901s)
[215.906085] [031/134] (810s left) kms_chamelium_hpd (hdmi-hpd)
[217.488476] Subtest hdmi-hpd: SKIP (0.000s)
[217.605835] [032/134] (809s left) i915_suspend (fence-restore-untiled)
[217.720351] Starting subtest: fence-restore-untiled
[217.722574] Subtest fence-restore-untiled: SKIP (0.000s)
[217.886560] [033/134] (808s left) gem_sync (basic-each)
[217.976073] Starting subtest: basic-each
[221.847256] Subtest basic-each: SUCCESS (3.871s)
[222.088720] [034/134] (804s left) kms_frontbuffer_tracking (fbcpsr-argb161616f-draw-mmap-cpu)
[223.597825] Starting subtest: fbcpsr-argb161616f-draw-mmap-cpu
[223.599445] Subtest fbcpsr-argb161616f-draw-mmap-cpu: SKIP (0.000s)
[223.824756] [035/134] (803s left) gem_userptr_blits (map-fixed-invalidate)
[223.920880] Starting subtest: map-fixed-invalidate
[223.922587] Subtest map-fixed-invalidate: SKIP (0.000s)
[224.125862] [036/134] (802s left) api_intel_allocator (reloc-allocator)
[224.202050] Starting subtest: reloc-allocator
[224.202953] Starting dynamic subtest: basic
[224.233380] Dynamic subtest basic: SUCCESS (0.031s)
[224.243746] Starting dynamic subtest: parallel-one
[224.244582] Dynamic subtest parallel-one: SUCCESS (0.005s)
[224.254533] Starting dynamic subtest: print
[224.255427] Dynamic subtest print: SUCCESS (0.000s)
[224.265159] Starting dynamic subtest: reuse
[224.266149] Dynamic subtest reuse: SUCCESS (0.000s)
[224.275539] Starting dynamic subtest: fork-reopen-allocator
[224.276675] Dynamic subtest fork-reopen-allocator: SUCCESS (0.013s)
[224.277746] Subtest reloc-allocator: SUCCESS (0.051s)
[224.461123] [037/134] (802s left) kms_flip (2x-flip-vs-fences)
[225.970870] Starting subtest: 2x-flip-vs-fences
[225.972471] Subtest 2x-flip-vs-fences: SKIP (0.000s)
[226.185237] [038/134] (801s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy)
[227.706208] Starting subtest: 2x-cursor-vs-flip-legacy
[227.709222] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.002s)
[227.877229] [039/134] (799s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-downscaling)
[229.413420] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-downscaling
[229.414299] Starting dynamic subtest: pipe-A-valid-mode
[234.062395] Dynamic subtest pipe-A-valid-mode: SUCCESS (4.648s)
[234.063319] Subtest flip-32bpp-4tile-to-64bpp-4tile-downscaling: SUCCESS (4.650s)
[234.288743] [040/134] (793s left) gem_exec_params (cliprects-invalid)
[234.372163] Starting subtest: cliprects-invalid
[234.373134] Subtest cliprects-invalid: SUCCESS (0.000s)
[234.525879] [041/134] (792s left) gem_mmap (pf-nonblock)
[234.602076] Subtest pf-nonblock: SKIP (0.000s)
[234.661673] [042/134] (792s left) kms_atomic_transition (modeset-transition)
[236.171241] Starting subtest: modeset-transition
[236.172150] Starting dynamic subtest: 1x-outputs
[238.039862] Dynamic subtest 1x-outputs: SUCCESS (1.867s)
[238.041408] Subtest modeset-transition: SUCCESS (1.869s)
[238.274469] [043/134] (789s left) sw_sync (sync_expired_merge)
[238.321290] Starting subtest: sync_expired_merge
[239.395996] Subtest sync_expired_merge: SUCCESS (1.074s)
[239.499200] [044/134] (788s left) syncobj_timeline (invalid-signal-one-illegal-handle)
[239.575161] Starting subtest: invalid-signal-one-illegal-handle
[239.576223] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[239.760640] [045/134] (787s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-pgflip-blt)
[241.288019] Starting subtest: fbcpsr-1p-primscrn-shrfb-pgflip-blt
[241.289726] Subtest fbcpsr-1p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[241.506127] [046/134] (786s left) gem_fenced_exec_thrash (no-spare-fences-busy)
[241.596453] Subtest no-spare-fences-busy: SKIP (0.000s)
[241.681888] [047/134] (786s left) syncobj_wait (wait-all-delayed-signal)
[241.759314] Starting subtest: wait-all-delayed-signal
[241.860051] Subtest wait-all-delayed-signal: SUCCESS (0.102s)
[241.992667] [048/134] (785s left) gem_exec_reloc (basic-concurrent16)
[242.076130] Subtest basic-concurrent16: SKIP (0.000s)
[242.145132] [049/134] (785s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[243.659550] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt
[243.661236] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[243.890715] [050/134] (784s left) kms_big_fb (x-tiled-addfb)
[245.415421] Starting subtest: x-tiled-addfb
[245.416404] Subtest x-tiled-addfb: SUCCESS (0.000s)
[245.637024] [051/134] (782s left) perf_pmu (semaphore-wait)
[245.708478] Starting subtest: semaphore-wait
[245.709401] Starting dynamic subtest: rcs0
[246.248547] Dynamic subtest rcs0: SUCCESS (0.539s)
[246.260754] Starting dynamic subtest: bcs0
[246.760364] Dynamic subtest bcs0: SUCCESS (0.510s)
[246.772682] Starting dynamic subtest: vcs0
[247.272385] Dynamic subtest vcs0: SUCCESS (0.510s)
[247.285006] Starting dynamic subtest: vcs1
[247.784671] Dynamic subtest vcs1: SUCCESS (0.510s)
[247.797747] Starting dynamic subtest: vecs0
[248.297508] Dynamic subtest vecs0: SUCCESS (0.511s)
[248.310103] Starting dynamic subtest: vecs1
[248.809839] Dynamic subtest vecs1: SUCCESS (0.510s)
[248.822711] Starting dynamic subtest: ccs0
[249.322376] Dynamic subtest ccs0: SUCCESS (0.511s)
[249.324024] Subtest semaphore-wait: SUCCESS (3.614s)
[249.514049] [052/134] (778s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs)
[251.026157] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs
[251.027055] Starting dynamic subtest: pipe-A-HDMI-A-3
[251.036284] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.000s)
[251.047034] Starting dynamic subtest: pipe-B-HDMI-A-3
[251.056482] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.000s)
[251.066962] Starting dynamic subtest: pipe-C-HDMI-A-3
[251.075890] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.000s)
[251.086271] Starting dynamic subtest: pipe-D-HDMI-A-3
[251.096460] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.000s)
[251.098432] Subtest random-ccs-data-4-tiled-mtl-rc-ccs: SKIP (0.005s)
[251.340597] [053/134] (776s left) syncobj_timeline (multi-wait-for-submit-signaled)
[251.417955] Starting subtest: multi-wait-for-submit-signaled
[251.418945] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[251.610818] [054/134] (776s left) gem_userptr_blits (invalid-null-pointer)
[251.695280] Starting subtest: invalid-null-pointer
[251.696169] Subtest invalid-null-pointer: SUCCESS (0.001s)
[251.907714] [055/134] (776s left) gem_render_copy (y-tiled-to-vebox-y-tiled)
[251.997972] Starting subtest: y-tiled-to-vebox-y-tiled
[251.999925] Subtest y-tiled-to-vebox-y-tiled: SKIP (0.000s)
[252.266356] [056/134] (776s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-plflip-blt)
[253.788508] Starting subtest: psr-2p-primscrn-shrfb-plflip-blt
[253.790256] Subtest psr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[254.002334] [057/134] (774s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[255.516289] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-wc
[255.517931] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[255.731009] [058/134] (773s left) kms_ccs (bad-aux-stride-y-tiled-ccs)
[257.252384] Starting subtest: bad-aux-stride-y-tiled-ccs
[257.253260] Starting dynamic subtest: pipe-A-HDMI-A-3
[257.261771] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.000s)
[257.272494] Starting dynamic subtest: pipe-B-HDMI-A-3
[257.281175] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.000s)
[257.291526] Starting dynamic subtest: pipe-C-HDMI-A-3
[257.299788] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.000s)
[257.310184] Starting dynamic subtest: pipe-D-HDMI-A-3
[257.320074] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.000s)
[257.321800] Subtest bad-aux-stride-y-tiled-ccs: SKIP (0.005s)
[257.585366] [059/134] (771s left) syncobj_wait (invalid-multi-wait-unsubmitted-signaled)
[257.664290] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[257.665206] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[257.814393] [060/134] (771s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-blt)
[259.326936] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-blt
[259.328636] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[259.557353] [061/134] (769s left) kms_sequence (get-forked)
[261.069425] Starting subtest: get-forked
[261.070350] Starting dynamic subtest: pipe-A-HDMI-A-3
[263.457846] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.388s)
[263.468518] Starting dynamic subtest: pipe-B-HDMI-A-3
[265.699413] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (2.241s)
[265.711018] Starting dynamic subtest: pipe-C-HDMI-A-3
[267.960797] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (2.260s)
[267.972579] Starting dynamic subtest: pipe-D-HDMI-A-3
[270.227634] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.266s)
[270.228486] Subtest get-forked: SUCCESS (9.159s)
[270.478065] [062/134] (758s left) gen3_render_tiledy_blits
[270.631733] [063/134] (758s left) syncobj_timeline (etime-single-wait-for-submit-submitted)
[270.708317] Starting subtest: etime-single-wait-for-submit-submitted
[270.815117] Subtest etime-single-wait-for-submit-submitted: SUCCESS (0.106s)
[271.032249] [064/134] (758s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-render)
[272.546423] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-render
[272.548147] Subtest psr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[272.765323] [065/134] (756s left) kms_feature_discovery (display-3x)
[274.280338] Starting subtest: display-3x
[274.282159] Subtest display-3x: SKIP (0.000s)
[274.469351] [066/134] (755s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-wc)
[276.013959] Starting subtest: fbc-rgb101010-draw-mmap-wc
[276.015696] Subtest fbc-rgb101010-draw-mmap-wc: SKIP (0.000s)
[276.238734] [067/134] (753s left) gem_exec_balancer (full-pulse)
[276.334371] Starting subtest: full-pulse
[278.380514] Subtest full-pulse: SUCCESS (2.046s)
[278.833353] [068/134] (750s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[280.343570] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[280.344435] Starting dynamic subtest: pipe-A-valid-mode
[280.716299] Dynamic subtest pipe-A-valid-mode: SKIP (0.372s)
[280.718695] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.373s)
[280.965906] [069/134] (748s left) kms_big_fb (yf-tiled-32bpp-rotate-270)
[282.488989] Starting subtest: yf-tiled-32bpp-rotate-270
[282.490848] Subtest yf-tiled-32bpp-rotate-270: SKIP (0.000s)
[282.694467] [070/134] (747s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-blt)
[284.215293] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-blt
[284.216919] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[284.424589] [071/134] (745s left) gem_fence_thrash (bo-write-verify-threaded-none)
[284.476168] Starting subtest: bo-write-verify-threaded-none
[284.506036] Subtest bo-write-verify-threaded-none: SKIP (0.029s)
[284.584007] [072/134] (745s left) gem_ctx_persistence (engines-hang)
[284.676769] Starting subtest: engines-hang
[284.677646] Starting dynamic subtest: rcs0
[284.826995] Dynamic subtest rcs0: SUCCESS (0.149s)
[284.839749] Starting dynamic subtest: bcs0
[284.933067] Dynamic subtest bcs0: SUCCESS (0.104s)
[284.970158] Starting dynamic subtest: vcs0
[284.986301] Dynamic subtest vcs0: SUCCESS (0.052s)
[285.005973] Starting dynamic subtest: vcs1
[285.083822] Dynamic subtest vcs1: SUCCESS (0.096s)
[285.119418] Starting dynamic subtest: vecs0
[285.120727] Dynamic subtest vecs0: SUCCESS (0.029s)
[285.138403] Starting dynamic subtest: vecs1
[285.242495] Dynamic subtest vecs1: SUCCESS (0.126s)
[285.255502] Starting dynamic subtest: ccs0
[285.346930] Dynamic subtest ccs0: SUCCESS (0.102s)
[285.348411] Subtest engines-hang: SUCCESS (0.671s)
[285.570139] [073/134] (744s left) kms_plane_lowres (tiling-4)
[287.087674] Starting subtest: tiling-4
[287.088534] Starting dynamic subtest: pipe-A-HDMI-A-3
[295.868764] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (8.781s)
[295.952198] Starting dynamic subtest: pipe-B-HDMI-A-3
[305.007510] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (9.065s)
[305.077381] Starting dynamic subtest: pipe-C-HDMI-A-3
[313.557634] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (8.491s)
[313.625074] Starting dynamic subtest: pipe-D-HDMI-A-3
[322.118162] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (8.502s)
[322.191648] Subtest tiling-4: SUCCESS (35.104s)
[322.448015] [074/134] (707s left) gem_exercise_blt (fast-copy)
[322.535473] Starting subtest: fast-copy
[322.536423] Starting dynamic subtest: linear-smem-smem
[322.585200] Dynamic subtest linear-smem-smem: SUCCESS (0.049s)
[322.597760] Starting dynamic subtest: linear-smem-lmem0
[322.602137] Dynamic subtest linear-smem-lmem0: SUCCESS (0.016s)
[322.614358] Starting dynamic subtest: linear-lmem0-smem
[322.719279] Dynamic subtest linear-lmem0-smem: SUCCESS (0.115s)
[322.729587] Starting dynamic subtest: linear-lmem0-lmem0
[322.833672] Dynamic subtest linear-lmem0-lmem0: SUCCESS (0.114s)
[322.844300] Starting dynamic subtest: xmajor-smem-smem
[322.852153] Dynamic subtest xmajor-smem-smem: SUCCESS (0.017s)
[322.864390] Starting dynamic subtest: xmajor-smem-lmem0
[322.867958] Dynamic subtest xmajor-smem-lmem0: SUCCESS (0.015s)
[322.880277] Starting dynamic subtest: xmajor-lmem0-smem
[322.985687] Dynamic subtest xmajor-lmem0-smem: SUCCESS (0.116s)
[322.996501] Starting dynamic subtest: xmajor-lmem0-lmem0
[323.100641] Dynamic subtest xmajor-lmem0-lmem0: SUCCESS (0.114s)
[323.112569] Starting dynamic subtest: tile4-smem-smem
[323.117019] Dynamic subtest tile4-smem-smem: SUCCESS (0.015s)
[323.129115] Starting dynamic subtest: tile4-smem-lmem0
[323.132806] Dynamic subtest tile4-smem-lmem0: SUCCESS (0.015s)
[323.145070] Starting dynamic subtest: tile4-lmem0-smem
[323.250126] Dynamic subtest tile4-lmem0-smem: SUCCESS (0.116s)
[323.260559] Starting dynamic subtest: tile4-lmem0-lmem0
[323.366776] Dynamic subtest tile4-lmem0-lmem0: SUCCESS (0.114s)
[323.377581] Starting dynamic subtest: tile64-smem-smem
[323.383399] Dynamic subtest tile64-smem-smem: SUCCESS (0.017s)
[323.395588] Starting dynamic subtest: tile64-smem-lmem0
[323.399275] Dynamic subtest tile64-smem-lmem0: SUCCESS (0.015s)
[323.411356] Starting dynamic subtest: tile64-lmem0-smem
[323.517801] Dynamic subtest tile64-lmem0-smem: SUCCESS (0.116s)
[323.528554] Starting dynamic subtest: tile64-lmem0-lmem0
[323.615232] Dynamic subtest tile64-lmem0-lmem0: SUCCESS (0.098s)
[323.623332] Subtest fast-copy: SUCCESS (1.080s)
[323.781423] [075/134] (706s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[325.293968] Starting subtest: compare-crc-sanitycheck-xr24
[325.296376] Starting dynamic subtest: pipe-A-HDMI-A-3
[325.797441] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.502s)
[325.811582] Starting dynamic subtest: pipe-B-HDMI-A-3
[326.165296] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.365s)
[326.177561] Starting dynamic subtest: pipe-C-HDMI-A-3
[326.550370] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.384s)
[326.563447] Starting dynamic subtest: pipe-D-HDMI-A-3
[326.906197] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.353s)
[326.907172] Subtest compare-crc-sanitycheck-xr24: SUCCESS (1.613s)
[327.149806] [076/134] (703s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted)
[327.231425] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted
[327.334289] Subtest etime-multi-wait-all-available-unsubmitted-submitted: SUCCESS (0.102s)
[327.502120] [077/134] (702s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render)
[329.023212] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render
[329.024975] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[329.263470] [078/134] (701s left) gem_exec_reloc (basic-cpu)
[329.354086] Subtest basic-cpu: SKIP (0.000s)
[329.445665] [079/134] (701s left) syncobj_timeline (reset-unsignaled)
[329.528433] Starting subtest: reset-unsignaled
[329.529395] Subtest reset-unsignaled: SUCCESS (0.000s)
[329.719932] [080/134] (701s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs)
[331.229150] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs
[331.230051] Starting dynamic subtest: pipe-A-HDMI-A-3
[331.238478] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.001s)
[331.249349] Starting dynamic subtest: pipe-B-HDMI-A-3
[331.257958] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.001s)
[331.268551] Starting dynamic subtest: pipe-C-HDMI-A-3
[331.277147] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.001s)
[331.287717] Starting dynamic subtest: pipe-D-HDMI-A-3
[331.297431] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.001s)
[331.299152] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs: SKIP (0.010s)
[331.550467] [081/134] (699s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-msflip-blt)
[333.064875] Starting subtest: psr-1p-primscrn-indfb-msflip-blt
[333.066494] Subtest psr-1p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[333.283882] [082/134] (697s left) kms_psr (psr-cursor-plane-move)
[334.799490] Subtest psr-cursor-plane-move: SKIP (0.000s)
[334.855997] [083/134] (696s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-onoff)
[336.375107] Starting subtest: psr-2p-scndscrn-cur-indfb-onoff
[336.376926] Subtest psr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[336.590583] [084/134] (694s left) gem_wait (write-wait)
[336.683939] Starting subtest: write-wait
[336.685070] Starting dynamic subtest: all-engines
[337.822261] Dynamic subtest all-engines: SUCCESS (1.138s)
[337.836758] Starting dynamic subtest: rcs0
[338.880315] Dynamic subtest rcs0: SUCCESS (1.057s)
[338.895626] Starting dynamic subtest: bcs0
[339.937167] Dynamic subtest bcs0: SUCCESS (1.055s)
[339.952081] Starting dynamic subtest: vcs0
[340.995513] Dynamic subtest vcs0: SUCCESS (1.054s)
[341.014436] Starting dynamic subtest: vcs1
[342.056163] Dynamic subtest vcs1: SUCCESS (1.057s)
[342.075299] Starting dynamic subtest: vecs0
[343.119201] Dynamic subtest vecs0: SUCCESS (1.059s)
[343.137576] Starting dynamic subtest: vecs1
[344.180360] Dynamic subtest vecs1: SUCCESS (1.057s)
[344.195125] Starting dynamic subtest: ccs0
[345.236213] Dynamic subtest ccs0: SUCCESS (1.052s)
[345.241098] Subtest write-wait: SUCCESS (8.554s)
[345.529228] [085/134] (685s left) kms_cursor_legacy (cursorb-vs-flipa-varying-size)
[347.041160] Starting subtest: cursorB-vs-flipA-varying-size
[347.042964] Subtest cursorB-vs-flipA-varying-size: SKIP (0.002s)
[347.233598] [086/134] (684s left) perf (blocking-parameterized)
[347.681156] Starting subtest: blocking-parameterized
[367.714362] Subtest blocking-parameterized: SUCCESS (20.033s)
[367.777527] [087/134] (663s left) kms_chamelium_edid (hdmi-edid-read)
[369.339240] Subtest hdmi-edid-read: SKIP (0.000s)
[369.441830] [088/134] (661s left) prime_mmap (test_errors)
[369.524219] Starting subtest: test_errors
[369.525164] Starting dynamic subtest: test_errors-smem
[369.750048] Dynamic subtest test_errors-smem: SUCCESS (0.225s)
[369.760757] Starting dynamic subtest: test_errors-lmem0
[370.730474] Dynamic subtest test_errors-lmem0: SUCCESS (0.979s)
[370.731498] Subtest test_errors: SUCCESS (1.206s)
[370.881029] [089/134] (660s left) fbdev (pan)
[370.928888] Starting subtest: pan
[370.974144] Subtest pan: SUCCESS (0.046s)
[371.107032] [090/134] (660s left) kms_invalid_mode (zero-clock)
[372.615986] Starting subtest: zero-clock
[372.616989] Starting dynamic subtest: pipe-A-HDMI-A-3
[372.663635] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.048s)
[372.675994] Starting dynamic subtest: pipe-B-HDMI-A-3
[372.677167] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.001s)
[372.687953] Starting dynamic subtest: pipe-C-HDMI-A-3
[372.688867] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.001s)
[372.699479] Starting dynamic subtest: pipe-D-HDMI-A-3
[372.700398] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.001s)
[372.701317] Subtest zero-clock: SUCCESS (0.057s)
[372.903085] [091/134] (658s left) kms_atomic_transition (plane-all-transition-nonblocking)
[374.413166] Starting subtest: plane-all-transition-nonblocking
[374.414170] Starting dynamic subtest: pipe-A-HDMI-A-3
[378.169457] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (3.755s)
[378.254216] Starting dynamic subtest: pipe-B-HDMI-A-3
[382.151287] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (3.907s)
[382.209583] Subtest plane-all-transition-nonblocking: SUCCESS (7.796s)
[382.435100] [092/134] (649s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-pgflip-blt)
[383.959969] Starting subtest: fbc-2p-scndscrn-indfb-pgflip-blt
[383.961771] Subtest fbc-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[384.164720] [093/134] (647s left) gem_pxp (regular-baseline-src-copy-readible)
[386.783461] Starting subtest: regular-baseline-src-copy-readible
[386.785542] Subtest regular-baseline-src-copy-readible: SKIP (0.000s)
[386.921677] [094/134] (644s left) kms_plane_scaling (planes-downscale-factor-0-5)
[388.432158] Starting subtest: planes-downscale-factor-0-5
[388.433030] Starting dynamic subtest: pipe-A
[388.528389] Dynamic subtest pipe-A: SUCCESS (0.097s)
[388.546286] Starting dynamic subtest: pipe-B
[388.691792] Dynamic subtest pipe-B: SUCCESS (0.162s)
[388.713266] Starting dynamic subtest: pipe-C
[388.834259] Dynamic subtest pipe-C: SUCCESS (0.141s)
[388.846423] Starting dynamic subtest: pipe-D
[388.958580] Dynamic subtest pipe-D: SUCCESS (0.123s)
[388.959481] Subtest planes-downscale-factor-0-5: SUCCESS (0.528s)
[389.221333] [095/134] (642s left) kms_psr (fbc-pr-cursor-mmap-gtt)
[390.737524] Subtest fbc-pr-cursor-mmap-gtt: SKIP (0.000s)
[390.864861] [096/134] (641s left) kms_content_protection (legacy-hdcp14)
[392.458261] Starting subtest: legacy-hdcp14
[392.466799] Subtest legacy-hdcp14: SKIP (0.006s)
[392.666709] [097/134] (639s left) gem_caching (writes)
[392.751152] Starting subtest: writes
[396.988640] Subtest writes: SUCCESS (4.237s)
[397.203154] [098/134] (635s left) kms_cursor_crc (cursor-onscreen-128x42)
[398.924337] Starting subtest: cursor-onscreen-128x42
[398.929394] Starting dynamic subtest: pipe-A-HDMI-A-3
[401.624426] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.695s)
[401.661383] Starting dynamic subtest: pipe-D-HDMI-A-3
[404.284069] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.632s)
[404.284975] Subtest cursor-onscreen-128x42: SUCCESS (5.359s)
[404.678011] [099/134] (627s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt)
[406.193053] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt
[409.053728] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (2.861s)
[409.294780] [100/134] (623s left) core_auth (getclient-master-drop)
[409.343156] Starting subtest: getclient-master-drop
[409.386356] Subtest getclient-master-drop: SUCCESS (0.044s)
[409.612616] [101/134] (622s left) gem_lmem_swapping (random)
[414.183894] Starting subtest: random
[414.185309] Starting dynamic subtest: lmem0
[415.123375] Dynamic subtest lmem0: SUCCESS (0.938s)
[415.124310] Subtest random: SUCCESS (0.940s)
[417.333028] [FACT gem_lmem_swapping (random)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[417.334016] [FACT gem_lmem_swapping (random)] deleted: kernel.kmod_is_loaded.i915: true
[417.335934] [102/134] (615s left) kms_psr (pr-cursor-blt)
[422.294465] Subtest pr-cursor-blt: SKIP (0.000s)
[422.376562] [FACT kms_psr (pr-cursor-blt)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[422.379378] [FACT kms_psr (pr-cursor-blt)] new: kernel.kmod_is_loaded.i915: true
[422.382936] [103/134] (610s left) kms_async_flips (alternate-sync-async-flip)
[423.909265] Starting subtest: alternate-sync-async-flip
[424.121577] Starting dynamic subtest: pipe-A-HDMI-A-3
[426.426565] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.305s)
[426.625608] Starting dynamic subtest: pipe-B-HDMI-A-3
[428.713685] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (2.096s)
[428.893430] Starting dynamic subtest: pipe-C-HDMI-A-3
[430.972583] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (2.087s)
[431.187862] Starting dynamic subtest: pipe-D-HDMI-A-3
[433.259292] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.088s)
[433.264094] Subtest alternate-sync-async-flip: SUCCESS (9.352s)
[433.693200] [104/134] (598s left) gem_exec_whisper (basic-contexts-all)
[433.787116] Starting subtest: basic-contexts-all
[455.834316] Subtest basic-contexts-all: SUCCESS (22.045s)
[456.063288] [105/134] (576s left) syncobj_wait (wait-any-interrupted)
[456.140420] Starting subtest: wait-any-interrupted
[456.241749] Subtest wait-any-interrupted: SUCCESS (0.101s)
[456.411712] [106/134] (576s left) kms_rotation_crc (bad-pixel-format)
[457.921185] Starting subtest: bad-pixel-format
[457.923035] Subtest bad-pixel-format: SKIP (0.001s)
[458.071283] [107/134] (574s left) kms_addfb_basic (too-wide)
[459.612234] Starting subtest: too-wide
[459.613178] Subtest too-wide: SUCCESS (0.000s)
[459.819034] [108/134] (573s left) gem_spin_batch (legacy-resubmit-new)
[459.915952] Starting subtest: legacy-resubmit-new
[459.916912] Starting dynamic subtest: default
[459.947439] Dynamic subtest default: SUCCESS (0.031s)
[459.959188] Starting dynamic subtest: render
[459.960116] Dynamic subtest render: SUCCESS (0.005s)
[459.970112] Starting dynamic subtest: bsd
[459.971030] Dynamic subtest bsd: SUCCESS (0.006s)
[459.980987] Starting dynamic subtest: bsd1
[459.981939] Dynamic subtest bsd1: SUCCESS (0.004s)
[459.992376] Starting dynamic subtest: bsd2
[459.993439] Dynamic subtest bsd2: SUCCESS (0.004s)
[460.003244] Starting dynamic subtest: blt
[460.004150] Dynamic subtest blt: SUCCESS (0.004s)
[460.014038] Starting dynamic subtest: vebox
[460.015192] Dynamic subtest vebox: SUCCESS (0.005s)
[460.016157] Subtest legacy-resubmit-new: SUCCESS (0.069s)
[460.315211] [109/134] (572s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-downscaling)
[461.824251] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-downscaling
[461.825166] Starting dynamic subtest: pipe-A-valid-mode
[461.870279] Dynamic subtest pipe-A-valid-mode: SKIP (0.044s)
[461.872088] Subtest flip-64bpp-ytile-to-16bpp-ytile-downscaling: SKIP (0.046s)
[462.080240] [110/134] (571s left) gem_exec_balancer (parallel-keep-submit-fence)
[462.449985] Starting subtest: parallel-keep-submit-fence
[464.681286] Subtest parallel-keep-submit-fence: SUCCESS (2.231s)
[464.845678] [111/134] (568s left) perf (non-system-wide-paranoid)
[465.263375] Starting subtest: non-system-wide-paranoid
[465.298959] Subtest non-system-wide-paranoid: SUCCESS (0.036s)
[465.366787] [112/134] (567s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions)
[466.878112] Starting subtest: short-busy-flip-before-cursor-atomic-transitions
[466.879890] Subtest short-busy-flip-before-cursor-atomic-transitions: SKIP (0.000s)
[467.044281] [113/134] (566s left) kms_busy (basic)
[468.591171] Starting subtest: basic
[468.592058] Starting dynamic subtest: flip
[469.192194] Dynamic subtest flip: SUCCESS (0.601s)
[469.207951] Starting dynamic subtest: modeset
[469.900610] Dynamic subtest modeset: SUCCESS (0.707s)
[469.901492] Subtest basic: SUCCESS (1.311s)
[470.174962] [114/134] (563s left) kms_plane (plane-panning-bottom-right-suspend)
[471.688137] Starting subtest: plane-panning-bottom-right-suspend
[471.688985] Starting dynamic subtest: pipe-A
[491.554335] Dynamic subtest pipe-A: SUCCESS (4.489s)
[491.568622] Starting dynamic subtest: pipe-B
[511.481353] Dynamic subtest pipe-B: SUCCESS (3.811s)
[511.482189] Subtest plane-panning-bottom-right-suspend: SUCCESS (8.304s)
[521.702289] [115/134] (521s left) syncobj_wait (invalid-multi-wait-all-unsubmitted)
[521.781053] Starting subtest: invalid-multi-wait-all-unsubmitted
[521.781988] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[521.938346] [116/134] (521s left) kms_big_fb (linear-64bpp-rotate-180)
[523.475909] Starting subtest: linear-64bpp-rotate-180
[525.445868] Subtest linear-64bpp-rotate-180: SUCCESS (1.956s)
[525.675909] [117/134] (517s left) perf (invalid-oa-metric-set-id)
[525.956355] Starting subtest: invalid-oa-metric-set-id
[525.972443] Subtest invalid-oa-metric-set-id: SUCCESS (0.016s)
[526.062055] [118/134] (517s left) gen7_exec_parse (batch-without-end)
[526.148882] Subtest batch-without-end: SKIP (0.000s)
[526.236415] [119/134] (517s left) perf_pmu (most-busy-idle-check-all)
[526.306682] Starting subtest: most-busy-idle-check-all
[526.307636] Starting dynamic subtest: rcs0
[527.017060] Dynamic subtest rcs0: FAIL (0.682s)
[527.033048] Starting dynamic subtest: bcs0
[527.673857] Dynamic subtest bcs0: SUCCESS (0.675s)
[527.689981] Starting dynamic subtest: vcs0
[528.332155] Dynamic subtest vcs0: SUCCESS (0.651s)
[528.352244] Starting dynamic subtest: vcs1
[528.997249] Dynamic subtest vcs1: SUCCESS (0.658s)
[529.016893] Starting dynamic subtest: vecs0
[529.658408] Dynamic subtest vecs0: SUCCESS (0.655s)
[529.672270] Starting dynamic subtest: vecs1
[530.312281] Dynamic subtest vecs1: SUCCESS (0.650s)
[530.326487] Starting dynamic subtest: ccs0
[530.971138] Dynamic subtest ccs0: SUCCESS (0.655s)
[530.975962] Subtest most-busy-idle-check-all: FAIL (4.645s)
[531.153382] [120/134] (512s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs)
[532.666941] Starting subtest: crc-sprite-planes-basic-4-tiled-bmg-ccs
[532.668748] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[532.934302] [121/134] (510s left) perf_pmu (all-busy-idle-check-all)
[533.004586] Starting subtest: all-busy-idle-check-all
[533.686603] Subtest all-busy-idle-check-all: SUCCESS (0.680s)
[533.878217] [122/134] (510s left) kms_rotation_crc (primary-x-tiled-reflect-x-0)
[535.407055] Starting subtest: primary-x-tiled-reflect-x-0
[545.594672] Subtest primary-x-tiled-reflect-x-0: SUCCESS (10.174s)
[545.891751] [123/134] (498s left) syncobj_wait (multi-wait-submitted)
[545.969261] Starting subtest: multi-wait-submitted
[546.071547] Subtest multi-wait-submitted: SUCCESS (0.102s)
[546.239873] [124/134] (497s left) dmabuf_sync_file (export-before-signal)
[546.302084] Starting subtest: export-before-signal
[546.303024] Subtest export-before-signal: SUCCESS (0.001s)
[546.425430] [125/134] (497s left) kms_ccs (crc-primary-basic-4-tiled-mtl-mc-ccs)
[547.938932] Starting subtest: crc-primary-basic-4-tiled-mtl-mc-ccs
[547.939813] Starting dynamic subtest: pipe-A-HDMI-A-3
[547.948232] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.001s)
[547.961144] Starting dynamic subtest: pipe-B-HDMI-A-3
[547.970452] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.001s)
[547.982654] Starting dynamic subtest: pipe-C-HDMI-A-3
[547.990969] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.001s)
[548.002922] Starting dynamic subtest: pipe-D-HDMI-A-3
[548.011956] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.001s)
[548.013785] Subtest crc-primary-basic-4-tiled-mtl-mc-ccs: SKIP (0.010s)
[548.251676] [126/134] (496s left) kms_prop_blob (blob-prop-validate)
[548.331171] Starting subtest: blob-prop-validate
[548.332102] Subtest blob-prop-validate: SUCCESS (0.000s)
[548.524606] [127/134] (495s left) kms_vblank (query-busy-hang)
[550.043040] Starting subtest: query-busy-hang
[550.043957] Starting dynamic subtest: pipe-A-HDMI-A-3
[577.062331] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (27.014s)
[577.078021] Starting dynamic subtest: pipe-D-HDMI-A-3
[601.993743] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (24.918s)
[601.994740] Subtest query-busy-hang: SUCCESS (51.939s)
[602.233469] [128/134] (442s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move)
[603.746688] Starting subtest: psr-2p-primscrn-cur-indfb-move
[603.748343] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[603.967475] [129/134] (440s left) kms_frontbuffer_tracking (fbc-abgr161616f-draw-mmap-wc)
[605.484655] Starting subtest: fbc-abgr161616f-draw-mmap-wc
[605.486269] Subtest fbc-abgr161616f-draw-mmap-wc: SKIP (0.000s)
[605.702336] [130/134] (438s left) gem_exec_schedule (promotion)
[605.795249] Starting subtest: promotion
[605.796229] Starting dynamic subtest: rcs0
[606.081820] Dynamic subtest rcs0: SUCCESS (0.285s)
[606.094362] Starting dynamic subtest: bcs0
[606.287926] Dynamic subtest bcs0: SUCCESS (0.205s)
[606.299974] Starting dynamic subtest: vcs0
[606.505529] Dynamic subtest vcs0: SUCCESS (0.216s)
[606.518538] Starting dynamic subtest: vcs1
[606.724174] Dynamic subtest vcs1: SUCCESS (0.218s)
[606.736857] Starting dynamic subtest: vecs0
[606.948548] Dynamic subtest vecs0: SUCCESS (0.223s)
[606.961348] Starting dynamic subtest: vecs1
[607.166007] Dynamic subtest vecs1: SUCCESS (0.216s)
[607.178798] Starting dynamic subtest: ccs0
[607.404186] Dynamic subtest ccs0: SUCCESS (0.237s)
[607.405098] Subtest promotion: SUCCESS (1.609s)
[607.829633] [131/134] (436s left) gem_ctx_persistence (legacy-engines-queued)
[607.913841] Starting subtest: legacy-engines-queued
[607.914891] Starting dynamic subtest: render
[608.028196] Dynamic subtest render: SUCCESS (0.114s)
[608.049912] Starting dynamic subtest: bsd1
[608.061042] Dynamic subtest bsd1: SUCCESS (0.031s)
[608.077620] Starting dynamic subtest: bsd2
[608.150235] Dynamic subtest bsd2: SUCCESS (0.087s)
[608.182353] Starting dynamic subtest: blt
[608.213390] Dynamic subtest blt: SUCCESS (0.060s)
[608.247600] Starting dynamic subtest: vebox
[608.300480] Dynamic subtest vebox: SUCCESS (0.084s)
[608.305271] Subtest legacy-engines-queued: SUCCESS (0.388s)
[608.527189] [132/134] (436s left) gem_readwrite (new-obj)
[608.604028] Subtest new-obj: SKIP (0.000s)
[608.689521] [133/134] (436s left) gem_exec_reloc (basic-cpu-read-noreloc)
[608.771018] Subtest basic-cpu-read-noreloc: SKIP (0.000s)
[608.845673] [134/134] (436s left) gem_exec_schedule (preemptive-hang)
[609.058127] Starting subtest: preemptive-hang
[609.059307] Starting dynamic subtest: rcs0
[618.614161] Dynamic subtest rcs0: SUCCESS (9.555s)
[618.626999] Starting dynamic subtest: bcs0
[627.630236] Dynamic subtest bcs0: SUCCESS (9.018s)
[627.643027] Starting dynamic subtest: vcs0
[636.610982] Dynamic subtest vcs0: SUCCESS (8.981s)
[636.623808] Starting dynamic subtest: vcs1
[645.643022] Dynamic subtest vcs1: SUCCESS (9.022s)
[645.655920] Starting dynamic subtest: vecs0
[654.670389] Dynamic subtest vecs0: SUCCESS (9.035s)
[654.683252] Starting dynamic subtest: vecs1
[663.611541] Dynamic subtest vecs1: SUCCESS (8.939s)
[663.624333] Starting dynamic subtest: ccs0
[672.632656] Dynamic subtest ccs0: SUCCESS (9.019s)
[672.633485] Subtest preemptive-hang: SUCCESS (63.577s)
[672.963237] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_hdr
results: parsing output: 2/ for test: i915_module_load
results: parsing output: 3/ for test: kms_psr2_sf
results: parsing output: 4/ for test: kms_pm_rpm
results: parsing output: 5/ for test: kms_rotation_crc
results: parsing output: 6/ for test: vgem_basic
results: parsing output: 7/ for test: kms_addfb_basic
results: parsing output: 8/ for test: gem_mmap_gtt
results: parsing output: 9/ for test: gem_eio
results: parsing output: 10/ for test: gem_ctx_shared
results: parsing output: 11/ for test: kms_rotation_crc
results: parsing output: 12/ for test: gem_exec_fence
results: parsing output: 13/ for test: kms_big_fb
results: parsing output: 14/ for test: kms_psr
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: i915_pm_rpm
results: parsing output: 17/ for test: syncobj_timeline
results: parsing output: 18/ for test: kms_pm_rpm
results: parsing output: 19/ for test: kms_big_fb
results: parsing output: 20/ for test: gem_render_copy
results: parsing output: 21/ for test: i915_drm_fdinfo
results: parsing output: 22/ for test: kms_cursor_edge_walk
results: parsing output: 23/ for test: kms_big_fb
results: parsing output: 24/ for test: kms_psr
results: parsing output: 25/ for test: kms_cursor_crc
results: parsing output: 26/ for test: kms_color
results: parsing output: 27/ for test: kms_cursor_legacy
results: parsing output: 28/ for test: kms_psr
results: parsing output: 29/ for test: gem_create
results: parsing output: 30/ for test: kms_chamelium_hpd
results: parsing output: 31/ for test: i915_suspend
results: parsing output: 32/ for test: gem_sync
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: gem_userptr_blits
results: parsing output: 35/ for test: api_intel_allocator
results: parsing output: 36/ for test: kms_flip
results: parsing output: 37/ for test: kms_cursor_legacy
results: parsing output: 38/ for test: kms_flip_scaled_crc
results: parsing output: 39/ for test: gem_exec_params
results: parsing output: 40/ for test: gem_mmap
results: parsing output: 41/ for test: kms_atomic_transition
results: parsing output: 42/ for test: sw_sync
results: parsing output: 43/ for test: syncobj_timeline
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: gem_fenced_exec_thrash
results: parsing output: 46/ for test: syncobj_wait
results: parsing output: 47/ for test: gem_exec_reloc
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_big_fb
results: parsing output: 50/ for test: perf_pmu
results: parsing output: 51/ for test: kms_ccs
results: parsing output: 52/ for test: syncobj_timeline
results: parsing output: 53/ for test: gem_userptr_blits
results: parsing output: 54/ for test: gem_render_copy
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_ccs
results: parsing output: 58/ for test: syncobj_wait
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: kms_sequence
results: parsing output: 61/ for test: gen3_render_tiledy_blits
results: parsing output: 62/ for test: syncobj_timeline
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_feature_discovery
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: gem_exec_balancer
results: parsing output: 67/ for test: kms_flip_scaled_crc
results: parsing output: 68/ for test: kms_big_fb
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: gem_fence_thrash
results: parsing output: 71/ for test: gem_ctx_persistence
results: parsing output: 72/ for test: kms_plane_lowres
results: parsing output: 73/ for test: gem_exercise_blt
results: parsing output: 74/ for test: kms_pipe_crc_basic
results: parsing output: 75/ for test: syncobj_timeline
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: gem_exec_reloc
results: parsing output: 78/ for test: syncobj_timeline
results: parsing output: 79/ for test: kms_ccs
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: kms_psr
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: gem_wait
results: parsing output: 84/ for test: kms_cursor_legacy
results: parsing output: 85/ for test: perf
results: parsing output: 86/ for test: kms_chamelium_edid
results: parsing output: 87/ for test: prime_mmap
results: parsing output: 88/ for test: fbdev
results: parsing output: 89/ for test: kms_invalid_mode
results: parsing output: 90/ for test: kms_atomic_transition
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: gem_pxp
results: parsing output: 93/ for test: kms_plane_scaling
results: parsing output: 94/ for test: kms_psr
results: parsing output: 95/ for test: kms_content_protection
results: parsing output: 96/ for test: gem_caching
results: parsing output: 97/ for test: kms_cursor_crc
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: core_auth
results: parsing output: 100/ for test: gem_lmem_swapping
results: parsing output: 101/ for test: kms_psr
results: parsing output: 102/ for test: kms_async_flips
results: parsing output: 103/ for test: gem_exec_whisper
results: parsing output: 104/ for test: syncobj_wait
results: parsing output: 105/ for test: kms_rotation_crc
results: parsing output: 106/ for test: kms_addfb_basic
results: parsing output: 107/ for test: gem_spin_batch
results: parsing output: 108/ for test: kms_flip_scaled_crc
results: parsing output: 109/ for test: gem_exec_balancer
results: parsing output: 110/ for test: perf
results: parsing output: 111/ for test: kms_cursor_legacy
results: parsing output: 112/ for test: kms_busy
results: parsing output: 113/ for test: kms_plane
results: parsing output: 114/ for test: syncobj_wait
results: parsing output: 115/ for test: kms_big_fb
results: parsing output: 116/ for test: perf
results: parsing output: 117/ for test: gen7_exec_parse
results: parsing output: 118/ for test: perf_pmu
results: parsing output: 119/ for test: kms_ccs
results: parsing output: 120/ for test: perf_pmu
results: parsing output: 121/ for test: kms_rotation_crc
results: parsing output: 122/ for test: syncobj_wait
results: parsing output: 123/ for test: dmabuf_sync_file
results: parsing output: 124/ for test: kms_ccs
results: parsing output: 125/ for test: kms_prop_blob
results: parsing output: 126/ for test: kms_vblank
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: gem_exec_schedule
results: parsing output: 130/ for test: gem_ctx_persistence
results: parsing output: 131/ for test: gem_readwrite
results: parsing output: 132/ for test: gem_exec_reloc
results: parsing output: 133/ for test: gem_exec_schedule
Done.