[35.297862] Initializing watchdogs
[35.298191]   /dev/watchdog0
[35.313747] [001/142] (960s left) gem_exec_params (no-blt)
[35.493201] Starting subtest: no-blt
[35.507071] Subtest no-blt: SUCCESS (0.011s)
[35.601824] [002/142] (960s left) kms_atomic_interruptible (universal-setplane-cursor)
[35.844953] Starting subtest: universal-setplane-cursor
[35.848232] Starting dynamic subtest: DP-1-pipe-A
[42.399684] Dynamic subtest DP-1-pipe-A: SUCCESS (6.551s)
[42.401129] Subtest universal-setplane-cursor: SUCCESS (6.554s)
[42.732902] [003/142] (953s left) v3d/v3d_submit_csd (multi-and-single-sync)
[42.936245] Subtest multi-and-single-sync: SKIP (0.000s)
[42.998555] [004/142] (952s left) drm_fdinfo (most-busy-idle-check-all)
[43.145095] Starting subtest: most-busy-idle-check-all
[43.146648] Starting dynamic subtest: rcs0
[43.780388] Dynamic subtest rcs0: SUCCESS (0.635s)
[43.796597] Starting dynamic subtest: bcs0
[44.406892] Dynamic subtest bcs0: SUCCESS (0.626s)
[44.422092] Starting dynamic subtest: vcs0
[45.030143] Dynamic subtest vcs0: SUCCESS (0.623s)
[45.045222] Starting dynamic subtest: vecs0
[45.656517] Dynamic subtest vecs0: SUCCESS (0.626s)
[45.658391] Subtest most-busy-idle-check-all: SUCCESS (2.511s)
[45.731762] [005/142] (950s left) syncobj_wait (wait-for-submit-snapshot)
[45.874196] Starting subtest: wait-for-submit-snapshot
[45.957133] Subtest wait-for-submit-snapshot: SUCCESS (0.082s)
[46.033137] [006/142] (949s left) kms_vblank (pipe-c-ts-continuation-dpms-suspend)
[46.268087] Starting subtest: pipe-C-ts-continuation-dpms-suspend
[63.401397] Subtest pipe-C-ts-continuation-dpms-suspend: SUCCESS (2.173s)
[69.536506] [007/142] (947s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-indfb-draw-pwrite)
[69.788300] Starting subtest: psr-1p-offscren-pri-indfb-draw-pwrite
[69.790851] Subtest psr-1p-offscren-pri-indfb-draw-pwrite: SKIP (0.000s)
[69.894314] [008/142] (946s left) kms_prime (basic-crc-hybrid)
[71.905472] Subtest basic-crc-hybrid: SKIP (0.000s)
[72.045051] [009/142] (944s left) perf (mi-rpc)
[72.342930] Starting subtest: mi-rpc
[72.413542] Subtest mi-rpc: SUCCESS (0.064s)
[72.468924] [010/142] (944s left) core_getclient
[72.694536] [011/142] (944s left) kms_plane_scaling (invalid-num-scalers)
[72.931789] Starting subtest: invalid-num-scalers
[72.936569] Starting dynamic subtest: pipe-A-DP-1-invalid-num-scalers
[72.939121] Dynamic subtest pipe-A-DP-1-invalid-num-scalers: SKIP (0.001s)
[72.956092] Starting dynamic subtest: pipe-B-DP-1-invalid-num-scalers
[72.958542] Dynamic subtest pipe-B-DP-1-invalid-num-scalers: SKIP (0.001s)
[72.975001] Starting dynamic subtest: pipe-C-DP-1-invalid-num-scalers
[72.977500] Dynamic subtest pipe-C-DP-1-invalid-num-scalers: SKIP (0.001s)
[72.980066] Subtest invalid-num-scalers: SKIP (0.013s)
[73.046214] [012/142] (943s left) kms_busy (extended-pageflip-hang-oldfb)
[73.299532] Starting subtest: extended-pageflip-hang-oldfb
[73.302734] Starting dynamic subtest: pipe-A
[73.889327] Dynamic subtest pipe-A: SUCCESS (0.585s)
[73.910301] Starting dynamic subtest: pipe-C
[74.365841] Dynamic subtest pipe-C: SUCCESS (0.473s)
[74.367674] Subtest extended-pageflip-hang-oldfb: SUCCESS (1.068s)
[74.720550] [013/142] (942s left) kms_cursor_legacy (flip-vs-cursor-atomic)
[74.963498] Starting subtest: flip-vs-cursor-atomic
[90.713368] Subtest flip-vs-cursor-atomic: SUCCESS (15.751s)
[91.041671] [014/142] (925s left) gem_exec_fence (syncobj-backward-timeline-chain-engines)
[91.815858] Starting subtest: syncobj-backward-timeline-chain-engines
[91.946151] Subtest syncobj-backward-timeline-chain-engines: SUCCESS (0.132s)
[92.173457] [015/142] (924s left) kms_ccs (pipe-d-crc-primary-basic-4_tiled_dg2_rc_ccs)
[92.647523] Subtest pipe-D-crc-primary-basic-4_tiled_dg2_rc_ccs: SKIP (0.000s)
[92.960605] [016/142] (924s left) kms_big_fb (yf-tiled-8bpp-rotate-90)
[93.224682] Starting subtest: yf-tiled-8bpp-rotate-90
[93.227572] Subtest yf-tiled-8bpp-rotate-90: SKIP (0.000s)
[93.327137] [017/142] (923s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc)
[93.573850] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc
[93.576548] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[93.660598] [018/142] (923s left) gem_wait (busy)
[93.841431] Starting subtest: busy
[93.843064] Starting dynamic subtest: all-engines
[94.364542] Dynamic subtest all-engines: SUCCESS (0.524s)
[94.385783] Starting dynamic subtest: rcs0
[94.880063] Dynamic subtest rcs0: SUCCESS (0.516s)
[94.898642] Starting dynamic subtest: bcs0
[95.408588] Dynamic subtest bcs0: SUCCESS (0.527s)
[95.426942] Starting dynamic subtest: vcs0
[95.928925] Dynamic subtest vcs0: SUCCESS (0.521s)
[95.947952] Starting dynamic subtest: vecs0
[96.446619] Dynamic subtest vecs0: SUCCESS (0.517s)
[96.448238] Subtest busy: SUCCESS (2.607s)
[96.697537] [019/142] (920s left) gem_softpin (evict-prime)
[96.846466] Starting subtest: evict-prime
[96.848050] Starting dynamic subtest: rcs0
[97.975322] Dynamic subtest rcs0: SUCCESS (1.127s)
[98.008989] Starting dynamic subtest: bcs0
[99.090687] Dynamic subtest bcs0: SUCCESS (1.115s)
[99.121158] Starting dynamic subtest: vcs0
[100.208838] Dynamic subtest vcs0: SUCCESS (1.117s)
[100.233992] Starting dynamic subtest: vecs0
[101.324822] Dynamic subtest vecs0: SUCCESS (1.115s)
[101.350715] Starting dynamic subtest: all
[102.438169] Dynamic subtest all: SUCCESS (1.112s)
[102.439593] Subtest evict-prime: SUCCESS (5.591s)
[102.533477] [020/142] (914s left) kms_flip (2x-nonexisting-fb-interruptible)
[102.778828] Starting subtest: 2x-nonexisting-fb-interruptible
[102.785816] Subtest 2x-nonexisting-fb-interruptible: SKIP (0.004s)
[102.878193] [021/142] (914s left) gem_set_tiling_vs_pwrite
[103.128241] [022/142] (914s left) kms_cursor_crc (cursor-rapid-movement-32x32)
[103.367060] Starting subtest: cursor-rapid-movement-32x32
[103.487565] Subtest cursor-rapid-movement-32x32: SKIP (0.119s)
[103.595262] [023/142] (913s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[103.861120] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip
[103.893449] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.030s)
[103.998338] [024/142] (913s left) gem_bad_reloc (negative-reloc)
[104.157058] Starting subtest: negative-reloc
[104.163424] Subtest negative-reloc: SUCCESS (0.002s)
[104.278305] [025/142] (913s left) kms_ccs (pipe-a-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs)
[104.643295] Starting subtest: pipe-A-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs
[104.649122] Subtest pipe-A-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs: SKIP (0.005s)
[105.076866] [026/142] (912s left) syncobj_timeline (invalid-multi-wait-unsubmitted)
[105.222715] Starting subtest: invalid-multi-wait-unsubmitted
[105.224321] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[105.305972] [027/142] (912s left) i915_pm_rpm (modeset-non-lpsp)
[107.137514] Starting subtest: modeset-non-lpsp
[107.905202] Subtest modeset-non-lpsp: SUCCESS (0.766s)
[108.088035] [028/142] (909s left) gen7_exec_parse (oacontrol-tracking)
[108.237284] Subtest oacontrol-tracking: SKIP (0.000s)
[108.288779] [029/142] (909s left) sw_sync (sync_multi_consumer)
[108.428480] Starting subtest: sync_multi_consumer
[109.606401] Subtest sync_multi_consumer: SUCCESS (1.178s)
[109.669075] [030/142] (907s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-msflip-blt)
[109.918429] Starting subtest: psr-2p-primscrn-indfb-msflip-blt
[109.922003] Subtest psr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[110.001801] [031/142] (907s left) gem_mmap_gtt (hang-user)
[110.143789] Starting subtest: hang-user
[124.836649] Subtest hang-user: SUCCESS (14.692s)
[124.953627] [032/142] (892s left) kms_ccs (pipe-a-crc-primary-basic-4_tiled_dg2_mc_ccs)
[125.283130] Starting subtest: pipe-A-crc-primary-basic-4_tiled_dg2_mc_ccs
[125.285917] Subtest pipe-A-crc-primary-basic-4_tiled_dg2_mc_ccs: SKIP (0.001s)
[125.749839] [033/142] (891s left) gem_exec_params (invalid-bsd1-flag-on-blt)
[125.903138] Starting subtest: invalid-bsd1-flag-on-blt
[125.904872] Subtest invalid-bsd1-flag-on-blt: SUCCESS (0.001s)
[125.999500] [034/142] (891s left) api_intel_allocator (simple-allocator)
[126.148292] Starting subtest: simple-allocator
[126.149834] Starting dynamic subtest: basic
[126.152761] Dynamic subtest basic: SUCCESS (0.006s)
[126.173642] Starting dynamic subtest: parallel-one
[126.320966] Dynamic subtest parallel-one: SUCCESS (0.166s)
[126.341960] Starting dynamic subtest: print
[126.343374] Dynamic subtest print: SUCCESS (0.000s)
[126.363001] Starting dynamic subtest: reuse
[126.364385] Dynamic subtest reuse: SUCCESS (0.000s)
[126.385315] Starting dynamic subtest: reserve
[126.386625] Dynamic subtest reserve: SUCCESS (0.000s)
[126.407140] Starting dynamic subtest: fork-reopen-allocator
[126.408423] Dynamic subtest fork-reopen-allocator: SUCCESS (0.045s)
[126.409755] Subtest simple-allocator: SUCCESS (0.220s)
[126.449210] [035/142] (891s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[126.692577] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[126.695150] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[126.797240] [036/142] (890s left) prime_busy (after)
[126.950206] Starting subtest: after
[126.967620] Starting dynamic subtest: rcs0
[126.989588] Dynamic subtest rcs0: SUCCESS (0.021s)
[127.011162] Starting dynamic subtest: bcs0
[127.015759] Dynamic subtest bcs0: SUCCESS (0.027s)
[127.037691] Starting dynamic subtest: vcs0
[127.041241] Dynamic subtest vcs0: SUCCESS (0.014s)
[127.061990] Starting dynamic subtest: vecs0
[127.063241] Dynamic subtest vecs0: SUCCESS (0.015s)
[127.164722] Subtest after: SUCCESS (0.214s)
[127.250602] [037/142] (890s left) gem_ctx_param (basic)
[127.394137] Starting subtest: basic
[127.395702] Subtest basic: SUCCESS (0.000s)
[127.484328] [038/142] (890s left) syncobj_timeline (etime-single-wait-for-submit-unsubmitted)
[127.628302] Starting subtest: etime-single-wait-for-submit-unsubmitted
[127.734601] Subtest etime-single-wait-for-submit-unsubmitted: SUCCESS (0.104s)
[127.813352] [039/142] (890s left) kms_cursor_crc (cursor-sliding-512x512)
[128.060841] Starting subtest: cursor-sliding-512x512
[128.065285] Subtest cursor-sliding-512x512: SKIP (0.003s)
[128.180080] [040/142] (889s left) gem_ctx_shared (q-smoketest-all)
[128.353969] Starting subtest: Q-smoketest-all
[160.670025] Subtest Q-smoketest-all: SUCCESS (32.310s)
[160.882228] [041/142] (857s left) gem_exec_await (wide-all)
[161.219918] Starting subtest: wide-all
[184.631726] Subtest wide-all: SUCCESS (23.412s)
[184.859384] [042/142] (833s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[185.224283] Starting subtest: fbcpsr-indfb-scaledprimary
[185.226790] Subtest fbcpsr-indfb-scaledprimary: SKIP (0.000s)
[185.331369] [043/142] (832s left) v3d/v3d_submit_cl (bad-multisync-in-sync)
[185.526322] Subtest bad-multisync-in-sync: SKIP (0.000s)
[185.601007] [044/142] (832s left) kms_vblank (pipe-a-wait-busy-hang)
[185.836915] Starting subtest: pipe-A-wait-busy-hang
[192.622098] Subtest pipe-A-wait-busy-hang: SUCCESS (6.786s)
[192.956177] [045/142] (825s left) syncobj_timeline (wait-any-complex)
[193.104678] Starting subtest: wait-any-complex
[193.170292] Subtest wait-any-complex: SUCCESS (0.065s)
[193.261007] [046/142] (824s left) gem_pxp (reject-modify-context-protection-off-3)
[195.926949] Subtest reject-modify-context-protection-off-3: SKIP (0.000s)
[196.007127] [047/142] (822s left) kms_ccs (pipe-a-bad-rotation-90-y_tiled_ccs)
[196.330252] Starting subtest: pipe-A-bad-rotation-90-y_tiled_ccs
[197.036750] Subtest pipe-A-bad-rotation-90-y_tiled_ccs: SUCCESS (0.703s)
[197.637326] [048/142] (820s left) kms_vblank (invalid)
[197.873496] Starting subtest: invalid
[198.142237] Subtest invalid: SUCCESS (0.269s)
[198.474269] [049/142] (819s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-indfb-draw-mmap-cpu)
[198.719525] Starting subtest: fbc-1p-offscren-pri-indfb-draw-mmap-cpu
[200.537148] Subtest fbc-1p-offscren-pri-indfb-draw-mmap-cpu: SUCCESS (1.820s)
[200.676504] [050/142] (817s left) syncobj_basic (test-valid-cycle)
[200.820111] Starting subtest: test-valid-cycle
[200.821562] Subtest test-valid-cycle: SUCCESS (0.000s)
[200.909213] [051/142] (817s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation)
[201.142498] Starting subtest: plane-scaler-with-clipping-clamping-rotation
[201.143784] Starting dynamic subtest: pipe-A-DP-1
[201.236769] Dynamic subtest pipe-A-DP-1: SKIP (0.091s)
[201.259609] Starting dynamic subtest: pipe-B-DP-1
[201.646945] Dynamic subtest pipe-B-DP-1: SKIP (0.400s)
[201.669227] Starting dynamic subtest: pipe-C-DP-1
[202.021869] Dynamic subtest pipe-C-DP-1: SKIP (0.377s)
[202.026269] Subtest plane-scaler-with-clipping-clamping-rotation: SKIP (0.877s)
[202.426095] [052/142] (816s left) kms_chamelium_frames (dp-crc-single)
[202.765738] Subtest dp-crc-single: SKIP (0.000s)
[203.034768] [053/142] (815s left) vc4/vc4_label_bo (set-label)
[203.243557] Subtest set-label: SKIP (0.000s)
[203.313930] [054/142] (815s left) kms_rotation_crc (bad-pixel-format)
[203.547780] Starting subtest: bad-pixel-format
[205.329820] Subtest bad-pixel-format: SUCCESS (1.785s)
[205.758479] [055/142] (812s left) drm_read (empty-block)
[206.117404] Starting subtest: empty-block
[207.119619] Subtest empty-block: SUCCESS (1.001s)
[207.258737] [056/142] (811s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move)
[207.505714] Starting subtest: psr-2p-primscrn-spr-indfb-move
[207.508295] Subtest psr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[207.605226] [057/142] (811s left) gem_mmap_offset (close-race)
[207.745036] Starting subtest: close-race
[227.866017] Subtest close-race: SUCCESS (20.120s)
[227.973159] [058/142] (790s left) gem_ctx_isolation (dirty-switch)
[228.139985] Starting subtest: dirty-switch
[228.141474] Starting dynamic subtest: rcs0
[229.877966] Dynamic subtest rcs0: SUCCESS (1.737s)
[229.900064] Starting dynamic subtest: bcs0
[232.091550] Dynamic subtest bcs0: SUCCESS (2.212s)
[232.113768] Starting dynamic subtest: vcs0
[233.732651] Dynamic subtest vcs0: SUCCESS (1.640s)
[233.753838] Starting dynamic subtest: vecs0
[235.396129] Dynamic subtest vecs0: SUCCESS (1.662s)
[235.397492] Subtest dirty-switch: SUCCESS (7.256s)
[235.593816] [059/142] (783s left) gem_ctx_engines (invalid-engines)
[235.760632] Starting subtest: invalid-engines
[235.774694] Subtest invalid-engines: SUCCESS (0.014s)
[235.973170] [060/142] (782s left) syncobj_wait (wait-all-snapshot)
[236.118129] Starting subtest: wait-all-snapshot
[236.202350] Subtest wait-all-snapshot: SUCCESS (0.083s)
[236.293154] [061/142] (782s left) kms_pm_backlight (fade-with-dpms)
[236.529946] Subtest fade-with-dpms: SKIP (0.000s)
[236.591191] [062/142] (782s left) drm_read (short-buffer-block)
[236.934690] Starting subtest: short-buffer-block
[236.936083] Subtest short-buffer-block: SUCCESS (0.000s)
[237.074534] [063/142] (781s left) gem_exec_alignment (single)
[237.225136] Starting subtest: single
[237.233959] Subtest single: SUCCESS (0.009s)
[237.358277] [064/142] (781s left) kms_ccs (pipe-d-bad-pixel-format-yf_tiled_ccs)
[237.825757] Subtest pipe-D-bad-pixel-format-yf_tiled_ccs: SKIP (0.000s)
[238.142856] [065/142] (780s left) kms_ccs (pipe-b-ccs-on-another-bo-y_tiled_gen12_rc_ccs)
[238.545513] Starting subtest: pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs
[238.548270] Subtest pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs: SKIP (0.000s)
[238.932504] [066/142] (780s left) kms_flip (dpms-vs-vblank-race-interruptible)
[239.174387] Starting subtest: dpms-vs-vblank-race-interruptible
[239.178447] Starting dynamic subtest: A-DP1
[243.361669] Dynamic subtest A-DP1: SUCCESS (4.184s)
[243.386345] Starting dynamic subtest: B-DP1
[247.557052] Dynamic subtest B-DP1: SUCCESS (4.190s)
[247.582170] Starting dynamic subtest: C-DP1
[251.762195] Dynamic subtest C-DP1: SUCCESS (4.202s)
[251.765198] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (12.586s)
[252.143639] [067/142] (766s left) i915_suspend (fence-restore-tiled2untiled)
[252.294946] Starting subtest: fence-restore-tiled2untiled
[272.715333] Subtest fence-restore-tiled2untiled: SUCCESS (4.163s)
[275.854738] [068/142] (762s left) kms_ccs (pipe-d-crc-sprite-planes-basic-4_tiled_mtl_mc_ccs)
[276.327457] Subtest pipe-D-crc-sprite-planes-basic-4_tiled_mtl_mc_ccs: SKIP (0.000s)
[276.652193] [069/142] (761s left) gem_exec_fair (basic-sync)
[276.832669] Starting subtest: basic-sync
[276.834096] Starting dynamic subtest: rcs0
[281.615375] Dynamic subtest rcs0: SUCCESS (4.780s)
[281.616763] Subtest basic-sync: SUCCESS (4.782s)
[281.818789] [070/142] (756s left) kms_lease (lease_invalid_crtc)
[282.062682] Starting subtest: lease_invalid_crtc
[282.064228] Starting dynamic subtest: pipe-A-DP-1
[282.065635] Dynamic subtest pipe-A-DP-1: SUCCESS (0.000s)
[282.091895] Starting dynamic subtest: pipe-B-DP-1
[282.093254] Dynamic subtest pipe-B-DP-1: SUCCESS (0.000s)
[282.115116] Starting dynamic subtest: pipe-C-DP-1
[282.116352] Dynamic subtest pipe-C-DP-1: SUCCESS (0.000s)
[282.117615] Subtest lease_invalid_crtc: SUCCESS (0.012s)
[282.169123] [071/142] (756s left) gem_shrink (reclaim)
[282.323097] Starting subtest: reclaim
[284.642302] Subtest reclaim: SUCCESS (2.318s)
[284.737315] [072/142] (753s left) syncobj_basic (create-signaled)
[284.876226] Starting subtest: create-signaled
[284.877549] Subtest create-signaled: SUCCESS (0.000s)
[284.968626] [073/142] (753s left) gem_exec_basic (basic)
[285.128268] Starting subtest: basic
[285.129822] Starting dynamic subtest: rcs0-smem
[285.131151] Dynamic subtest rcs0-smem: SUCCESS (0.003s)
[285.154284] Starting dynamic subtest: bcs0-smem
[285.155511] Dynamic subtest bcs0-smem: SUCCESS (0.003s)
[285.177513] Starting dynamic subtest: vcs0-smem
[285.178791] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[285.201170] Starting dynamic subtest: vecs0-smem
[285.202585] Dynamic subtest vecs0-smem: SUCCESS (0.001s)
[285.203979] Subtest basic: SUCCESS (0.017s)
[285.370633] [074/142] (753s left) kms_flip (plain-flip-interruptible)
[285.609359] Starting subtest: plain-flip-interruptible
[285.614311] Starting dynamic subtest: A-DP1
[286.798688] Dynamic subtest A-DP1: SUCCESS (1.181s)
[286.821736] Starting dynamic subtest: B-DP1
[287.870569] Dynamic subtest B-DP1: SUCCESS (1.070s)
[287.893007] Starting dynamic subtest: C-DP1
[288.955784] Dynamic subtest C-DP1: SUCCESS (1.084s)
[288.960966] Subtest plain-flip-interruptible: SUCCESS (3.349s)
[289.384535] [075/142] (749s left) kms_ccs (pipe-b-bad-aux-stride-4_tiled_mtl_rc_ccs_cc)
[289.806365] Starting subtest: pipe-B-bad-aux-stride-4_tiled_mtl_rc_ccs_cc
[289.808972] Subtest pipe-B-bad-aux-stride-4_tiled_mtl_rc_ccs_cc: SKIP (0.000s)
[290.191648] [076/142] (748s left) kms_flip (flip-vs-fences-interruptible)
[290.432518] Starting subtest: flip-vs-fences-interruptible
[290.436379] Starting dynamic subtest: A-DP1
[301.037596] Dynamic subtest A-DP1: SUCCESS (10.601s)
[301.063268] Starting dynamic subtest: B-DP1
[311.536779] Dynamic subtest B-DP1: SUCCESS (10.498s)
[311.564055] Starting dynamic subtest: C-DP1
[322.094642] Dynamic subtest C-DP1: SUCCESS (10.552s)
[322.102470] Subtest flip-vs-fences-interruptible: SUCCESS (31.667s)
[322.571179] [077/142] (716s left) perf (global-sseu-config)
[322.846590] Starting subtest: global-sseu-config
[322.848104] Starting dynamic subtest: 0-rcs0
[322.970195] Dynamic subtest 0-rcs0: SUCCESS (0.119s)
[322.971528] Subtest global-sseu-config: SUCCESS (0.122s)
[323.017699] [078/142] (715s left) kms_atomic_transition (plane-all-transition)
[323.257828] Starting subtest: plane-all-transition
[323.261818] Starting dynamic subtest: pipe-A-DP-1
[327.289546] Dynamic subtest pipe-A-DP-1: SUCCESS (4.029s)
[327.445944] Starting dynamic subtest: pipe-B-DP-1
[331.816283] Dynamic subtest pipe-B-DP-1: SUCCESS (4.424s)
[331.912769] Subtest plane-all-transition: SUCCESS (8.656s)
[332.268210] [079/142] (706s left) v3d/v3d_perfmon (get-values-invalid-perfmon)
[332.475481] Subtest get-values-invalid-perfmon: SKIP (0.000s)
[332.549818] [080/142] (706s left) kms_flip (absolute-wf_vblank)
[332.779758] Starting subtest: absolute-wf_vblank
[332.784395] Starting dynamic subtest: A-DP1
[343.299002] Dynamic subtest A-DP1: SUCCESS (10.517s)
[343.324868] Starting dynamic subtest: B-DP1
[353.756778] Dynamic subtest B-DP1: SUCCESS (10.452s)
[353.782121] Starting dynamic subtest: C-DP1
[364.221200] Dynamic subtest C-DP1: SUCCESS (10.462s)
[364.227036] Subtest absolute-wf_vblank: SUCCESS (31.446s)
[364.640956] [081/142] (674s left) kms_ccs (pipe-d-random-ccs-data-yf_tiled_ccs)
[365.110749] Subtest pipe-D-random-ccs-data-yf_tiled_ccs: SKIP (0.000s)
[365.439789] [082/142] (673s left) gem_render_copy (y-tiled-ccs-to-x-tiled)
[365.605142] Starting subtest: y-tiled-ccs-to-x-tiled
[365.606851] Starting dynamic subtest: smem
[365.894753] Dynamic subtest smem: SUCCESS (0.289s)
[365.896358] Subtest y-tiled-ccs-to-x-tiled: SUCCESS (0.292s)
[366.106138] [083/142] (672s left) kms_rotation_crc (primary-x-tiled-reflect-x-180)
[366.341366] Starting subtest: primary-x-tiled-reflect-x-180
[366.344512] Subtest primary-x-tiled-reflect-x-180: SKIP (0.003s)
[366.439950] [084/142] (672s left) kms_ccs (pipe-c-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs)
[366.915446] Starting subtest: pipe-C-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs
[366.921010] Subtest pipe-C-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs: SKIP (0.004s)
[367.257041] [085/142] (671s left) kms_frontbuffer_tracking (fbc-farfromfence-mmap-gtt)
[367.501805] Starting subtest: fbc-farfromfence-mmap-gtt
[370.079082] Subtest fbc-farfromfence-mmap-gtt: SUCCESS (2.579s)
[370.206488] [086/142] (668s left) kms_content_protection (lic)
[370.485136] Starting subtest: LIC
[370.516103] Starting dynamic subtest: pipe-A-DP-1
[491.525689] Per-test timeout exceeded. Killing the current test with SIGQUIT.
[492.071355] Closing watchdogs
[492.077388] Initializing watchdogs
[492.077564]   /dev/watchdog0
[492.104349] [087/142] (547s left) gem_ctx_param (invalid-ctx-get)
[492.249775] Starting subtest: invalid-ctx-get
[492.251536] Subtest invalid-ctx-get: SUCCESS (0.000s)
[492.340390] [088/142] (546s left) kms_ccs (pipe-b-crc-sprite-planes-basic-yf_tiled_ccs)
[492.786173] Starting subtest: pipe-B-crc-sprite-planes-basic-yf_tiled_ccs
[493.306290] Subtest pipe-B-crc-sprite-planes-basic-yf_tiled_ccs: SUCCESS (0.520s)
[493.766277] [089/142] (545s left) gem_eio (in-flight-contexts-10ms)
[493.936143] Starting subtest: in-flight-contexts-10ms
[505.136165] Subtest in-flight-contexts-10ms: SUCCESS (11.203s)
[505.351086] [090/142] (534s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-blt)
[505.597464] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-blt
[505.600054] Subtest fbc-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[505.700222] [091/142] (533s left) gem_lmem_swapping (heavy-multi)
[505.853514] Subtest heavy-multi: SKIP (0.000s)
[505.915995] [092/142] (533s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[506.074344] Starting subtest: x-tiled-to-vebox-y-tiled
[506.076927] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[506.284759] [093/142] (533s left) syncobj_wait (single-wait-all-signaled)
[506.426213] Starting subtest: single-wait-all-signaled
[506.427785] Subtest single-wait-all-signaled: SUCCESS (0.001s)
[506.515653] [094/142] (533s left) kms_atomic_interruptible (legacy-dpms)
[506.761689] Starting subtest: legacy-dpms
[506.766200] Starting dynamic subtest: DP-1-pipe-A
[513.353167] Dynamic subtest DP-1-pipe-A: SUCCESS (6.586s)
[513.355118] Subtest legacy-dpms: SUCCESS (6.592s)
[513.701605] [095/142] (525s left) dmabuf_sync_file (export-basic)
[513.841470] Starting subtest: export-basic
[513.845468] Subtest export-basic: SUCCESS (0.004s)
[513.917252] [096/142] (525s left) kms_psr (psr2_cursor_render)
[514.062522] Subtest psr2_cursor_render: SKIP (0.000s)
[514.117554] [097/142] (525s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[514.365460] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt
[514.368274] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[514.466886] [098/142] (525s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-msflip-blt)
[514.718612] Starting subtest: fbcpsr-2p-scndscrn-indfb-msflip-blt
[514.721328] Subtest fbcpsr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[514.817403] [099/142] (525s left) api_intel_allocator (alloc-simple)
[514.959641] Starting subtest: alloc-simple
[514.965719] Subtest alloc-simple: SUCCESS (0.004s)
[515.083129] [100/142] (524s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-blt)
[515.330539] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-blt
[515.333524] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[515.433759] [101/142] (524s left) gem_exec_params (invalid-bsd2-flag-on-blt)
[515.584193] Starting subtest: invalid-bsd2-flag-on-blt
[515.585723] Subtest invalid-bsd2-flag-on-blt: SUCCESS (0.001s)
[515.701742] [102/142] (524s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-fullscreen)
[515.947062] Starting subtest: fbc-1p-primscrn-spr-indfb-fullscreen
[517.541646] Subtest fbc-1p-primscrn-spr-indfb-fullscreen: SUCCESS (1.595s)
[517.684638] [103/142] (522s left) kms_chamelium_hpd (hdmi-hpd-storm)
[518.024358] Subtest hdmi-hpd-storm: SKIP (0.000s)
[518.317460] [104/142] (521s left) kms_ccs (pipe-b-crc-primary-rotation-180-y_tiled_gen12_rc_ccs_cc)
[518.708804] Starting subtest: pipe-B-crc-primary-rotation-180-y_tiled_gen12_rc_ccs_cc
[518.711740] Subtest pipe-B-crc-primary-rotation-180-y_tiled_gen12_rc_ccs_cc: SKIP (0.001s)
[519.125620] [105/142] (520s left) prime_self_import (basic-llseek-bad)
[519.263843] Starting subtest: basic-llseek-bad
[519.269239] Subtest basic-llseek-bad: SUCCESS (0.005s)
[519.377184] [106/142] (520s left) perf_pmu (gt-awake)
[519.524886] Starting subtest: gt-awake
[522.083058] Subtest gt-awake: SUCCESS (2.555s)
[522.191622] [107/142] (517s left) kms_ccs (pipe-c-bad-rotation-90-yf_tiled_ccs)
[522.616604] Starting subtest: pipe-C-bad-rotation-90-yf_tiled_ccs
[522.619261] Subtest pipe-C-bad-rotation-90-yf_tiled_ccs: SKIP (0.000s)
[522.991687] [108/142] (517s left) i915_pm_rpm (basic-rte)
[523.133726] Starting subtest: basic-rte
[525.488021] Subtest basic-rte: SUCCESS (2.351s)
[526.295223] [109/142] (513s left) kms_big_fb (linear-64bpp-rotate-0)
[526.555528] Starting subtest: linear-64bpp-rotate-0
[535.031435] Subtest linear-64bpp-rotate-0: SUCCESS (8.475s)
[535.960748] [110/142] (504s left) kms_dsc (dsc-with-output-formats-with-bpc)
[536.206841] Subtest dsc-with-output-formats-with-bpc: SKIP (0.000s)
[536.260671] [111/142] (504s left) kms_big_fb (x-tiled-64bpp-rotate-180)
[536.525963] Starting subtest: x-tiled-64bpp-rotate-180
[544.148026] Subtest x-tiled-64bpp-rotate-180: SUCCESS (7.623s)
[545.077085] [112/142] (495s left) gem_exec_balancer (fairslice)
[545.243633] Starting subtest: fairslice
[545.246474] Subtest fairslice: SKIP (0.000s)
[549.192356] [113/142] (491s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0)
[549.448463] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0
[550.913349] Subtest y-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.465s)
[551.061706] [114/142] (489s left) kms_dsc (dsc-with-bpc-formats)
[551.297055] Subtest dsc-with-bpc-formats: SKIP (0.000s)
[551.359683] [115/142] (489s left) vgem_basic (unload)
[551.497866] Starting subtest: unload
[580.491397] Subtest unload: SUCCESS (28.992s)
[580.630069] [116/142] (459s left) kms_big_fb (4-tiled-32bpp-rotate-0)
[580.898326] Starting subtest: 4-tiled-32bpp-rotate-0
[580.901409] Subtest 4-tiled-32bpp-rotate-0: SKIP (0.000s)
[580.992233] [117/142] (459s left) kms_atomic (plane-primary-overlay-mutable-zpos)
[581.355421] Starting subtest: plane-primary-overlay-mutable-zpos
[581.359749] Subtest plane-primary-overlay-mutable-zpos: SKIP (0.000s)
[581.792995] [118/142] (458s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling)
[582.027485] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling
[582.031462] Starting dynamic subtest: pipe-A-valid-mode
[582.440066] Dynamic subtest pipe-A-valid-mode: SKIP (0.405s)
[582.442653] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SKIP (0.409s)
[582.810355] [119/142] (457s left) gem_ctx_exec (basic)
[582.957514] Starting subtest: basic
[582.963445] Subtest basic: SUCCESS (0.006s)
[583.073123] [120/142] (457s left) i915_power (sanity)
[583.215327] Starting subtest: sanity
[587.241558] Subtest sanity: SUCCESS (4.024s)
[587.356886] [121/142] (453s left) kms_hdr (static-toggle)
[587.600851] Starting subtest: static-toggle
[587.603599] Subtest static-toggle: SKIP (0.000s)
[587.690764] [122/142] (453s left) gem_exec_whisper (basic-contexts)
[587.859783] Starting subtest: basic-contexts
[597.292346] Subtest basic-contexts: SUCCESS (9.429s)
[597.508372] [123/142] (443s left) gem_ctx_persistence (legacy-engines-mixed-process)
[597.661689] Starting subtest: legacy-engines-mixed-process
[597.665895] Starting dynamic subtest: render
[598.021822] Dynamic subtest render: SUCCESS (0.357s)
[598.055722] Starting dynamic subtest: bsd
[598.358040] Dynamic subtest bsd: SUCCESS (0.333s)
[598.390326] Starting dynamic subtest: blt
[598.731162] Dynamic subtest blt: SUCCESS (0.370s)
[598.760474] Starting dynamic subtest: vebox
[599.089611] Dynamic subtest vebox: SUCCESS (0.355s)
[599.091282] Subtest legacy-engines-mixed-process: SUCCESS (1.429s)
[599.193080] [124/142] (441s left) gem_exec_schedule (lateslice)
[599.367214] Starting subtest: lateslice
[599.368729] Starting dynamic subtest: rcs0
[599.400308] Dynamic subtest rcs0: SUCCESS (0.031s)
[599.433509] Starting dynamic subtest: bcs0
[599.438055] Dynamic subtest bcs0: SUCCESS (0.034s)
[599.472542] Starting dynamic subtest: vcs0
[599.474290] Dynamic subtest vcs0: SUCCESS (0.027s)
[599.502738] Starting dynamic subtest: vecs0
[599.504003] Dynamic subtest vecs0: SUCCESS (0.026s)
[599.505504] Subtest lateslice: SUCCESS (0.131s)
[599.875791] [125/142] (441s left) gem_exercise_blt (fast-copy-emit)
[600.025822] Starting subtest: fast-copy-emit
[600.027417] Starting dynamic subtest: linear-smem-smem-emit
[600.084589] Dynamic subtest linear-smem-smem-emit: SUCCESS (0.057s)
[600.115058] Starting dynamic subtest: ymajor-smem-smem-emit
[600.137782] Dynamic subtest ymajor-smem-smem-emit: SUCCESS (0.051s)
[600.168776] Starting dynamic subtest: yfmajor-smem-smem-emit
[600.189666] Dynamic subtest yfmajor-smem-smem-emit: SUCCESS (0.049s)
[600.220391] Starting dynamic subtest: tile64-smem-smem-emit
[600.241290] Dynamic subtest tile64-smem-smem-emit: SUCCESS (0.049s)
[600.243108] Subtest fast-copy-emit: SUCCESS (0.217s)
[600.376159] [126/142] (440s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted-signaled)
[600.521319] Starting subtest: multi-wait-all-for-submit-available-submitted-signaled
[600.522958] Subtest multi-wait-all-for-submit-available-submitted-signaled: SUCCESS (0.002s)
[600.623678] [127/142] (440s left) i915_hangman (engine-engine-hang)
[600.785861] Starting subtest: engine-engine-hang
[600.790063] Starting dynamic subtest: rcs0
[601.383665] Dynamic subtest rcs0: SUCCESS (0.595s)
[601.415240] Starting dynamic subtest: bcs0
[601.974205] Dynamic subtest bcs0: SUCCESS (0.585s)
[602.006201] Starting dynamic subtest: vcs0
[602.569112] Dynamic subtest vcs0: SUCCESS (0.592s)
[602.599203] Starting dynamic subtest: vecs0
[603.166022] Dynamic subtest vecs0: SUCCESS (0.593s)
[603.167871] Subtest engine-engine-hang: SUCCESS (2.382s)
[603.290161] [128/142] (437s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-shrfb-draw-mmap-wc)
[603.542285] Starting subtest: fbc-1p-offscren-pri-shrfb-draw-mmap-wc
[605.399930] Subtest fbc-1p-offscren-pri-shrfb-draw-mmap-wc: SUCCESS (1.859s)
[605.560692] [129/142] (435s left) syncobj_timeline (single-wait-signaled)
[605.705139] Starting subtest: single-wait-signaled
[605.707002] Subtest single-wait-signaled: SUCCESS (0.001s)
[605.807049] [130/142] (435s left) kms_ccs (pipe-c-bad-aux-stride-4_tiled_mtl_rc_ccs)
[606.281951] Starting subtest: pipe-C-bad-aux-stride-4_tiled_mtl_rc_ccs
[606.284642] Subtest pipe-C-bad-aux-stride-4_tiled_mtl_rc_ccs: SKIP (0.000s)
[606.622783] [131/142] (434s left) gem_exec_schedule (preempt-queue)
[606.798255] Starting subtest: preempt-queue
[606.799994] Starting dynamic subtest: rcs0
[607.197062] Dynamic subtest rcs0: SUCCESS (0.395s)
[607.227070] Starting dynamic subtest: bcs0
[607.594994] Dynamic subtest bcs0: SUCCESS (0.397s)
[607.629627] Starting dynamic subtest: vcs0
[607.993626] Dynamic subtest vcs0: SUCCESS (0.395s)
[608.031510] Starting dynamic subtest: vecs0
[608.399126] Dynamic subtest vecs0: SUCCESS (0.402s)
[608.400724] Subtest preempt-queue: SUCCESS (1.602s)
[608.771666] [132/142] (432s left) kms_vblank (pipe-d-ts-continuation-idle)
[609.007052] Subtest pipe-D-ts-continuation-idle: SKIP (0.000s)
[609.104598] [133/142] (432s left) kms_plane_alpha_blend (alpha-transparent-fb)
[609.349838] Starting subtest: alpha-transparent-fb
[609.667173] Starting dynamic subtest: pipe-A-DP-1
[610.427098] Dynamic subtest pipe-A-DP-1: FAIL (0.402s)
[610.452121] Starting dynamic subtest: pipe-C-DP-1
[611.069215] Dynamic subtest pipe-C-DP-1: FAIL (0.645s)
[611.070585] Subtest alpha-transparent-fb: FAIL (1.372s)
[611.142711] [134/142] (430s left) kms_cursor_crc (cursor-onscreen-512x512)
[611.395361] Starting subtest: cursor-onscreen-512x512
[611.403079] Subtest cursor-onscreen-512x512: SKIP (0.003s)
[611.520164] [135/142] (429s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[611.760130] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[611.765708] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.004s)
[611.872854] [136/142] (429s left) gem_eio (in-flight-suspend)
[612.033827] Starting subtest: in-flight-suspend
[651.367996] Subtest in-flight-suspend: SUCCESS (8.152s)
[656.417934] [137/142] (421s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[656.674305] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[656.677230] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[656.772207] [138/142] (420s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[657.014083] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-wc
[657.017225] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[657.121858] [139/142] (420s left) kms_scaling_modes (scaling-mode-none)
[657.359739] Starting subtest: scaling-mode-none
[657.362285] Subtest scaling-mode-none: SKIP (0.001s)
[657.456844] [140/142] (420s left) kms_ccs (pipe-c-random-ccs-data-4_tiled_dg2_mc_ccs)
[657.906430] Starting subtest: pipe-C-random-ccs-data-4_tiled_dg2_mc_ccs
[657.910277] Subtest pipe-C-random-ccs-data-4_tiled_dg2_mc_ccs: SKIP (0.000s)
[658.266407] [141/142] (419s left) vgem_basic (bad-flag)
[658.422689] Starting subtest: bad-flag
[658.424182] Subtest bad-flag: SUCCESS (0.000s)
[658.499851] [142/142] (419s left) sw_sync (sync_merge_invalid)
[658.642485] Starting subtest: sync_merge_invalid
[658.651377] Subtest sync_merge_invalid: SUCCESS (0.006s)
[658.714367] Closing watchdogs
Done.