[52.683202] Initializing watchdogs
[52.683454]   /dev/watchdog0
[52.719082] [001/142] (960s left) kms_vblank (pipe-a-query-forked-busy)
[53.150777] Starting subtest: pipe-A-query-forked-busy
[55.634528] Subtest pipe-A-query-forked-busy: SUCCESS (2.502s)
[55.993787] [002/142] (957s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-render)
[56.468270] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-render
[56.507480] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[56.606859] [003/142] (956s left) kms_vblank (pipe-c-query-busy-hang)
[56.962400] Starting subtest: pipe-C-query-busy-hang
[64.127195] Subtest pipe-C-query-busy-hang: SUCCESS (7.039s)
[64.388372] [004/142] (949s left) kms_vblank (pipe-c-query-forked-busy-hang)
[64.745919] Starting subtest: pipe-C-query-forked-busy-hang
[72.017925] Subtest pipe-C-query-forked-busy-hang: SUCCESS (7.262s)
[72.392237] [005/142] (941s left) kms_ccs (pipe-c-crc-primary-rotation-180-4_tiled_mtl_mc_ccs)
[73.107944] Starting subtest: pipe-C-crc-primary-rotation-180-4_tiled_mtl_mc_ccs
[73.148771] Subtest pipe-C-crc-primary-rotation-180-4_tiled_mtl_mc_ccs: SKIP (0.001s)
[73.509268] [006/142] (940s left) kms_flip (2x-flip-vs-rmfb)
[73.869334] Starting subtest: 2x-flip-vs-rmfb
[73.907310] Subtest 2x-flip-vs-rmfb: SKIP (0.003s)
[74.014326] [007/142] (939s left) kms_cursor_crc (cursor-offscreen-max-size)
[74.417303] Starting subtest: cursor-offscreen-max-size
[74.476426] Subtest cursor-offscreen-max-size: SKIP (0.000s)
[74.579151] [008/142] (939s left) perf_pmu (busy-hang)
[74.877042] Starting subtest: busy-hang
[74.897740] Starting dynamic subtest: rcs0
[75.921352] Dynamic subtest rcs0: SUCCESS (1.053s)
[75.955249] Starting dynamic subtest: bcs0
[76.968371] Dynamic subtest bcs0: SUCCESS (1.048s)
[77.000539] Starting dynamic subtest: vcs0
[78.020307] Dynamic subtest vcs0: SUCCESS (1.051s)
[78.052574] Starting dynamic subtest: vecs0
[79.069419] Dynamic subtest vecs0: SUCCESS (1.046s)
[79.090119] Subtest busy-hang: SUCCESS (4.198s)
[79.188803] [009/142] (934s left) kms_tiled_display (basic-test-pattern-with-chamelium)
[79.663120] Subtest basic-test-pattern-with-chamelium: SKIP (0.000s)
[79.768806] [010/142] (934s left) gem_exec_fair (basic-pace-share)
[80.248059] Starting subtest: basic-pace-share
[80.269787] Starting dynamic subtest: rcs0
[84.907646] Dynamic subtest rcs0: SUCCESS (4.843s)
[84.926122] Subtest basic-pace-share: SUCCESS (4.843s)
[85.137656] [011/142] (929s left) syncobj_timeline (etime-single-wait-all-submitted)
[85.418749] Starting subtest: etime-single-wait-all-submitted
[85.510968] Subtest etime-single-wait-all-submitted: SUCCESS (0.108s)
[85.622715] [012/142] (928s left) kms_ccs (pipe-c-crc-sprite-planes-basic-yf_tiled_ccs)
[86.348744] Starting subtest: pipe-C-crc-sprite-planes-basic-yf_tiled_ccs
[86.390964] Subtest pipe-C-crc-sprite-planes-basic-yf_tiled_ccs: SKIP (0.004s)
[86.717062] [013/142] (927s left) syncobj_timeline (invalid-transfer-bad-pad)
[87.002487] Starting subtest: invalid-transfer-bad-pad
[87.024082] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s)
[87.125514] [014/142] (927s left) kms_ccs (pipe-d-ccs-on-another-bo-y_tiled_ccs)
[87.862567] Subtest pipe-D-ccs-on-another-bo-y_tiled_ccs: SKIP (0.000s)
[88.219471] [015/142] (926s left) kms_plane_scaling (plane-downscale-with-modifiers-factor-0-25)
[88.633951] Starting subtest: plane-downscale-with-modifiers-factor-0-25
[88.664252] Starting dynamic subtest: pipe-A-DP-1
[88.717354] Dynamic subtest pipe-A-DP-1: SKIP (0.047s)
[88.757026] Starting dynamic subtest: pipe-B-DP-1
[88.808092] Dynamic subtest pipe-B-DP-1: SKIP (0.099s)
[88.853518] Starting dynamic subtest: pipe-C-DP-1
[88.905459] Dynamic subtest pipe-C-DP-1: SKIP (0.097s)
[88.959557] Subtest plane-downscale-with-modifiers-factor-0-25: SKIP (0.252s)
[89.096376] [016/142] (925s left) syncobj_wait (wait-for-submit-delayed-submit)
[89.390677] Starting subtest: wait-for-submit-delayed-submit
[89.474653] Subtest wait-for-submit-delayed-submit: SUCCESS (0.103s)
[89.599188] [017/142] (925s left) gem_workarounds (suspend-resume)
[89.919136] Starting subtest: suspend-resume
[106.988764] Subtest suspend-resume: SUCCESS (1.480s)
[113.111574] [018/142] (923s left) kms_ccs (pipe-b-crc-primary-rotation-180-y_tiled_gen12_mc_ccs)
[113.680852] Starting subtest: pipe-B-crc-primary-rotation-180-y_tiled_gen12_mc_ccs
[113.720052] Subtest pipe-B-crc-primary-rotation-180-y_tiled_gen12_mc_ccs: SKIP (0.001s)
[114.195482] [019/142] (922s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc)
[114.629967] Starting subtest: fbcpsr-rgb565-draw-mmap-wc
[114.668634] Subtest fbcpsr-rgb565-draw-mmap-wc: SKIP (0.000s)
[114.777461] [020/142] (921s left) gem_spin_batch (engines)
[115.074807] Starting subtest: engines
[115.095669] Starting dynamic subtest: rcs0
[118.579961] Dynamic subtest rcs0: SUCCESS (3.325s)
[118.617523] Starting dynamic subtest: bcs0
[121.776269] Dynamic subtest bcs0: SUCCESS (3.324s)
[121.812433] Starting dynamic subtest: vcs0
[125.232835] Dynamic subtest vcs0: SUCCESS (3.324s)
[125.269624] Starting dynamic subtest: vecs0
[128.550296] Dynamic subtest vecs0: SUCCESS (3.322s)
[128.571992] Subtest engines: SUCCESS (13.296s)
[128.661680] [021/142] (908s left) kms_big_fb (4-tiled-32bpp-rotate-270)
[129.056856] Starting subtest: 4-tiled-32bpp-rotate-270
[129.096850] Subtest 4-tiled-32bpp-rotate-270: SKIP (0.000s)
[129.208870] [022/142] (907s left) gem_readwrite (read-bad-handle)
[129.511042] Starting subtest: read-bad-handle
[129.549245] Subtest read-bad-handle: SUCCESS (0.000s)
[129.635657] [023/142] (907s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[130.029324] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[130.066932] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[130.177808] [024/142] (906s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[131.165582] Starting subtest: syncobj-timeline-multiple-ext-nodes
[131.184593] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.003s)
[131.413959] [025/142] (905s left) gem_ctx_param (basic-default)
[131.707016] Starting subtest: basic-default
[131.728828] Subtest basic-default: SUCCESS (0.000s)
[131.817268] [026/142] (905s left) gem_unfence_active_buffers
[132.378270] [027/142] (904s left) kms_ccs (pipe-b-bad-aux-stride-y_tiled_gen12_mc_ccs)
[132.997940] Starting subtest: pipe-B-bad-aux-stride-y_tiled_gen12_mc_ccs
[133.036254] Subtest pipe-B-bad-aux-stride-y_tiled_gen12_mc_ccs: SKIP (0.000s)
[133.466513] [028/142] (903s left) kms_cursor_crc (cursor-sliding-256x85)
[133.847880] Starting subtest: cursor-sliding-256x85
[133.867086] Starting dynamic subtest: pipe-A-DP-1
[137.723490] Dynamic subtest pipe-A-DP-1: SUCCESS (3.867s)
[137.807154] Starting dynamic subtest: pipe-C-DP-1
[141.797852] Dynamic subtest pipe-C-DP-1: SUCCESS (4.015s)
[141.816733] Subtest cursor-sliding-256x85: SUCCESS (7.958s)
[142.168586] [029/142] (895s left) gem_render_copy_redux (flink)
[142.466613] Starting subtest: flink
[147.140137] Subtest flink: SUCCESS (4.676s)
[147.268089] [030/142] (890s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-pwrite)
[147.722415] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-pwrite
[147.768957] Subtest fbc-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[147.888237] [031/142] (889s left) gem_tiled_partial_pwrite_pread (writes)
[148.187573] Starting subtest: writes
[150.374079] Subtest writes: SUCCESS (2.198s)
[150.502809] [032/142] (887s left) dumb_buffer (map-uaf)
[150.802378] Starting subtest: map-uaf
[150.844162] Subtest map-uaf: SUCCESS (0.065s)
[150.963272] [033/142] (886s left) gem_readwrite (beyond-eob)
[151.254834] Starting subtest: beyond-EOB
[151.293767] Subtest beyond-EOB: SUCCESS (0.000s)
[151.387668] [034/142] (886s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted)
[151.673657] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted
[151.747375] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.102s)
[151.863384] [035/142] (886s left) v3d/v3d_wait_bo (unused-bo-1ns)
[152.203543] Subtest unused-bo-1ns: SKIP (0.000s)
[152.294888] [036/142] (885s left) kms_dp_aux_dev
[153.141266] [037/142] (885s left) prime_busy (after)
[153.440343] Starting subtest: after
[153.461878] Starting dynamic subtest: rcs0
[153.483181] Dynamic subtest rcs0: SUCCESS (0.017s)
[153.523033] Starting dynamic subtest: bcs0
[153.543155] Dynamic subtest bcs0: SUCCESS (0.022s)
[153.580160] Starting dynamic subtest: vcs0
[153.599223] Dynamic subtest vcs0: SUCCESS (0.020s)
[153.636277] Starting dynamic subtest: vecs0
[153.656467] Dynamic subtest vecs0: SUCCESS (0.019s)
[153.678507] Subtest after: SUCCESS (0.212s)
[153.770143] [038/142] (884s left) kms_async_flips (test-cursor)
[154.129287] Starting subtest: test-cursor
[154.570448] Starting dynamic subtest: pipe-A-DP-1
[155.451982] Dynamic subtest pipe-A-DP-1: SUCCESS (0.885s)
[156.000063] Starting dynamic subtest: pipe-B-DP-1
[156.216547] Dynamic subtest pipe-B-DP-1: SUCCESS (0.268s)
[156.634509] Starting dynamic subtest: pipe-C-DP-1
[156.872544] Dynamic subtest pipe-C-DP-1: SUCCESS (0.261s)
[156.891566] Subtest test-cursor: SUCCESS (2.736s)
[157.509231] [039/142] (880s left) gem_softpin (evict-active)
[157.813023] Starting subtest: evict-active
[157.831913] Subtest evict-active: SUCCESS (0.022s)
[157.965486] [040/142] (880s left) kms_ccs (pipe-a-ccs-on-another-bo-4_tiled_mtl_rc_ccs)
[158.479477] Starting subtest: pipe-A-ccs-on-another-bo-4_tiled_mtl_rc_ccs
[158.520176] Subtest pipe-A-ccs-on-another-bo-4_tiled_mtl_rc_ccs: SKIP (0.000s)
[159.056785] [041/142] (879s left) i915_pm_backlight (fade)
[159.434229] Subtest fade: SKIP (0.000s)
[159.544865] [042/142] (879s left) kms_addfb_basic (invalid-set-prop-any)
[159.842041] Starting subtest: invalid-set-prop-any
[159.860913] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[160.066296] [043/142] (878s left) sw_sync (sync_busy)
[160.344438] Starting subtest: sync_busy
[160.363747] Subtest sync_busy: SUCCESS (0.007s)
[160.468462] [044/142] (878s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-pwrite)
[160.900004] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-pwrite
[162.906120] Subtest fbc-1p-primscrn-cur-indfb-draw-pwrite: SUCCESS (2.076s)
[163.101140] [045/142] (875s left) kms_prime (basic-modeset-hybrid)
[165.588628] Subtest basic-modeset-hybrid: SKIP (0.000s)
[165.723776] [046/142] (873s left) kms_ccs (pipe-d-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs_cc)
[166.481709] Subtest pipe-D-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs_cc: SKIP (0.000s)
[166.820133] [047/142] (872s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-plflip-blt)
[167.241981] Starting subtest: psr-2p-primscrn-shrfb-plflip-blt
[167.285717] Subtest psr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[167.396825] [048/142] (871s left) gem_exec_schedule (smoketest-all)
[167.869424] Starting subtest: smoketest-all
[200.093441] Subtest smoketest-all: SUCCESS (32.306s)
[200.402027] [049/142] (838s left) kms_plane_scaling (planes-upscale-20x20)
[200.755625] Starting subtest: planes-upscale-20x20
[200.775060] Starting dynamic subtest: pipe-A-DP-1
[200.819577] Dynamic subtest pipe-A-DP-1: SUCCESS (0.062s)
[200.858438] Starting dynamic subtest: pipe-B-DP-1
[201.206977] Dynamic subtest pipe-B-DP-1: SUCCESS (0.370s)
[201.257975] Starting dynamic subtest: pipe-C-DP-1
[201.330984] Dynamic subtest pipe-C-DP-1: SKIP (0.092s)
[201.352591] Subtest planes-upscale-20x20: SUCCESS (0.535s)
[201.728698] [050/142] (837s left) gem_exec_schedule (preempt-user)
[202.178829] Starting subtest: preempt-user
[202.200791] Starting dynamic subtest: rcs0
[202.222817] Dynamic subtest rcs0: SUCCESS (0.071s)
[202.266711] Starting dynamic subtest: bcs0
[202.288222] Dynamic subtest bcs0: SUCCESS (0.086s)
[202.326031] Starting dynamic subtest: vcs0
[202.344859] Dynamic subtest vcs0: SUCCESS (0.061s)
[202.382402] Starting dynamic subtest: vecs0
[202.401302] Dynamic subtest vecs0: SUCCESS (0.063s)
[202.422868] Subtest preempt-user: SUCCESS (0.286s)
[202.689545] [051/142] (836s left) kms_hdr (invalid-metadata-sizes)
[203.077281] Starting subtest: invalid-metadata-sizes
[203.118940] Subtest invalid-metadata-sizes: SKIP (0.000s)
[203.225502] [052/142] (836s left) kms_sequence (get-forked-busy)
[203.620854] Starting subtest: get-forked-busy
[203.642315] Starting dynamic subtest: DP-1-pipe-A
[206.090725] Dynamic subtest DP-1-pipe-A: SUCCESS (2.490s)
[206.142906] Starting dynamic subtest: DP-1-pipe-B
[208.874656] Dynamic subtest DP-1-pipe-B: SUCCESS (2.776s)
[208.922825] Starting dynamic subtest: DP-1-pipe-C
[211.809584] Dynamic subtest DP-1-pipe-C: SUCCESS (2.927s)
[211.832646] Subtest get-forked-busy: SUCCESS (8.202s)
[212.161304] [053/142] (827s left) gem_lmem_swapping (verify-random)
[212.487437] Subtest verify-random: SKIP (0.000s)
[212.599510] [054/142] (827s left) perf (unprivileged-single-ctx-counters)
[213.080654] Starting subtest: unprivileged-single-ctx-counters
[213.118030] Subtest unprivileged-single-ctx-counters: SKIP (0.000s)
[213.231496] [055/142] (826s left) syncobj_wait (multi-wait-for-submit-signaled)
[213.515429] Starting subtest: multi-wait-for-submit-signaled
[213.536811] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[213.630507] [056/142] (826s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-msflip-blt)
[214.043868] Starting subtest: fbcpsr-2p-scndscrn-indfb-msflip-blt
[214.086680] Subtest fbcpsr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[214.199486] [057/142] (825s left) v3d/v3d_submit_cl (valid-submission)
[214.549964] Subtest valid-submission: SKIP (0.000s)
[214.638626] [058/142] (825s left) gem_userptr_blits (stress-mm)
[215.024561] Starting subtest: stress-mm
[220.500087] Subtest stress-mm: SUCCESS (5.375s)
[220.588893] [059/142] (819s left) kms_setmode (basic-clone-single-crtc)
[220.890554] Starting subtest: basic-clone-single-crtc
[220.949561] Subtest basic-clone-single-crtc: SKIP (0.000s)
[221.045977] [060/142] (819s left) vc4/vc4_purgeable_bo (mark-unpurgeable-twice)
[221.384588] Subtest mark-unpurgeable-twice: SKIP (0.000s)
[221.472454] [061/142] (819s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[221.834771] Starting subtest: basic-flip-after-cursor-varying-size
[222.922819] Subtest basic-flip-after-cursor-varying-size: SUCCESS (1.072s)
[223.296325] [062/142] (817s left) kms_writeback (writeback-pixel-formats)
[223.774289] Subtest writeback-pixel-formats: SKIP (0.000s)
[223.884969] [063/142] (816s left) kms_vblank (pipe-c-query-forked-busy)
[224.294471] Starting subtest: pipe-C-query-forked-busy
[227.245604] Subtest pipe-C-query-forked-busy: SUCCESS (2.972s)
[227.640335] [064/142] (813s left) kms_ccs (pipe-a-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs_cc)
[228.202647] Starting subtest: pipe-A-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs_cc
[228.261994] Subtest pipe-A-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs_cc: SKIP (0.005s)
[228.754861] [065/142] (812s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[229.200479] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[229.239030] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[229.349757] [066/142] (811s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[229.789463] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[229.827927] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[229.943609] [067/142] (811s left) kms_flip (nonblocking-read)
[230.305164] Starting subtest: nonblocking-read
[230.323955] Subtest nonblocking-read: SUCCESS (0.000s)
[230.440001] [068/142] (810s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180)
[230.836898] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180
[232.167815] Subtest y-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.350s)
[232.352956] [069/142] (809s left) kms_lease (lease_unleased_connector)
[232.718227] Starting subtest: lease_unleased_connector
[232.739815] Starting dynamic subtest: pipe-A-DP-1
[232.901942] Dynamic subtest pipe-A-DP-1: SUCCESS (0.160s)
[232.944180] Starting dynamic subtest: pipe-B-DP-1
[233.054937] Dynamic subtest pipe-B-DP-1: SUCCESS (0.159s)
[233.098949] Starting dynamic subtest: pipe-C-DP-1
[233.223173] Dynamic subtest pipe-C-DP-1: SUCCESS (0.160s)
[233.242284] Subtest lease_unleased_connector: SUCCESS (0.491s)
[233.355560] [070/142] (808s left) api_intel_bb (blit-noreloc-purge-cache)
[233.651684] Starting subtest: blit-noreloc-purge-cache
[233.673676] Subtest blit-noreloc-purge-cache: SUCCESS (0.019s)
[233.805671] [071/142] (807s left) gem_exec_reloc (basic-concurrent16)
[234.106372] Starting subtest: basic-concurrent16
[239.863681] Subtest basic-concurrent16: SUCCESS (5.526s)
[239.975136] [072/142] (801s left) kms_rotation_crc (cursor-rotation-180)
[240.338148] Starting subtest: cursor-rotation-180
[241.140517] Subtest cursor-rotation-180: SUCCESS (0.804s)
[241.614590] [073/142] (800s left) gem_ringfill (legacy-basic)
[242.187279] Starting subtest: legacy-basic
[242.208051] Starting dynamic subtest: default
[242.228901] Dynamic subtest default: SUCCESS (0.022s)
[242.269940] Starting dynamic subtest: render
[242.288901] Dynamic subtest render: SUCCESS (0.022s)
[242.331900] Starting dynamic subtest: bsd
[242.350928] Dynamic subtest bsd: SUCCESS (0.028s)
[242.392856] Starting dynamic subtest: bsd1
[242.415086] Dynamic subtest bsd1: SUCCESS (0.026s)
[242.454766] Starting dynamic subtest: blt
[242.475549] Dynamic subtest blt: SUCCESS (0.029s)
[242.513628] Starting dynamic subtest: vebox
[242.532590] Dynamic subtest vebox: SUCCESS (0.022s)
[242.551267] Subtest legacy-basic: SUCCESS (0.162s)
[242.666183] [074/142] (799s left) kms_ccs (pipe-d-bad-pixel-format-y_tiled_gen12_mc_ccs)
[243.400763] Subtest pipe-D-bad-pixel-format-y_tiled_gen12_mc_ccs: SKIP (0.000s)
[243.750708] [075/142] (798s left) gem_exec_balancer (parallel-balancer)
[248.047653] Subtest parallel-balancer: SKIP (0.000s)
[248.136508] [076/142] (794s left) kms_flip (flip-vs-absolute-wf_vblank)
[248.498867] Starting subtest: flip-vs-absolute-wf_vblank
[248.520307] Starting dynamic subtest: A-DP1
[259.302715] Dynamic subtest A-DP1: SUCCESS (10.826s)
[259.345642] Starting dynamic subtest: B-DP1
[270.057497] Dynamic subtest B-DP1: SUCCESS (10.752s)
[270.100365] Starting dynamic subtest: C-DP1
[280.803458] Dynamic subtest C-DP1: SUCCESS (10.744s)
[280.825709] Subtest flip-vs-absolute-wf_vblank: SUCCESS (32.334s)
[281.272137] [077/142] (761s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render)
[281.684466] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render
[281.726889] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[281.840733] [078/142] (760s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[282.176652] Starting subtest: cursorA-vs-flipB-legacy
[282.214281] Subtest cursorA-vs-flipB-legacy: SKIP (0.002s)
[282.333731] [079/142] (760s left) syncobj_wait (invalid-multi-wait-all-unsubmitted)
[282.624851] Starting subtest: invalid-multi-wait-all-unsubmitted
[282.643839] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[282.784278] [080/142] (759s left) gem_ccs (block-copy-uncompressed)
[283.127588] Subtest block-copy-uncompressed: SKIP (0.000s)
[283.231121] [081/142] (759s left) syncobj_basic (bad-pad-handle-to-fd)
[283.520456] Starting subtest: bad-pad-handle-to-fd
[283.539365] Subtest bad-pad-handle-to-fd: SUCCESS (0.000s)
[283.636034] [082/142] (759s left) kms_cursor_legacy (single-move)
[283.995392] Starting subtest: single-move
[284.014852] Starting dynamic subtest: pipe-A
[289.591458] Dynamic subtest pipe-A: SUCCESS (5.407s)
[289.632010] Starting dynamic subtest: pipe-B
[294.995311] Dynamic subtest pipe-B: SUCCESS (5.404s)
[295.033661] Starting dynamic subtest: pipe-C
[300.402839] Dynamic subtest pipe-C: SUCCESS (5.405s)
[300.441028] Starting dynamic subtest: all-pipes
[305.808317] Dynamic subtest all-pipes: SUCCESS (5.407s)
[305.829919] Subtest single-move: SUCCESS (21.631s)
[305.925710] [083/142] (737s left) gem_ctx_persistence (engines-cleanup)
[306.221251] Starting subtest: engines-cleanup
[306.242662] Starting dynamic subtest: rcs0
[306.263739] Dynamic subtest rcs0: SUCCESS (0.038s)
[306.303430] Starting dynamic subtest: bcs0
[306.322510] Dynamic subtest bcs0: SUCCESS (0.038s)
[306.363227] Starting dynamic subtest: vcs0
[306.382003] Dynamic subtest vcs0: SUCCESS (0.033s)
[306.422768] Starting dynamic subtest: vecs0
[306.444259] Dynamic subtest vecs0: SUCCESS (0.034s)
[306.465663] Subtest engines-cleanup: SUCCESS (0.152s)
[306.557473] [084/142] (736s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-upscaling)
[306.923970] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-upscaling
[306.943588] Starting dynamic subtest: pipe-A-valid-mode
[307.039828] Dynamic subtest pipe-A-valid-mode: SKIP (0.087s)
[307.080470] Subtest flip-64bpp-yftile-to-16bpp-yftile-upscaling: SKIP (0.091s)
[307.382273] [085/142] (735s left) kms_fbcon_fbt (psr-suspend)
[307.677566] Starting subtest: psr-suspend
[307.717874] Subtest psr-suspend: SKIP (0.000s)
[307.832424] [086/142] (735s left) core_hotunplug (unbind-rebind)
[308.143940] Starting subtest: unbind-rebind
[309.960138] Subtest unbind-rebind: SUCCESS (1.816s)
[310.081142] [087/142] (733s left) kms_lease (empty_lease)
[310.471477] Starting subtest: empty_lease
[310.490363] Starting dynamic subtest: pipe-A-DP-1
[310.508980] Dynamic subtest pipe-A-DP-1: SUCCESS (0.001s)
[310.552340] Starting dynamic subtest: pipe-B-DP-1
[310.573640] Dynamic subtest pipe-B-DP-1: SUCCESS (0.001s)
[310.616797] Starting dynamic subtest: pipe-C-DP-1
[310.637400] Dynamic subtest pipe-C-DP-1: SUCCESS (0.001s)
[310.656283] Subtest empty_lease: SUCCESS (0.014s)
[310.768578] [088/142] (732s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-downscaling)
[311.133337] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-downscaling
[311.154834] Starting dynamic subtest: pipe-A-valid-mode
[311.859860] Dynamic subtest pipe-A-valid-mode: SKIP (0.701s)
[311.898187] Subtest flip-32bpp-xtile-to-64bpp-xtile-downscaling: SKIP (0.705s)
[312.296142] [089/142] (731s left) i915_suspend (basic-s2idle-without-i915)
[312.583166] Starting subtest: basic-s2idle-without-i915
[332.208833] Subtest basic-s2idle-without-i915: SUCCESS (19.628s)
[338.238968] [090/142] (711s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-move)
[338.686034] Starting subtest: fbc-2p-primscrn-spr-indfb-move
[338.729490] Subtest fbc-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[338.844615] [091/142] (710s left) kms_frontbuffer_tracking (psr-1p-rte)
[339.290788] Starting subtest: psr-1p-rte
[339.329396] Subtest psr-1p-rte: SKIP (0.000s)
[339.439125] [092/142] (710s left) gem_exec_reloc (basic-gtt-cpu-active)
[339.753004] Starting subtest: basic-gtt-cpu-active
[339.903434] Subtest basic-gtt-cpu-active: SUCCESS (0.156s)
[340.136046] [093/142] (709s left) sw_sync (alloc_timeline)
[340.404638] Starting subtest: alloc_timeline
[340.426425] Subtest alloc_timeline: SUCCESS (0.000s)
[340.519905] [094/142] (709s left) gem_tiled_pread_pwrite
[343.372831] [095/142] (706s left) syncobj_timeline (wait-all-complex)
[343.843425] Starting subtest: wait-all-complex
[344.067681] Subtest wait-all-complex: SUCCESS (0.218s)
[344.182585] [096/142] (705s left) gem_render_copy (mixed-tiled-to-yf-tiled-ccs)
[344.481218] Starting subtest: mixed-tiled-to-yf-tiled-ccs
[344.501686] Starting dynamic subtest: smem
[344.944933] Dynamic subtest smem: SUCCESS (0.480s)
[344.963932] Subtest mixed-tiled-to-yf-tiled-ccs: SUCCESS (0.483s)
[345.181719] [097/142] (704s left) gem_exec_params (secure-non-root)
[345.460084] Starting subtest: secure-non-root
[345.501184] Subtest secure-non-root: SKIP (0.000s)
[345.591261] [098/142] (704s left) kms_ccs (pipe-d-random-ccs-data-yf_tiled_ccs)
[346.444619] Subtest pipe-D-random-ccs-data-yf_tiled_ccs: SKIP (0.000s)
[346.760616] [099/142] (703s left) api_intel_allocator (alloc-simple)
[347.053771] Starting subtest: alloc-simple
[347.073961] Subtest alloc-simple: SUCCESS (0.006s)
[347.195110] [100/142] (703s left) kms_big_fb (x-tiled-64bpp-rotate-180)
[347.604414] Starting subtest: x-tiled-64bpp-rotate-180
[355.279152] Subtest x-tiled-64bpp-rotate-180: SUCCESS (7.689s)
[356.239432] [101/142] (694s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[356.659798] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip
[356.710116] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[356.852638] [102/142] (693s left) gem_exec_schedule (u-lateslice)
[357.323140] Starting subtest: u-lateslice
[357.344133] Starting dynamic subtest: rcs0
[357.364094] Dynamic subtest rcs0: SUCCESS (0.039s)
[357.403150] Starting dynamic subtest: bcs0
[357.422376] Dynamic subtest bcs0: SUCCESS (0.034s)
[357.462790] Starting dynamic subtest: vcs0
[357.482965] Dynamic subtest vcs0: SUCCESS (0.031s)
[357.524741] Starting dynamic subtest: vecs0
[357.546507] Dynamic subtest vecs0: SUCCESS (0.030s)
[357.567393] Subtest u-lateslice: SUCCESS (0.143s)
[357.729569] [103/142] (693s left) gem_exec_async (concurrent-writes)
[358.030298] Starting subtest: concurrent-writes
[358.050438] Starting dynamic subtest: rcs0
[358.072170] Dynamic subtest rcs0: SUCCESS (0.021s)
[358.118137] Starting dynamic subtest: bcs0
[358.138872] Dynamic subtest bcs0: SUCCESS (0.015s)
[358.180854] Starting dynamic subtest: vcs0
[358.199856] Dynamic subtest vcs0: SUCCESS (0.016s)
[358.241216] Starting dynamic subtest: vecs0
[358.260138] Dynamic subtest vecs0: SUCCESS (0.014s)
[358.279040] Subtest concurrent-writes: SUCCESS (0.077s)
[358.377622] [104/142] (692s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-wc)
[358.806803] Starting subtest: fbc-rgb101010-draw-mmap-wc
[361.515969] Subtest fbc-rgb101010-draw-mmap-wc: SUCCESS (2.655s)
[361.611062] [105/142] (689s left) kms_plane_alpha_blend (coverage-7efc)
[361.980284] Starting subtest: coverage-7efc
[362.290167] Starting dynamic subtest: pipe-A-DP-1
[362.769637] Dynamic subtest pipe-A-DP-1: SUCCESS (0.481s)
[362.881826] Starting dynamic subtest: pipe-C-DP-1
[363.654445] Dynamic subtest pipe-C-DP-1: SUCCESS (0.812s)
[363.676020] Subtest coverage-7efc: SUCCESS (1.675s)
[364.038478] [106/142] (687s left) gen7_exec_parse (basic-offset)
[364.356790] Subtest basic-offset: SKIP (0.000s)
[364.474492] [107/142] (686s left) kms_big_fb (x-tiled-16bpp-rotate-270)
[364.867678] Starting subtest: x-tiled-16bpp-rotate-270
[364.978428] Subtest x-tiled-16bpp-rotate-270: SKIP (0.083s)
[365.089825] [108/142] (686s left) v3d/v3d_submit_cl (bad-extension)
[365.447547] Subtest bad-extension: SKIP (0.000s)
[365.564045] [109/142] (685s left) kms_ccs (pipe-b-missing-ccs-buffer-4_tiled_mtl_rc_ccs_cc)
[366.156621] Starting subtest: pipe-B-missing-ccs-buffer-4_tiled_mtl_rc_ccs_cc
[366.194817] Subtest pipe-B-missing-ccs-buffer-4_tiled_mtl_rc_ccs_cc: SKIP (0.000s)
[366.667238] [110/142] (684s left) kms_psr (sprite_plane_move)
[366.988729] Subtest sprite_plane_move: SKIP (0.000s)
[367.101959] [111/142] (684s left) kms_ccs (pipe-a-bad-pixel-format-4_tiled_dg2_rc_ccs_cc)
[367.457255] Starting subtest: pipe-A-bad-pixel-format-4_tiled_dg2_rc_ccs_cc
[367.497356] Subtest pipe-A-bad-pixel-format-4_tiled_dg2_rc_ccs_cc: SKIP (0.000s)
[368.188717] [112/142] (683s left) vc4/vc4_wait_bo (used-bo)
[368.537019] Subtest used-bo: SKIP (0.000s)
[368.651161] [113/142] (683s left) kms_chamelium_edid (dp-edid-stress-resolution-4k)
[369.127886] Subtest dp-edid-stress-resolution-4k: SKIP (0.000s)
[369.451716] [114/142] (682s left) gen9_exec_parse (batch-invalid-length)
[369.759668] Starting subtest: batch-invalid-length
[369.781343] Subtest batch-invalid-length: SUCCESS (0.011s)
[370.038813] [115/142] (682s left) i915_pm_rpm (modeset-non-lpsp)
[371.894563] Starting subtest: modeset-non-lpsp
[372.523715] Subtest modeset-non-lpsp: SUCCESS (0.625s)
[372.754510] [116/142] (679s left) gem_mmap_wc (pf-nonblock)
[373.052744] Starting subtest: pf-nonblock
[373.071745] Subtest pf-nonblock: SUCCESS (0.005s)
[373.192127] [117/142] (679s left) v3d/v3d_create_bo (create-bo-zeroed)
[373.541404] Subtest create-bo-zeroed: SKIP (0.000s)
[373.651848] [118/142] (678s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-fullscreen)
[374.095316] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-fullscreen
[374.132570] Subtest fbcpsr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[374.251020] [119/142] (678s left) sw_sync (sync_multi_consumer_producer)
[374.523873] Starting subtest: sync_multi_consumer_producer
[375.506108] Subtest sync_multi_consumer_producer: SUCCESS (0.992s)
[375.619432] [120/142] (677s left) gem_exec_whisper (basic-sync)
[375.964116] Starting subtest: basic-sync
[384.254327] Subtest basic-sync: SUCCESS (8.333s)
[384.470362] [121/142] (668s left) kms_ccs (pipe-b-bad-rotation-90-y_tiled_gen12_mc_ccs)
[384.992900] Starting subtest: pipe-B-bad-rotation-90-y_tiled_gen12_mc_ccs
[385.035393] Subtest pipe-B-bad-rotation-90-y_tiled_gen12_mc_ccs: SKIP (0.000s)
[385.572679] [122/142] (667s left) kms_pipe_b_c_ivb (enable-pipe-c-while-b-has-3-lanes)
[385.899451] Subtest enable-pipe-C-while-B-has-3-lanes: SKIP (0.000s)
[386.014467] [123/142] (666s left) gem_mmap_gtt (big-copy)
[386.313165] Starting subtest: big-copy
[397.175142] Subtest big-copy: SUCCESS (10.890s)
[397.308472] [124/142] (655s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[397.915964] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[397.957989] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[398.078038] [125/142] (655s left) gem_pwrite (basic-exhaustion)
[398.359076] Starting subtest: basic-exhaustion
[419.681153] Subtest basic-exhaustion: SUCCESS (21.183s)
[419.779838] [126/142] (633s left) i915_pm_lpsp (kms-lpsp)
[421.166894] Starting subtest: kms-lpsp
[421.189263] Starting dynamic subtest: kms-lpsp-DP
[421.231162] Dynamic subtest kms-lpsp-DP: SKIP (0.000s)
[421.271075] Subtest kms-lpsp: SKIP (0.004s)
[421.388965] [127/142] (632s left) drm_fdinfo (busy-check-all)
[421.690446] Starting subtest: busy-check-all
[421.709690] Starting dynamic subtest: rcs0
[422.215798] Dynamic subtest rcs0: SUCCESS (0.533s)
[422.258936] Starting dynamic subtest: bcs0
[422.744056] Dynamic subtest bcs0: SUCCESS (0.531s)
[422.785573] Starting dynamic subtest: vcs0
[423.281332] Dynamic subtest vcs0: SUCCESS (0.534s)
[423.324907] Starting dynamic subtest: vecs0
[423.813002] Dynamic subtest vecs0: SUCCESS (0.531s)
[423.832096] Subtest busy-check-all: SUCCESS (2.140s)
[423.938093] [128/142] (629s left) syncobj_timeline (multi-wait-for-submit-available-signaled)
[424.268718] Starting subtest: multi-wait-for-submit-available-signaled
[424.290023] Subtest multi-wait-for-submit-available-signaled: SUCCESS (0.002s)
[424.385697] [129/142] (629s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-wc)
[424.790549] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-wc
[426.931388] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (2.204s)
[427.084023] [130/142] (626s left) gem_exec_whisper (basic-forked)
[427.426626] Starting subtest: basic-forked
[438.356338] Subtest basic-forked: SUCCESS (10.932s)
[438.534415] [131/142] (615s left) gem_ctx_freq (sysfs)
[438.817176] Starting subtest: sysfs
[438.836436] Starting dynamic subtest: gt0
[443.795409] Dynamic subtest gt0: SUCCESS (4.981s)
[443.816237] Subtest sysfs: SUCCESS (4.984s)
[443.918600] [132/142] (609s left) kms_content_protection (mei_interface)
[444.361393] Starting subtest: mei_interface
[445.103852] Subtest mei_interface: SKIP (0.713s)
[445.555383] [133/142] (608s left) kms_big_fb (yf-tiled-32bpp-rotate-0)
[445.961364] Starting subtest: yf-tiled-32bpp-rotate-0
[450.924411] Subtest yf-tiled-32bpp-rotate-0: SUCCESS (4.984s)
[451.488348] [134/142] (602s left) kms_psr (psr2_basic)
[451.804872] Subtest psr2_basic: SKIP (0.000s)
[451.896979] [135/142] (602s left) perf_pmu (interrupts)
[452.203168] Starting subtest: interrupts
[453.330587] Subtest interrupts: SUCCESS (1.155s)
[453.480945] [136/142] (600s left) kms_ccs (pipe-c-bad-rotation-90-4_tiled_mtl_rc_ccs)
[454.155552] Starting subtest: pipe-C-bad-rotation-90-4_tiled_mtl_rc_ccs
[454.194775] Subtest pipe-C-bad-rotation-90-4_tiled_mtl_rc_ccs: SKIP (0.000s)
[454.594757] [137/142] (599s left) gem_exec_reloc (basic-write-wc)
[454.896023] Starting subtest: basic-write-wc
[454.916482] Subtest basic-write-wc: SUCCESS (0.027s)
[455.129841] [138/142] (599s left) kms_ccs (pipe-a-crc-primary-rotation-180-y_tiled_gen12_rc_ccs)
[455.617217] Starting subtest: pipe-A-crc-primary-rotation-180-y_tiled_gen12_rc_ccs
[455.658064] Subtest pipe-A-crc-primary-rotation-180-y_tiled_gen12_rc_ccs: SKIP (0.001s)
[456.239376] [139/142] (598s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode)
[456.726131] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s)
[457.061954] [140/142] (597s left) kms_color (ctm-green-to-red)
[457.461999] Starting subtest: ctm-green-to-red
[457.481884] Starting dynamic subtest: pipe-A
[457.996768] Dynamic subtest pipe-A: SUCCESS (0.534s)
[458.070673] Starting dynamic subtest: pipe-B
[458.801902] Dynamic subtest pipe-B: SUCCESS (0.805s)
[458.879574] Starting dynamic subtest: pipe-C
[459.736989] Dynamic subtest pipe-C: SUCCESS (0.940s)
[459.758911] Subtest ctm-green-to-red: SUCCESS (2.288s)
[460.133474] [141/142] (594s left) gem_eio (context-create)
[460.469067] Starting subtest: context-create
[460.490344] Subtest context-create: SUCCESS (0.039s)
[460.730991] [142/142] (594s left) kms_fbcon_fbt (fbc-suspend)
[461.029486] Starting subtest: fbc-suspend
[510.437551] Subtest fbc-suspend: SUCCESS (17.248s)
[511.514746] Closing watchdogs
Done.