[49.490646] Initializing watchdogs
[49.490886]   /dev/watchdog0
[49.506755] [001/142] (960s left) kms_atomic_transition (plane-toggle-modeset-transition)
[49.833813] Starting subtest: plane-toggle-modeset-transition
[49.835188] Starting dynamic subtest: pipe-A-DP-1
[55.313152] Dynamic subtest pipe-A-DP-1: SUCCESS (5.480s)
[55.342073] Starting dynamic subtest: pipe-B-DP-1
[60.713225] Dynamic subtest pipe-B-DP-1: SUCCESS (5.392s)
[60.718652] Subtest plane-toggle-modeset-transition: SUCCESS (10.889s)
[61.056980] [002/142] (948s left) kms_ccs (pipe-d-bad-rotation-90-4_tiled_dg2_mc_ccs)
[61.788485] Subtest pipe-D-bad-rotation-90-4_tiled_dg2_mc_ccs: SKIP (0.000s)
[62.103848] [003/142] (947s left) prime_vgem (wait)
[62.438364] Starting subtest: wait
[62.439798] Starting dynamic subtest: rcs0
[62.487946] Dynamic subtest rcs0: SUCCESS (0.049s)
[62.502803] Starting dynamic subtest: vcs0
[62.514081] Dynamic subtest vcs0: SUCCESS (0.023s)
[62.529440] Starting dynamic subtest: vecs0
[62.533720] Dynamic subtest vecs0: SUCCESS (0.021s)
[62.536234] Subtest wait: SUCCESS (0.096s)
[62.654470] [004/142] (947s left) kms_busy (basic-hang)
[62.975508] Starting subtest: basic-hang
[62.976814] Starting dynamic subtest: flip-pipe-A
[63.891476] Dynamic subtest flip-pipe-A: SUCCESS (0.914s)
[63.906161] Starting dynamic subtest: modeset-pipe-A
[65.471894] Dynamic subtest modeset-pipe-A: SUCCESS (1.579s)
[65.489458] Starting dynamic subtest: flip-pipe-C
[66.315834] Dynamic subtest flip-pipe-C: SUCCESS (0.840s)
[66.330505] Starting dynamic subtest: modeset-pipe-C
[67.820685] Dynamic subtest modeset-pipe-C: SUCCESS (1.503s)
[67.821928] Subtest basic-hang: SUCCESS (4.849s)
[68.176360] [005/142] (941s left) kms_flip (2x-nonexisting-fb)
[68.467999] Starting subtest: 2x-nonexisting-fb
[68.470482] Subtest 2x-nonexisting-fb: SKIP (0.003s)
[68.572744] [006/142] (941s left) kms_rotation_crc (bad-pixel-format)
[68.875048] Starting subtest: bad-pixel-format
[70.681194] Subtest bad-pixel-format: SUCCESS (1.811s)
[71.099070] [007/142] (939s left) kms_ccs (pipe-c-crc-primary-basic-4_tiled_mtl_rc_ccs)
[71.695179] Starting subtest: pipe-C-crc-primary-basic-4_tiled_mtl_rc_ccs
[71.698033] Subtest pipe-C-crc-primary-basic-4_tiled_mtl_rc_ccs: SKIP (0.001s)
[72.085752] [008/142] (938s left) i915_module_load (reload-with-fault-injection)
[72.288689] Starting subtest: reload-with-fault-injection
[77.113130] Subtest reload-with-fault-injection: SUCCESS (4.824s)
[77.145189] [009/142] (933s left) kms_flip (flip-vs-dpms-off-vs-modeset)
[80.513984] Starting subtest: flip-vs-dpms-off-vs-modeset
[80.517732] Starting dynamic subtest: A-DP1
[81.992463] Dynamic subtest A-DP1: SUCCESS (1.467s)
[82.006445] Starting dynamic subtest: B-DP1
[83.069502] Dynamic subtest B-DP1: SUCCESS (1.079s)
[83.084190] Starting dynamic subtest: C-DP1
[84.151080] Dynamic subtest C-DP1: SUCCESS (1.082s)
[84.152442] Subtest flip-vs-dpms-off-vs-modeset: SUCCESS (3.640s)
[84.523105] [010/142] (925s left) gem_exec_params (secure-non-root)
[84.747993] Starting subtest: secure-non-root
[84.751254] Subtest secure-non-root: SKIP (0.000s)
[84.839536] [011/142] (925s left) gem_exec_await (wide-all)
[85.274369] Starting subtest: wide-all
[108.823215] Subtest wide-all: SUCCESS (23.548s)
[109.053492] [012/142] (901s left) i915_pm_rpm (fences)
[111.257945] Starting subtest: fences
[114.165230] Subtest fences: SUCCESS (2.907s)
[114.384581] [013/142] (896s left) i915_pm_rps (thresholds-idle)
[114.603634] Starting subtest: thresholds-idle
[114.605316] Starting dynamic subtest: gt0
[114.612482] Dynamic subtest gt0: SKIP (0.005s)
[114.615730] Subtest thresholds-idle: SKIP (0.007s)
[114.732628] [014/142] (895s left) syncobj_wait (invalid-wait-bad-flags)
[114.953236] Starting subtest: invalid-wait-bad-flags
[114.955128] Subtest invalid-wait-bad-flags: SUCCESS (0.000s)
[115.049552] [015/142] (895s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite)
[115.370134] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite
[115.373030] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[115.466385] [016/142] (895s left) gem_request_retire (retire-vma-not-inactive)
[115.682379] Starting subtest: retire-vma-not-inactive
[115.718322] Subtest retire-vma-not-inactive: SUCCESS (0.034s)
[115.832244] [017/142] (894s left) kms_psr_stress_test (flip-primary-invalidate-overlay)
[116.037457] Subtest flip-primary-invalidate-overlay: SKIP (0.000s)
[116.098574] [018/142] (894s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[116.410040] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu
[116.412849] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[116.499595] [019/142] (894s left) kms_big_fb (x-tiled-16bpp-rotate-180)
[116.827582] Starting subtest: x-tiled-16bpp-rotate-180
[120.591927] Subtest x-tiled-16bpp-rotate-180: SUCCESS (3.764s)
[120.920414] [020/142] (889s left) gem_exec_reloc (basic-gtt-active)
[121.146096] Starting subtest: basic-gtt-active
[121.301318] Subtest basic-gtt-active: SUCCESS (0.154s)
[121.500583] [021/142] (889s left) gem_exec_balancer (nohangcheck)
[125.642938] Starting subtest: nohangcheck
[129.388782] Subtest nohangcheck: SUCCESS (3.745s)
[129.484889] [022/142] (881s left) vgem_basic (sysfs)
[129.693058] Starting subtest: sysfs
[129.694581] Subtest sysfs: SUCCESS (0.001s)
[129.765725] [023/142] (881s left) kms_ccs (pipe-b-bad-rotation-90-4_tiled_mtl_mc_ccs)
[130.262629] Starting subtest: pipe-B-bad-rotation-90-4_tiled_mtl_mc_ccs
[130.265560] Subtest pipe-B-bad-rotation-90-4_tiled_mtl_mc_ccs: SKIP (0.000s)
[130.767816] [024/142] (880s left) kms_hdr (static-toggle-suspend)
[131.076786] Starting subtest: static-toggle-suspend
[131.079825] Subtest static-toggle-suspend: SKIP (0.000s)
[131.168243] [025/142] (879s left) kms_ccs (pipe-b-crc-primary-basic-y_tiled_gen12_rc_ccs)
[131.688974] Starting subtest: pipe-B-crc-primary-basic-y_tiled_gen12_rc_ccs
[131.694742] Subtest pipe-B-crc-primary-basic-y_tiled_gen12_rc_ccs: SKIP (0.002s)
[132.195270] [026/142] (878s left) kms_cdclk (mode-transition-all-outputs)
[132.399682] Subtest mode-transition-all-outputs: SKIP (0.000s)
[132.459965] [027/142] (878s left) kms_color (deep-color)
[132.766771] Starting subtest: deep-color
[132.769785] Subtest deep-color: SKIP (0.000s)
[132.845508] [028/142] (878s left) kms_plane_multiple (tiling-none)
[133.153527] Starting subtest: tiling-none
[133.155213] Starting dynamic subtest: pipe-A-DP-1
[134.625622] Dynamic subtest pipe-A-DP-1: SUCCESS (1.473s)
[134.646499] Starting dynamic subtest: pipe-B-DP-1
[136.353769] Dynamic subtest pipe-B-DP-1: SUCCESS (1.724s)
[136.374671] Starting dynamic subtest: pipe-C-DP-1
[138.058755] Dynamic subtest pipe-C-DP-1: SUCCESS (1.700s)
[138.060295] Subtest tiling-none: SUCCESS (4.910s)
[138.404479] [029/142] (872s left) kms_ccs (pipe-c-bad-rotation-90-y_tiled_ccs)
[138.982160] Starting subtest: pipe-C-bad-rotation-90-y_tiled_ccs
[138.985093] Subtest pipe-C-bad-rotation-90-y_tiled_ccs: SKIP (0.000s)
[139.389741] [030/142] (871s left) kms_lease (setcrtc_implicit_plane)
[139.699364] Starting subtest: setcrtc_implicit_plane
[139.700873] Starting dynamic subtest: pipe-A-DP-1
[140.005541] Dynamic subtest pipe-A-DP-1: SUCCESS (0.302s)
[140.026310] Starting dynamic subtest: pipe-B-DP-1
[140.608645] Dynamic subtest pipe-B-DP-1: SUCCESS (0.599s)
[140.630522] Starting dynamic subtest: pipe-C-DP-1
[141.392633] Dynamic subtest pipe-C-DP-1: SUCCESS (0.781s)
[141.394351] Subtest setcrtc_implicit_plane: SUCCESS (1.694s)
[141.723919] [031/142] (869s left) kms_addfb_basic (bad-pitch-1024)
[141.929105] Starting subtest: bad-pitch-1024
[141.930750] Subtest bad-pitch-1024: SUCCESS (0.000s)
[142.140550] [032/142] (869s left) kms_ccs (pipe-b-bad-pixel-format-4_tiled_dg2_rc_ccs_cc)
[142.610580] Starting subtest: pipe-B-bad-pixel-format-4_tiled_dg2_rc_ccs_cc
[142.613608] Subtest pipe-B-bad-pixel-format-4_tiled_dg2_rc_ccs_cc: SKIP (0.000s)
[143.125748] [033/142] (868s left) gem_exec_fair (basic-flow)
[143.361813] Starting subtest: basic-flow
[143.363440] Starting dynamic subtest: rcs0
[148.396487] Dynamic subtest rcs0: SUCCESS (5.032s)
[148.397812] Subtest basic-flow: SUCCESS (5.035s)
[148.611142] [034/142] (862s left) kms_flip (flip-vs-absolute-wf_vblank)
[148.913322] Starting subtest: flip-vs-absolute-wf_vblank
[148.917951] Starting dynamic subtest: A-DP1
[159.743158] Dynamic subtest A-DP1: SUCCESS (10.822s)
[159.761592] Starting dynamic subtest: B-DP1
[170.471605] Dynamic subtest B-DP1: SUCCESS (10.730s)
[170.494167] Starting dynamic subtest: C-DP1
[181.231283] Dynamic subtest C-DP1: SUCCESS (10.757s)
[181.236454] Subtest flip-vs-absolute-wf_vblank: SUCCESS (32.325s)
[181.666502] [035/142] (829s left) kms_ccs (pipe-a-bad-pixel-format-y_tiled_gen12_rc_ccs)
[181.970903] Starting subtest: pipe-A-bad-pixel-format-y_tiled_gen12_rc_ccs
[181.973638] Subtest pipe-A-bad-pixel-format-y_tiled_gen12_rc_ccs: SKIP (0.000s)
[182.697368] [036/142] (828s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-ccs)
[182.921885] Starting subtest: y-tiled-ccs-to-yf-tiled-ccs
[182.923916] Starting dynamic subtest: smem
[183.356298] Dynamic subtest smem: SUCCESS (0.432s)
[183.358628] Subtest y-tiled-ccs-to-yf-tiled-ccs: SUCCESS (0.435s)
[183.565266] [037/142] (827s left) kms_ccs (pipe-c-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs)
[184.246982] Starting subtest: pipe-C-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs
[184.253377] Subtest pipe-C-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs: SKIP (0.005s)
[184.591650] [038/142] (826s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-fullscreen)
[184.906971] Starting subtest: fbc-1p-primscrn-spr-indfb-fullscreen
[186.466448] Subtest fbc-1p-primscrn-spr-indfb-fullscreen: SUCCESS (1.562s)
[186.608336] [039/142] (824s left) kms_ccs (pipe-a-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc)
[187.065951] Starting subtest: pipe-A-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc
[187.069060] Subtest pipe-A-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[187.605598] [040/142] (823s left) gem_exec_schedule (submit-early-slice)
[187.843657] Starting subtest: submit-early-slice
[187.845444] Starting dynamic subtest: rcs0
[187.907347] Dynamic subtest rcs0: SUCCESS (0.062s)
[187.934989] Starting dynamic subtest: bcs0
[187.979703] Dynamic subtest bcs0: SUCCESS (0.068s)
[188.005700] Starting dynamic subtest: vcs0
[188.046581] Dynamic subtest vcs0: SUCCESS (0.065s)
[188.072158] Starting dynamic subtest: vecs0
[188.108200] Dynamic subtest vecs0: SUCCESS (0.059s)
[188.112622] Subtest submit-early-slice: SUCCESS (0.267s)
[188.456605] [041/142] (823s left) gem_exec_params (invalid-ring2)
[188.667202] Starting subtest: invalid-ring2
[188.669290] Subtest invalid-ring2: SUCCESS (0.001s)
[188.772290] [042/142] (822s left) gem_wait (invalid-buf)
[188.981700] Starting subtest: invalid-buf
[188.983287] Subtest invalid-buf: SUCCESS (0.000s)
[189.256540] [043/142] (822s left) gem_exec_reloc (basic-wc-gtt-active)
[189.467502] Starting subtest: basic-wc-gtt-active
[189.611402] Subtest basic-wc-gtt-active: SUCCESS (0.143s)
[189.789366] [044/142] (821s left) i915_suspend (fence-restore-tiled2untiled)
[189.990668] Starting subtest: fence-restore-tiled2untiled
[209.660025] Subtest fence-restore-tiled2untiled: SUCCESS (4.288s)
[212.804801] [045/142] (817s left) api_intel_allocator (two-level-inception-interruptible)
[213.010044] Starting subtest: two-level-inception-interruptible
[218.558647] Subtest two-level-inception-interruptible: SUCCESS (5.549s)
[218.649366] [046/142] (811s left) kms_ccs (pipe-a-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs_cc)
[219.103284] Starting subtest: pipe-A-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs_cc
[219.110072] Subtest pipe-A-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs_cc: SKIP (0.005s)
[219.646917] [047/142] (810s left) gem_userptr_blits (stress-purge)
[219.890882] Starting subtest: stress-purge
[225.362478] Subtest stress-purge: SUCCESS (5.471s)
[225.541636] [048/142] (804s left) kms_chamelium_frames (hdmi-cmp-planar-formats)
[226.068711] Subtest hdmi-cmp-planar-formats: SKIP (0.000s)
[226.361799] [049/142] (803s left) gem_mmap_wc (set-cache-level)
[226.569871] Starting subtest: set-cache-level
[226.572385] Subtest set-cache-level: SUCCESS (0.005s)
[226.675275] [050/142] (803s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling)
[226.987815] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-downscaling
[226.989774] Starting dynamic subtest: pipe-A-valid-mode
[227.081580] Dynamic subtest pipe-A-valid-mode: SKIP (0.092s)
[227.084134] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (0.096s)
[227.384698] [051/142] (802s left) syncobj_timeline (single-wait-for-submit-available-signaled)
[227.604682] Starting subtest: single-wait-for-submit-available-signaled
[227.606587] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.001s)
[227.700722] [052/142] (802s left) kms_psr2_sf (cursor-plane-move-continuous-sf)
[227.904500] Subtest cursor-plane-move-continuous-sf: SKIP (0.000s)
[227.966715] [053/142] (802s left) kms_vblank (pipe-d-query-idle)
[228.268549] Subtest pipe-D-query-idle: SKIP (0.000s)
[228.351380] [054/142] (802s left) kms_addfb_basic (too-high)
[228.665690] Starting subtest: too-high
[228.667360] Subtest too-high: SUCCESS (0.002s)
[228.768119] [055/142] (801s left) kms_big_fb (yf-tiled-16bpp-rotate-270)
[229.109661] Starting subtest: yf-tiled-16bpp-rotate-270
[229.197814] Subtest yf-tiled-16bpp-rotate-270: SKIP (0.087s)
[229.317699] [056/142] (801s left) gem_exec_schedule (preempt-hang)
[229.677155] Starting subtest: preempt-hang
[229.679284] Starting dynamic subtest: rcs0
[229.973699] Dynamic subtest rcs0: SUCCESS (0.294s)
[230.001188] Starting dynamic subtest: bcs0
[230.278162] Dynamic subtest bcs0: SUCCESS (0.302s)
[230.305743] Starting dynamic subtest: vcs0
[230.555932] Dynamic subtest vcs0: SUCCESS (0.276s)
[230.583151] Starting dynamic subtest: vecs0
[230.835981] Dynamic subtest vecs0: SUCCESS (0.279s)
[230.837964] Subtest preempt-hang: SUCCESS (1.163s)
[231.085110] [057/142] (799s left) prime_udl
[231.350660] [058/142] (799s left) kms_plane_scaling (plane-downscale-with-modifiers-factor-0-25)
[231.651089] Starting subtest: plane-downscale-with-modifiers-factor-0-25
[231.652638] Starting dynamic subtest: pipe-A-DP-1
[231.713491] Dynamic subtest pipe-A-DP-1: SKIP (0.050s)
[231.737335] Starting dynamic subtest: pipe-B-DP-1
[231.811659] Dynamic subtest pipe-B-DP-1: SKIP (0.093s)
[231.834695] Starting dynamic subtest: pipe-C-DP-1
[231.902289] Dynamic subtest pipe-C-DP-1: SKIP (0.093s)
[231.905140] Subtest plane-downscale-with-modifiers-factor-0-25: SKIP (0.252s)
[232.018007] [059/142] (798s left) gen7_exec_parse (basic-rejected)
[232.234291] Subtest basic-rejected: SKIP (0.000s)
[232.299653] [060/142] (798s left) vgem_basic (bad-fence)
[232.507031] Starting subtest: bad-fence
[232.508780] Subtest bad-fence: SUCCESS (0.000s)
[232.584700] [061/142] (798s left) kms_psr (psr2_primary_page_flip)
[232.790014] Subtest psr2_primary_page_flip: SKIP (0.000s)
[232.850948] [062/142] (797s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-render)
[233.160889] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-render
[233.164218] Subtest fbc-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[233.268415] [063/142] (797s left) fbdev (eof)
[233.492146] Starting subtest: eof
[233.493832] Subtest eof: SUCCESS (0.000s)
[233.568056] [064/142] (797s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[233.897686] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip
[233.901180] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[234.018614] [065/142] (796s left) kms_psr (suspend)
[234.223492] Subtest suspend: SKIP (0.000s)
[234.283967] [066/142] (796s left) syncobj_wait (single-wait-all-for-submit-signaled)
[234.484804] Starting subtest: single-wait-all-for-submit-signaled
[234.486631] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.001s)
[234.584663] [067/142] (796s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[234.903934] Starting subtest: fbc-rgb565-draw-mmap-gtt
[237.056381] Subtest fbc-rgb565-draw-mmap-gtt: SUCCESS (2.154s)
[237.201311] [068/142] (793s left) kms_frontbuffer_tracking (fbcpsr-tiling-4)
[237.514275] Starting subtest: fbcpsr-tiling-4
[237.517290] Subtest fbcpsr-tiling-4: SKIP (0.000s)
[237.618351] [069/142] (793s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[237.918225] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[237.920810] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.004s)
[238.018590] [070/142] (793s left) gem_exec_fence (basic-busy-all)
[238.245843] Starting subtest: basic-busy-all
[238.278111] Subtest basic-busy-all: SUCCESS (0.032s)
[239.084295] [071/142] (792s left) gem_ctx_persistence (idempotent)
[239.295186] Starting subtest: idempotent
[239.296831] Subtest idempotent: SUCCESS (0.000s)
[239.384324] [072/142] (791s left) drm_fdinfo (virtual-busy-hang)
[239.594103] Starting subtest: virtual-busy-hang
[243.822119] Subtest virtual-busy-hang: SUCCESS (4.227s)
[243.918714] [073/142] (787s left) v3d/v3d_mmap (mmap-bad-handle)
[244.174222] Subtest mmap-bad-handle: SKIP (0.000s)
[244.250239] [074/142] (787s left) perf (rc6-disable)
[244.594881] Starting subtest: rc6-disable
[244.830559] Subtest rc6-disable: SUCCESS (0.234s)
[244.886729] [075/142] (786s left) kms_panel_fitting (atomic-fastset)
[245.185280] Starting subtest: atomic-fastset
[245.188295] Subtest atomic-fastset: SKIP (0.001s)
[245.285012] [076/142] (786s left) syncobj_timeline (wait-for-submit-delayed-submit)
[245.489910] Starting subtest: wait-for-submit-delayed-submit
[245.594365] Subtest wait-for-submit-delayed-submit: SUCCESS (0.104s)
[245.684872] [077/142] (785s left) kms_vblank (pipe-a-query-busy-hang)
[245.994804] Starting subtest: pipe-A-query-busy-hang
[253.388590] Subtest pipe-A-query-busy-hang: SUCCESS (7.395s)
[253.736396] [078/142] (777s left) gem_exec_whisper (basic-fds-priority-all)
[253.964369] Starting subtest: basic-fds-priority-all
[278.379963] Subtest basic-fds-priority-all: SUCCESS (24.413s)
[278.588024] [079/142] (752s left) perf_pmu (busy-check-all)
[278.801621] Starting subtest: busy-check-all
[278.803217] Starting dynamic subtest: rcs0
[279.333211] Dynamic subtest rcs0: SUCCESS (0.530s)
[279.362992] Starting dynamic subtest: bcs0
[279.873681] Dynamic subtest bcs0: SUCCESS (0.537s)
[279.901685] Starting dynamic subtest: vcs0
[280.405270] Dynamic subtest vcs0: SUCCESS (0.529s)
[280.435595] Starting dynamic subtest: vecs0
[280.940355] Dynamic subtest vecs0: SUCCESS (0.532s)
[280.942876] Subtest busy-check-all: SUCCESS (2.140s)
[281.036197] [080/142] (750s left) kms_color (ctm-0-25)
[281.335784] Starting subtest: ctm-0-25
[281.337193] Starting dynamic subtest: pipe-A
[283.231658] Dynamic subtest pipe-A: SUCCESS (1.894s)
[283.272241] Starting dynamic subtest: pipe-B
[285.390392] Dynamic subtest pipe-B: SUCCESS (2.156s)
[285.423537] Starting dynamic subtest: pipe-C
[287.688669] Dynamic subtest pipe-C: SUCCESS (2.298s)
[287.690255] Subtest ctm-0-25: SUCCESS (6.355s)
[288.053108] [081/142] (743s left) kms_frontbuffer_tracking (psr-1p-pri-indfb-multidraw)
[288.369419] Starting subtest: psr-1p-pri-indfb-multidraw
[288.372083] Subtest psr-1p-pri-indfb-multidraw: SKIP (0.000s)
[288.486308] [082/142] (743s left) vc4/vc4_perfmon (get-values-invalid-perfmon)
[288.740268] Subtest get-values-invalid-perfmon: SKIP (0.000s)
[288.818726] [083/142] (742s left) kms_cursor_legacy (flip-vs-cursor-toggle)
[289.132228] Starting subtest: flip-vs-cursor-toggle
[308.686770] Subtest flip-vs-cursor-toggle: SUCCESS (19.556s)
[309.035318] [084/142] (722s left) core_auth (basic-auth)
[309.241385] Starting subtest: basic-auth
[309.243067] Subtest basic-auth: SUCCESS (0.002s)
[309.334013] [085/142] (722s left) kms_vblank (pipe-a-query-idle-hang)
[309.631748] Starting subtest: pipe-A-query-idle-hang
[316.349982] Subtest pipe-A-query-idle-hang: SUCCESS (6.720s)
[316.700283] [086/142] (715s left) gem_linear_blits (interruptible)
[317.297484] Starting subtest: interruptible
[333.673534] Subtest interruptible: SUCCESS (16.373s)
[333.769394] [087/142] (698s left) gem_ctx_persistence (many-contexts)
[334.101893] Starting subtest: many-contexts
[366.939015] Subtest many-contexts: SUCCESS (32.837s)
[367.034630] [088/142] (664s left) kms_cursor_legacy (cursora-vs-flipa-atomic)
[367.353750] Starting subtest: cursorA-vs-flipA-atomic
[378.569249] Subtest cursorA-vs-flipA-atomic: SUCCESS (11.219s)
[378.919528] [089/142] (653s left) gem_pxp (reject-modify-context-protection-on)
[381.646524] Subtest reject-modify-context-protection-on: SKIP (0.000s)
[381.732993] [090/142] (650s left) gem_fence_thrash (bo-write-verify-none)
[381.933377] Starting subtest: bo-write-verify-none
[383.049140] Subtest bo-write-verify-none: SUCCESS (1.115s)
[383.166625] [091/142] (648s left) prime_self_import (basic-llseek-bad)
[383.369205] Starting subtest: basic-llseek-bad
[383.375450] Subtest basic-llseek-bad: SUCCESS (0.004s)
[383.482832] [092/142] (648s left) kms_writeback (writeback-pixel-formats)
[383.887037] Subtest writeback-pixel-formats: SKIP (0.000s)
[383.949882] [093/142] (648s left) kms_frontbuffer_tracking (fbcpsr-modesetfrombusy)
[384.265763] Starting subtest: fbcpsr-modesetfrombusy
[384.268611] Subtest fbcpsr-modesetfrombusy: SKIP (0.000s)
[384.384397] [094/142] (647s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-upscaling)
[384.697550] Starting subtest: flip-64bpp-linear-to-32bpp-linear-upscaling
[384.700179] Starting dynamic subtest: pipe-A-valid-mode
[385.091648] Dynamic subtest pipe-A-valid-mode: SKIP (0.393s)
[385.094565] Subtest flip-64bpp-linear-to-32bpp-linear-upscaling: SKIP (0.397s)
[385.469734] [095/142] (646s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180)
[385.806409] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180
[385.809784] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[385.902288] [096/142] (646s left) gem_exec_schedule (deep)
[386.284859] Starting subtest: deep
[386.286449] Starting dynamic subtest: rcs0
[400.684684] Dynamic subtest rcs0: SUCCESS (14.394s)
[400.722712] Starting dynamic subtest: bcs0
[415.681897] Dynamic subtest bcs0: SUCCESS (14.990s)
[415.717644] Starting dynamic subtest: vcs0
[430.020224] Dynamic subtest vcs0: SUCCESS (14.330s)
[430.053164] Starting dynamic subtest: vecs0
[444.410279] Dynamic subtest vecs0: SUCCESS (14.384s)
[444.416936] Subtest deep: SUCCESS (58.128s)
[445.405283] [097/142] (586s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-render)
[445.720708] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-render
[445.723812] Subtest fbcpsr-1p-offscren-pri-indfb-draw-render: SKIP (0.000s)
[445.836154] [098/142] (586s left) kms_universal_plane (disable-primary-vs-flip-pipe-b)
[446.137351] Starting subtest: disable-primary-vs-flip-pipe-B
[447.197543] Subtest disable-primary-vs-flip-pipe-B: SUCCESS (1.063s)
[447.541628] [099/142] (584s left) gem_busy (semaphore)
[447.911122] Starting subtest: semaphore
[447.913139] Starting dynamic subtest: rcs0
[447.944260] Dynamic subtest rcs0: SUCCESS (0.032s)
[447.975636] Starting dynamic subtest: bcs0
[447.977330] Dynamic subtest bcs0: SUCCESS (0.028s)
[448.004873] Starting dynamic subtest: vcs0
[448.006325] Dynamic subtest vcs0: SUCCESS (0.026s)
[448.033028] Starting dynamic subtest: vecs0
[448.040545] Dynamic subtest vecs0: SUCCESS (0.033s)
[448.042123] Subtest semaphore: SUCCESS (0.131s)
[448.292039] [100/142] (584s left) i915_pm_rpm (legacy-planes)
[450.088815] Starting subtest: legacy-planes
[450.091650] Starting dynamic subtest: plane-39
[452.465831] Dynamic subtest plane-39: SUCCESS (2.375s)
[452.495814] Starting dynamic subtest: plane-47
[454.755134] Dynamic subtest plane-47: SUCCESS (2.286s)
[454.757952] Subtest legacy-planes: SUCCESS (4.668s)
[455.223796] [101/142] (577s left) gem_ctx_param (set-priority-not-supported)
[455.429607] Starting subtest: set-priority-not-supported
[455.432860] Subtest set-priority-not-supported: SKIP (0.000s)
[455.520384] [102/142] (577s left) gem_exec_balancer (busy)
[455.749322] Starting subtest: busy
[457.686733] Subtest busy: SUCCESS (1.937s)
[461.673287] [103/142] (570s left) kms_flip (2x-flip-vs-suspend)
[461.958151] Starting subtest: 2x-flip-vs-suspend
[461.960771] Subtest 2x-flip-vs-suspend: SKIP (0.003s)
[462.087221] [104/142] (570s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-move)
[462.405960] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-move
[462.409261] Subtest fbcpsr-1p-primscrn-cur-indfb-move: SKIP (0.000s)
[462.520207] [105/142] (570s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-gtt)
[462.838960] Starting subtest: fbc-rgb101010-draw-mmap-gtt
[465.489159] Subtest fbc-rgb101010-draw-mmap-gtt: SUCCESS (2.651s)
[465.636215] [106/142] (567s left) gem_ctx_param (invalid-ctx-set)
[465.841656] Starting subtest: invalid-ctx-set
[465.843472] Subtest invalid-ctx-set: SUCCESS (0.000s)
[465.936754] [107/142] (566s left) gem_mmap_gtt (basic-write-read-distinct)
[466.139886] Starting subtest: basic-write-read-distinct
[466.172040] Subtest basic-write-read-distinct: SUCCESS (0.033s)
[466.288831] [108/142] (566s left) gem_exec_fence (syncobj-invalid-wait)
[466.961232] Starting subtest: syncobj-invalid-wait
[466.963154] Subtest syncobj-invalid-wait: SUCCESS (0.002s)
[467.320674] [109/142] (565s left) api_intel_bb (reset-flags)
[467.527094] Starting subtest: reset-flags
[467.551606] Subtest reset-flags: SUCCESS (0.023s)
[467.669518] [110/142] (565s left) kms_plane_scaling (planes-upscale-factor-0-25)
[467.968202] Starting subtest: planes-upscale-factor-0-25
[467.969794] Starting dynamic subtest: pipe-A-DP-1
[468.037717] Dynamic subtest pipe-A-DP-1: SUCCESS (0.069s)
[468.066118] Starting dynamic subtest: pipe-B-DP-1
[468.415185] Dynamic subtest pipe-B-DP-1: SUCCESS (0.372s)
[468.460689] Starting dynamic subtest: pipe-C-DP-1
[468.518185] Dynamic subtest pipe-C-DP-1: SKIP (0.095s)
[468.519804] Subtest planes-upscale-factor-0-25: SUCCESS (0.552s)
[468.937142] [111/142] (564s left) v3d/v3d_submit_cl (multisync-out-syncs)
[469.189902] Subtest multisync-out-syncs: SKIP (0.000s)
[469.269863] [112/142] (563s left) kms_cursor_crc (cursor-random-256x256)
[469.578226] Starting subtest: cursor-random-256x256
[469.590789] Starting dynamic subtest: pipe-A-DP-1
[473.409642] Dynamic subtest pipe-A-DP-1: SUCCESS (3.814s)
[473.509312] Starting dynamic subtest: pipe-C-DP-1
[477.639902] Dynamic subtest pipe-C-DP-1: SUCCESS (4.167s)
[477.641567] Subtest cursor-random-256x256: SUCCESS (8.061s)
[477.996316] [113/142] (555s left) gem_mmap (bad-size)
[478.199363] Starting subtest: bad-size
[478.201096] Subtest bad-size: SUCCESS (0.002s)
[478.308902] [114/142] (554s left) i915_query (query-topology-known-pci-ids)
[478.513174] Starting subtest: query-topology-known-pci-ids
[478.516463] Subtest query-topology-known-pci-ids: SKIP (0.000s)
[478.608989] [115/142] (554s left) gen9_exec_parse (cmd-crossing-page)
[478.834161] Starting subtest: cmd-crossing-page
[478.841105] Subtest cmd-crossing-page: SUCCESS (0.007s)
[479.075290] [116/142] (554s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa
[479.282867] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled
[479.284886] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.002s)
[479.375630] [117/142] (553s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-fullscreen)
[479.680882] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-fullscreen
[479.683735] Subtest fbcpsr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[479.792636] [118/142] (553s left) kms_ccs (pipe-b-random-ccs-data-y_tiled_ccs)
[480.314264] Starting subtest: pipe-B-random-ccs-data-y_tiled_ccs
[480.758544] Subtest pipe-B-random-ccs-data-y_tiled_ccs: SUCCESS (0.442s)
[481.321740] [119/142] (552s left) gem_mmap_offset (bad-extensions)
[481.527012] Starting subtest: bad-extensions
[481.528918] Subtest bad-extensions: SUCCESS (0.000s)
[481.638683] [120/142] (551s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[481.944784] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[481.947958] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[482.059232] [121/142] (551s left) kms_atomic_interruptible (legacy-dpms)
[482.359263] Starting subtest: legacy-dpms
[482.363528] Starting dynamic subtest: DP-1-pipe-A
[488.947558] Dynamic subtest DP-1-pipe-A: SUCCESS (6.583s)
[488.949128] Subtest legacy-dpms: SUCCESS (6.588s)
[489.298568] [122/142] (544s left) perf_pmu (rc6-suspend)
[489.507749] Starting subtest: rc6-suspend
[514.075553] Subtest rc6-suspend: SUCCESS (8.664s)
[514.737438] [123/142] (535s left) kms_ccs (pipe-d-crc-primary-rotation-180-4_tiled_mtl_rc_ccs_cc)
[515.436657] Subtest pipe-D-crc-primary-rotation-180-4_tiled_mtl_rc_ccs_cc: SKIP (0.000s)
[515.762027] [124/142] (534s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[516.076497] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-cpu
[516.079626] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[516.179566] [125/142] (533s left) kms_big_fb (4-tiled-32bpp-rotate-270)
[516.512010] Starting subtest: 4-tiled-32bpp-rotate-270
[516.515185] Subtest 4-tiled-32bpp-rotate-270: SKIP (0.000s)
[516.628822] [126/142] (533s left) syncobj_wait (multi-wait-all-signaled)
[516.834201] Starting subtest: multi-wait-all-signaled
[516.836018] Subtest multi-wait-all-signaled: SUCCESS (0.001s)
[516.929448] [127/142] (533s left) syncobj_timeline (etime-single-wait-for-submit-submitted)
[517.133849] Starting subtest: etime-single-wait-for-submit-submitted
[517.236461] Subtest etime-single-wait-for-submit-submitted: SUCCESS (0.102s)
[517.328920] [128/142] (532s left) kms_big_fb (linear-16bpp-rotate-270)
[517.651539] Starting subtest: linear-16bpp-rotate-270
[517.744803] Subtest linear-16bpp-rotate-270: SKIP (0.090s)
[517.861999] [129/142] (532s left) kms_cursor_edge_walk (128x128-top-bottom)
[518.171614] Starting subtest: 128x128-top-bottom
[518.173097] Starting dynamic subtest: pipe-A-DP-1
[521.873445] Dynamic subtest pipe-A-DP-1: SUCCESS (3.700s)
[521.907613] Starting dynamic subtest: pipe-C-DP-1
[525.396947] Dynamic subtest pipe-C-DP-1: SUCCESS (3.517s)
[525.398552] Subtest 128x128-top-bottom: SUCCESS (7.229s)
[525.735324] [130/142] (524s left) gem_ctx_engines (execute-one)
[525.964163] Starting subtest: execute-one
[529.050924] Subtest execute-one: SUCCESS (3.085s)
[529.303319] [131/142] (521s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted-signaled)
[529.513929] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[529.515549] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[529.617053] [132/142] (520s left) kms_ccs (pipe-d-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs_cc)
[530.308614] Subtest pipe-D-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[530.640413] [133/142] (519s left) gem_softpin (allocator-fork)
[530.852461] Starting subtest: allocator-fork
[533.219176] Subtest allocator-fork: SUCCESS (2.366s)
[533.342406] [134/142] (517s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-move)
[533.655389] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-move
[533.658339] Subtest fbcpsr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[533.774001] [135/142] (516s left) gem_exercise_blt (fast-copy-emit)
[533.983385] Starting subtest: fast-copy-emit
[533.984998] Starting dynamic subtest: linear-smem-smem-emit
[534.043544] Dynamic subtest linear-smem-smem-emit: SUCCESS (0.057s)
[534.068957] Starting dynamic subtest: ymajor-smem-smem-emit
[534.093591] Dynamic subtest ymajor-smem-smem-emit: SUCCESS (0.049s)
[534.125344] Starting dynamic subtest: yfmajor-smem-smem-emit
[534.143674] Dynamic subtest yfmajor-smem-smem-emit: SUCCESS (0.047s)
[534.171083] Starting dynamic subtest: tile64-smem-smem-emit
[534.193548] Dynamic subtest tile64-smem-smem-emit: SUCCESS (0.047s)
[534.195067] Subtest fast-copy-emit: SUCCESS (0.211s)
[534.323096] [136/142] (516s left) kms_cursor_legacy (cursor-vs-flip-varying-size)
[534.633854] Starting subtest: cursor-vs-flip-varying-size
[576.562823] Subtest cursor-vs-flip-varying-size: SUCCESS (41.931s)
[576.920952] [137/142] (473s left) v3d/v3d_submit_csd (valid-submission)
[577.187409] Subtest valid-submission: SKIP (0.000s)
[577.267671] [138/142] (473s left) gem_wait (invalid-flags)
[577.480097] Starting subtest: invalid-flags
[577.481523] Subtest invalid-flags: SUCCESS (0.000s)
[577.767486] [139/142] (473s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[578.089310] Starting subtest: cursor-rapid-movement-512x512
[578.096499] Subtest cursor-rapid-movement-512x512: SKIP (0.003s)
[578.201049] [140/142] (472s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-pwrite)
[578.519878] Starting subtest: psr-2p-primscrn-cur-indfb-draw-pwrite
[578.522827] Subtest psr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[578.634479] [141/142] (472s left) kms_ccs (pipe-d-bad-pixel-format-4_tiled_mtl_mc_ccs)
[579.289071] Subtest pipe-D-bad-pixel-format-4_tiled_mtl_mc_ccs: SKIP (0.000s)
[579.613165] [142/142] (471s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[579.931533] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[579.937495] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.003s)
[580.026672] Closing watchdogs
Done.