[21.901962] Initializing watchdogs
[21.902039]   /dev/watchdog0
[21.906314] [001/142] (960s left) gem_workarounds (suspend-resume-context)
[21.971404] Starting subtest: suspend-resume-context
[38.072622] Subtest suspend-resume-context: SUCCESS (1.178s)
[45.135488] [002/142] (959s left) kms_cursor_legacy (basic-busy-flip-before-cursor-varying-size)
[45.241323] Starting subtest: basic-busy-flip-before-cursor-varying-size
[45.242734] Subtest basic-busy-flip-before-cursor-varying-size: SKIP (0.000s)
[45.273065] [003/142] (959s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[45.373367] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-wc
[45.374749] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[45.414864] [004/142] (958s left) kms_color (ctm-0-75)
[45.510362] Starting subtest: ctm-0-75
[45.511087] Starting dynamic subtest: pipe-A
[46.482879] Dynamic subtest pipe-A: SUCCESS (0.973s)
[46.486627] Starting dynamic subtest: pipe-B
[47.708808] Dynamic subtest pipe-B: SUCCESS (1.226s)
[47.713191] Starting dynamic subtest: pipe-C
[48.620497] Dynamic subtest pipe-C: SUCCESS (0.911s)
[48.624199] Starting dynamic subtest: pipe-D
[49.531879] Dynamic subtest pipe-D: SUCCESS (0.911s)
[49.532768] Subtest ctm-0-75: SUCCESS (4.021s)
[49.640914] [005/142] (954s left) syncobj_timeline (multi-wait-all-available-signaled)
[49.691942] Starting subtest: multi-wait-all-available-signaled
[49.692739] Subtest multi-wait-all-available-signaled: SUCCESS (0.000s)
[49.729077] [006/142] (954s left) gem_userptr_blits (create-destroy-sync)
[49.785976] Starting subtest: create-destroy-sync
[54.803513] Subtest create-destroy-sync: SUCCESS (5.018s)
[54.879895] [007/142] (949s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[54.985611] Starting subtest: addfb25-y-tiled-legacy
[54.986379] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[55.040542] [008/142] (949s left) syncobj_timeline (etime-single-wait-for-submit-available-unsubmitted)
[55.087541] Starting subtest: etime-single-wait-for-submit-available-unsubmitted
[55.192008] Subtest etime-single-wait-for-submit-available-unsubmitted: SUCCESS (0.104s)
[55.230329] [009/142] (949s left) gem_userptr_blits (map-fixed-invalidate-overlap)
[55.296469] Starting subtest: map-fixed-invalidate-overlap
[55.297292] Starting dynamic subtest: gtt
[55.375172] Dynamic subtest gtt: SUCCESS (0.078s)
[55.379442] Starting dynamic subtest: wb
[55.436735] Dynamic subtest wb: SUCCESS (0.062s)
[55.440568] Starting dynamic subtest: wc
[55.498018] Dynamic subtest wc: SUCCESS (0.061s)
[55.502090] Starting dynamic subtest: uc
[55.559553] Dynamic subtest uc: SUCCESS (0.061s)
[55.560516] Subtest map-fixed-invalidate-overlap: SUCCESS (0.263s)
[55.637896] [010/142] (948s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[55.746882] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[56.020281] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SUCCESS (0.274s)
[56.111477] [011/142] (948s left) gem_exec_whisper (basic-contexts-all)
[56.169482] Starting subtest: basic-contexts-all
[58.775216] Subtest basic-contexts-all: SUCCESS (2.605s)
[58.924188] [012/142] (945s left) perf (low-oa-exponent-permissions)
[59.023895] Starting subtest: low-oa-exponent-permissions
[59.056855] Subtest low-oa-exponent-permissions: SUCCESS (0.033s)
[59.072763] [013/142] (945s left) kms_pwrite_crc
[59.526931] [014/142] (944s left) gem_exec_schedule (u-semaphore-user)
[59.583570] Starting subtest: u-semaphore-user
[59.590353] Subtest u-semaphore-user: SUCCESS (0.007s)
[59.850690] [015/142] (944s left) kms_frontbuffer_tracking (fbc-tiling-linear)
[59.953115] Starting subtest: fbc-tiling-linear
[60.972360] Subtest fbc-tiling-linear: SUCCESS (1.020s)
[61.055201] [016/142] (943s left) syncobj_wait (wait-all-for-submit-snapshot)
[61.108843] Starting subtest: wait-all-for-submit-snapshot
[61.191123] Subtest wait-all-for-submit-snapshot: SUCCESS (0.082s)
[61.231568] [017/142] (943s left) kms_plane_scaling (2x-scaler-multi-pipe)
[61.328437] Starting subtest: 2x-scaler-multi-pipe
[61.330929] Subtest 2x-scaler-multi-pipe: SKIP (0.002s)
[61.386197] [018/142] (943s left) gem_softpin (noreloc-interruptible)
[61.439468] Starting subtest: noreloc-interruptible
[66.828751] Subtest noreloc-interruptible: SUCCESS (5.388s)
[66.909044] [019/142] (937s left) syncobj_timeline (single-wait-for-submit-available-signaled)
[66.963458] Starting subtest: single-wait-for-submit-available-signaled
[66.964283] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.000s)
[67.009654] [020/142] (937s left) kms_ccs (pipe-b-crc-primary-basic-y_tiled_ccs)
[67.233506] Starting subtest: pipe-B-crc-primary-basic-y_tiled_ccs
[67.235011] Subtest pipe-B-crc-primary-basic-y_tiled_ccs: SKIP (0.000s)
[67.480385] [021/142] (937s left) gem_exec_fence (syncobj-backward-timeline-chain-engines)
[67.928432] Starting subtest: syncobj-backward-timeline-chain-engines
[67.979660] Subtest syncobj-backward-timeline-chain-engines: SUCCESS (0.058s)
[68.129020] [022/142] (936s left) i915_query (engine-info)
[68.179453] Starting subtest: engine-info
[68.180206] Subtest engine-info: SUCCESS (0.001s)
[68.213700] [023/142] (936s left) kms_ccs (pipe-b-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc)
[68.451915] Starting subtest: pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc
[68.452752] Subtest pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc: SUCCESS (0.000s)
[68.669708] [024/142] (935s left) i915_pm_rpm (gem-mmap-type)
[70.185203] Starting subtest: gem-mmap-type
[70.186570] Starting dynamic subtest: gtt-smem0
[72.193296] Dynamic subtest gtt-smem0: SUCCESS (2.008s)
[72.198960] Starting dynamic subtest: wb-smem0
[72.791259] Dynamic subtest wb-smem0: SUCCESS (0.597s)
[72.797311] Starting dynamic subtest: wc-smem0
[73.306852] Dynamic subtest wc-smem0: SUCCESS (0.515s)
[73.312922] Starting dynamic subtest: uc-smem0
[74.021116] Dynamic subtest uc-smem0: SUCCESS (0.713s)
[74.022628] Subtest gem-mmap-type: SUCCESS (3.838s)
[74.098477] [025/142] (930s left) drm_fdinfo (virtual-idle)
[74.148092] Starting subtest: virtual-idle
[76.663045] Subtest virtual-idle: SUCCESS (2.512s)
[76.698514] [026/142] (927s left) kms_mmap_write_crc (main)
[76.800249] Starting subtest: main
[76.801864] Starting dynamic subtest: pipe-A-HDMI-A-1
[78.162846] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.361s)
[78.163558] Subtest main: SUCCESS (1.363s)
[78.267395] [027/142] (926s left) kms_universal_plane (cursor-fb-leak-pipe-a)
[78.363711] Starting subtest: cursor-fb-leak-pipe-A
[78.564490] Subtest cursor-fb-leak-pipe-A: SUCCESS (0.201s)
[78.662866] [028/142] (926s left) kms_flip (flip-vs-blocking-wf-vblank)
[78.746856] Starting subtest: flip-vs-blocking-wf-vblank
[78.749110] Starting dynamic subtest: A-HDMI-A1
[86.570194] Dynamic subtest A-HDMI-A1: SUCCESS (7.821s)
[86.576736] Starting dynamic subtest: B-HDMI-A1
[94.372250] Dynamic subtest B-HDMI-A1: SUCCESS (7.801s)
[94.377121] Starting dynamic subtest: C-HDMI-A1
[102.163752] Dynamic subtest C-HDMI-A1: SUCCESS (7.791s)
[102.168534] Starting dynamic subtest: D-HDMI-A1
[109.953662] Dynamic subtest D-HDMI-A1: SUCCESS (7.789s)
[109.956076] Subtest flip-vs-blocking-wf-vblank: SUCCESS (31.211s)
[110.083871] [029/142] (894s left) kms_ccs (pipe-c-random-ccs-data-4_tiled_dg2_rc_ccs_cc)
[110.369274] Starting subtest: pipe-C-random-ccs-data-4_tiled_dg2_rc_ccs_cc
[110.371727] Subtest pipe-C-random-ccs-data-4_tiled_dg2_rc_ccs_cc: SKIP (0.000s)
[110.547224] [030/142] (894s left) kms_ccs (pipe-d-bad-rotation-90-y_tiled_gen12_rc_ccs_cc)
[110.880747] Starting subtest: pipe-D-bad-rotation-90-y_tiled_gen12_rc_ccs_cc
[110.954489] Subtest pipe-D-bad-rotation-90-y_tiled_gen12_rc_ccs_cc: SUCCESS (0.073s)
[111.121209] [031/142] (893s left) gem_bad_reloc (negative-reloc-lut)
[111.170837] Starting subtest: negative-reloc-lut
[111.172933] Subtest negative-reloc-lut: SUCCESS (0.000s)
[111.237358] [032/142] (893s left) i915_pm_rpm (basic-pci-d3-state)
[112.754880] Starting subtest: basic-pci-d3-state
[123.276711] Subtest basic-pci-d3-state: FAIL (10.500s)
[123.408300] [033/142] (881s left) kms_ccs (pipe-a-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs)
[123.599683] Starting subtest: pipe-A-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs
[123.602793] Subtest pipe-A-crc-sprite-planes-basic-4_tiled_mtl_rc_ccs: SKIP (0.002s)
[123.870457] [034/142] (880s left) kms_flip (2x-plain-flip-ts-check-interruptible)
[123.952852] Starting subtest: 2x-plain-flip-ts-check-interruptible
[123.965910] Subtest 2x-plain-flip-ts-check-interruptible: SKIP (0.012s)
[124.003997] [035/142] (880s left) gem_exec_params (no-vebox)
[124.052298] Starting subtest: no-vebox
[124.053051] Subtest no-vebox: SUCCESS (0.000s)
[124.112068] [036/142] (880s left) kms_vblank (pipe-a-ts-continuation-modeset-hang)
[124.206378] Starting subtest: pipe-A-ts-continuation-modeset-hang
[137.785649] Subtest pipe-A-ts-continuation-modeset-hang: SUCCESS (13.579s)
[137.890310] [037/142] (866s left) gem_busy (semaphore)
[138.054231] Starting subtest: semaphore
[138.055038] Starting dynamic subtest: rcs0
[138.082749] Dynamic subtest rcs0: SUCCESS (0.028s)
[138.090832] Starting dynamic subtest: bcs0
[138.105147] Dynamic subtest bcs0: SUCCESS (0.021s)
[138.115335] Starting dynamic subtest: vcs0
[138.123858] Dynamic subtest vcs0: SUCCESS (0.018s)
[138.133134] Starting dynamic subtest: vcs1
[138.143850] Dynamic subtest vcs1: SUCCESS (0.019s)
[138.152932] Starting dynamic subtest: vecs0
[138.163870] Dynamic subtest vecs0: SUCCESS (0.019s)
[138.164994] Subtest semaphore: SUCCESS (0.110s)
[138.348817] [038/142] (866s left) gem_flink_basic (double-flink)
[138.405774] Starting subtest: double-flink
[138.406569] Subtest double-flink: SUCCESS (0.000s)
[138.450813] [039/142] (866s left) gem_ppgtt (shrink-vs-evict-pinned)
[138.508672] Starting subtest: shrink-vs-evict-pinned
[143.585569] Subtest shrink-vs-evict-pinned: SUCCESS (5.076s)
[143.648384] [040/142] (861s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-move)
[143.756334] Starting subtest: fbc-2p-scndscrn-cur-indfb-move
[143.757789] Subtest fbc-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[143.799432] [041/142] (861s left) kms_color (ctm-signed)
[143.893736] Starting subtest: ctm-signed
[143.894526] Starting dynamic subtest: pipe-A
[144.406166] Dynamic subtest pipe-A: SUCCESS (0.512s)
[144.411241] Starting dynamic subtest: pipe-B
[144.924263] Dynamic subtest pipe-B: SUCCESS (0.517s)
[144.930432] Starting dynamic subtest: pipe-C
[145.422001] Dynamic subtest pipe-C: SUCCESS (0.497s)
[145.427108] Starting dynamic subtest: pipe-D
[145.891202] Dynamic subtest pipe-D: SUCCESS (0.468s)
[145.891933] Subtest ctm-signed: SUCCESS (1.997s)
[145.990922] [042/142] (858s left) kms_cursor_crc (cursor-rapid-movement-128x42)
[146.090724] Starting subtest: cursor-rapid-movement-128x42
[146.095238] Starting dynamic subtest: pipe-A-HDMI-A-1
[146.317201] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.222s)
[146.342767] Starting dynamic subtest: pipe-D-HDMI-A-1
[146.547354] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.208s)
[146.548134] Subtest cursor-rapid-movement-128x42: SUCCESS (0.457s)
[146.650579] [043/142] (858s left) v3d/v3d_submit_csd (valid-multisync-submission)
[146.719286] Subtest valid-multisync-submission: SKIP (0.000s)
[146.749733] [044/142] (858s left) kms_plane_alpha_blend (alpha-transparent-fb)
[146.844725] Starting subtest: alpha-transparent-fb
[146.907273] Starting dynamic subtest: pipe-A-HDMI-A-1
[147.175985] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.268s)
[147.182051] Starting dynamic subtest: pipe-D-HDMI-A-1
[147.479332] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.302s)
[147.480107] Subtest alpha-transparent-fb: SUCCESS (0.635s)
[147.587601] [045/142] (857s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted)
[147.633208] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted
[147.735446] Subtest etime-multi-wait-all-for-submit-unsubmitted: SUCCESS (0.102s)
[147.771472] [046/142] (857s left) kms_ccs (pipe-c-bad-rotation-90-y_tiled_gen12_mc_ccs)
[148.022409] Starting subtest: pipe-C-bad-rotation-90-y_tiled_gen12_mc_ccs
[148.023936] Subtest pipe-C-bad-rotation-90-y_tiled_gen12_mc_ccs: SKIP (0.000s)
[148.216579] [047/142] (856s left) kms_ccs (pipe-d-crc-primary-basic-y_tiled_ccs)
[148.535779] Starting subtest: pipe-D-crc-primary-basic-y_tiled_ccs
[148.537259] Subtest pipe-D-crc-primary-basic-y_tiled_ccs: SKIP (0.000s)
[148.660026] [048/142] (856s left) gem_spin_batch (user-each)
[148.714405] Starting subtest: user-each
[152.044950] Subtest user-each: SUCCESS (3.331s)
[152.196661] [049/142] (852s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[152.309139] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[152.310836] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[152.370682] [050/142] (852s left) kms_vblank (pipe-d-ts-continuation-modeset)
[152.469451] Starting subtest: pipe-D-ts-continuation-modeset
[152.828676] Subtest pipe-D-ts-continuation-modeset: SUCCESS (0.359s)
[152.915903] [051/142] (852s left) gem_ctx_persistence (engines-mixed-process)
[152.964796] Starting subtest: engines-mixed-process
[152.965505] Starting dynamic subtest: rcs0
[153.282816] Dynamic subtest rcs0: SUCCESS (0.317s)
[153.288066] Starting dynamic subtest: bcs0
[153.585728] Dynamic subtest bcs0: SUCCESS (0.302s)
[153.590930] Starting dynamic subtest: vcs0
[153.904855] Dynamic subtest vcs0: SUCCESS (0.318s)
[153.910143] Starting dynamic subtest: vcs1
[154.207880] Dynamic subtest vcs1: SUCCESS (0.302s)
[154.213131] Starting dynamic subtest: vecs0
[154.533913] Dynamic subtest vecs0: SUCCESS (0.325s)
[154.534780] Subtest engines-mixed-process: SUCCESS (1.569s)
[154.573628] [052/142] (850s left) kms_psr (psr2_primary_render)
[154.621274] Subtest psr2_primary_render: SKIP (0.000s)
[154.641538] [053/142] (850s left) i915_getparams_basic (basic-subslice-total)
[154.692228] Starting subtest: basic-subslice-total
[154.693599] Subtest basic-subslice-total: SUCCESS (0.000s)
[154.733963] [054/142] (850s left) gem_exec_schedule (preempt-engines)
[154.798060] Starting subtest: preempt-engines
[154.798828] Starting dynamic subtest: rcs0
[154.859246] Dynamic subtest rcs0: SUCCESS (0.061s)
[154.866297] Starting dynamic subtest: bcs0
[154.926868] Dynamic subtest bcs0: SUCCESS (0.066s)
[154.932670] Starting dynamic subtest: vcs0
[154.995690] Dynamic subtest vcs0: SUCCESS (0.068s)
[155.002649] Starting dynamic subtest: vcs1
[155.058641] Dynamic subtest vcs1: SUCCESS (0.062s)
[155.065671] Starting dynamic subtest: vecs0
[155.121686] Dynamic subtest vecs0: SUCCESS (0.062s)
[155.122561] Subtest preempt-engines: SUCCESS (0.324s)
[155.391935] [055/142] (849s left) gem_exec_balancer (full-late)
[155.449823] Starting subtest: full-late
[156.545584] Subtest full-late: SUCCESS (1.096s)
[156.774665] [056/142] (848s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-render)
[156.879072] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-render
[156.880492] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[156.925021] [057/142] (848s left) syncobj_basic (bad-fd-to-handle)
[156.972081] Starting subtest: bad-fd-to-handle
[156.972815] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[157.007945] [058/142] (848s left) gem_ctx_param (get-priority-new-ctx)
[157.061570] Starting subtest: get-priority-new-ctx
[157.062325] Subtest get-priority-new-ctx: SUCCESS (0.000s)
[157.100000] [059/142] (847s left) gem_exec_reloc (basic-cpu-gtt)
[157.156664] Starting subtest: basic-cpu-gtt
[157.162185] Subtest basic-cpu-gtt: SUCCESS (0.005s)
[157.251866] [060/142] (847s left) kms_ccs (pipe-b-random-ccs-data-4_tiled_dg2_rc_ccs_cc)
[157.468251] Starting subtest: pipe-B-random-ccs-data-4_tiled_dg2_rc_ccs_cc
[157.470321] Subtest pipe-B-random-ccs-data-4_tiled_dg2_rc_ccs_cc: SKIP (0.000s)
[157.702990] [061/142] (847s left) kms_ccs (pipe-b-bad-pixel-format-4_tiled_dg2_rc_ccs)
[157.892225] Starting subtest: pipe-B-bad-pixel-format-4_tiled_dg2_rc_ccs
[157.893618] Subtest pipe-B-bad-pixel-format-4_tiled_dg2_rc_ccs: SKIP (0.000s)
[158.168487] [062/142] (846s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling)
[158.267831] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling
[158.268600] Starting dynamic subtest: pipe-A-valid-mode
[159.171527] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.903s)
[159.172250] Subtest flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling: SUCCESS (0.904s)
[159.277364] [063/142] (845s left) kms_chamelium_edid (dp-edid-stress-resolution-4k)
[159.422091] Subtest dp-edid-stress-resolution-4k: SKIP (0.000s)
[159.481728] [064/142] (845s left) kms_big_fb (x-tiled-8bpp-rotate-90)
[159.581920] Starting subtest: x-tiled-8bpp-rotate-90
[159.635285] Subtest x-tiled-8bpp-rotate-90: SKIP (0.052s)
[159.703447] [065/142] (845s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-render)
[159.813365] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-render
[159.814745] Subtest fbcpsr-1p-offscren-pri-indfb-draw-render: SKIP (0.000s)
[159.870702] [066/142] (845s left) kms_ccs (pipe-c-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs)
[160.169802] Starting subtest: pipe-C-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs
[160.957558] Subtest pipe-C-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs: SUCCESS (0.788s)
[161.133606] [067/142] (844s left) kms_rotation_crc (bad-pixel-format)
[161.229502] Starting subtest: bad-pixel-format
[162.126950] Subtest bad-pixel-format: SUCCESS (0.898s)
[162.265751] [068/142] (842s left) kms_ccs (pipe-a-crc-primary-basic-y_tiled_gen12_rc_ccs)
[162.418147] Starting subtest: pipe-A-crc-primary-basic-y_tiled_gen12_rc_ccs
[162.620796] Subtest pipe-A-crc-primary-basic-y_tiled_gen12_rc_ccs: SUCCESS (0.203s)
[162.962384] [069/142] (842s left) kms_dsc (dsc-basic)
[163.068142] Starting subtest: dsc-basic
[163.069716] Subtest dsc-basic: SKIP (0.000s)
[163.104048] [070/142] (842s left) gem_eio (suspend)
[163.157419] Starting subtest: suspend
[173.952419] Subtest suspend: SUCCESS (10.795s)
[179.055352] [071/142] (831s left) gem_userptr_blits (map-fixed-invalidate-busy)
[179.116553] Starting subtest: map-fixed-invalidate-busy
[179.117357] Starting dynamic subtest: gtt
[180.488723] Dynamic subtest gtt: SUCCESS (1.371s)
[180.494087] Starting dynamic subtest: wb
[181.909126] Dynamic subtest wb: SUCCESS (1.420s)
[181.915657] Starting dynamic subtest: wc
[183.316313] Dynamic subtest wc: SUCCESS (1.406s)
[183.321627] Starting dynamic subtest: uc
[184.728273] Dynamic subtest uc: SUCCESS (1.411s)
[184.729180] Subtest map-fixed-invalidate-busy: SUCCESS (5.612s)
[184.808346] [072/142] (825s left) kms_rotation_crc (exhaust-fences)
[184.910621] Starting subtest: exhaust-fences
[186.036188] Subtest exhaust-fences: SUCCESS (1.126s)
[186.109596] [073/142] (824s left) gem_exec_reloc (basic-wc-cpu-noreloc)
[186.161774] Starting subtest: basic-wc-cpu-noreloc
[186.164897] Subtest basic-wc-cpu-noreloc: SUCCESS (0.003s)
[186.259082] [074/142] (824s left) gem_exec_schedule (smoketest-all)
[186.315330] Starting subtest: smoketest-all
[218.578251] Subtest smoketest-all: SUCCESS (32.257s)
[218.839748] [075/142] (791s left) v3d/v3d_perfmon (create-two-perfmon)
[218.917425] Subtest create-two-perfmon: SKIP (0.000s)
[218.951252] [076/142] (791s left) kms_ccs (pipe-a-bad-rotation-90-4_tiled_dg2_mc_ccs)
[219.108263] Starting subtest: pipe-A-bad-rotation-90-4_tiled_dg2_mc_ccs
[219.109906] Subtest pipe-A-bad-rotation-90-4_tiled_dg2_mc_ccs: SKIP (0.000s)
[219.415258] [077/142] (790s left) kms_ccs (pipe-c-ccs-on-another-bo-4_tiled_mtl_mc_ccs)
[219.702576] Starting subtest: pipe-C-ccs-on-another-bo-4_tiled_mtl_mc_ccs
[219.704124] Subtest pipe-C-ccs-on-another-bo-4_tiled_mtl_mc_ccs: SKIP (0.000s)
[219.862010] [078/142] (790s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-blt)
[219.961426] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-blt
[219.962876] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[220.020342] [079/142] (790s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-upscaling)
[220.117396] Starting subtest: flip-32bpp-linear-to-64bpp-linear-upscaling
[220.119259] Starting dynamic subtest: pipe-A-valid-mode
[220.973561] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.855s)
[220.974325] Subtest flip-32bpp-linear-to-64bpp-linear-upscaling: SUCCESS (0.857s)
[221.078830] [080/142] (789s left) gem_render_copy_redux (flink)
[221.135399] Starting subtest: flink
[222.138173] Subtest flink: SUCCESS (1.003s)
[222.204624] [081/142] (788s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-msflip-blt)
[222.313295] Starting subtest: psr-2p-primscrn-shrfb-msflip-blt
[222.314674] Subtest psr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[222.362648] [082/142] (788s left) gem_lmem_swapping (massive)
[222.411678] Subtest massive: SKIP (0.000s)
[222.429639] [083/142] (787s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-signaled)
[222.476201] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[222.476956] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[222.511714] [084/142] (787s left) gem_mmap_wc (read-write-distinct)
[222.558620] Starting subtest: read-write-distinct
[222.560460] Subtest read-write-distinct: SUCCESS (0.002s)
[222.617253] [085/142] (787s left) gem_reg_read (timestamp-moving)
[222.667425] Starting subtest: timestamp-moving
[223.668333] Subtest timestamp-moving: SUCCESS (1.001s)
[223.707188] [086/142] (786s left) kms_vblank (pipe-d-query-forked-busy)
[223.808353] Starting subtest: pipe-D-query-forked-busy
[225.171607] Subtest pipe-D-query-forked-busy: SUCCESS (1.362s)
[225.272499] [087/142] (785s left) kms_atomic_transition (plane-all-transition)
[225.380940] Starting subtest: plane-all-transition
[225.382816] Starting dynamic subtest: pipe-A-HDMI-A-1
[227.307744] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.926s)
[227.373729] Starting dynamic subtest: pipe-B-HDMI-A-1
[229.388165] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.019s)
[229.445896] Subtest plane-all-transition: SUCCESS (4.065s)
[229.529202] [088/142] (780s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-gtt)
[229.640193] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-gtt
[229.641549] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[229.687178] [089/142] (780s left) gem_exec_balancer (parallel-balancer)
[229.931731] Starting subtest: parallel-balancer
[230.828408] Subtest parallel-balancer: SUCCESS (0.902s)
[230.871241] [090/142] (779s left) gem_softpin (allocator-evict)
[230.922405] Starting subtest: allocator-evict
[230.923258] Starting dynamic subtest: rcs0
[254.252458] Dynamic subtest rcs0: SUCCESS (23.330s)
[254.258509] Starting dynamic subtest: bcs0
[276.803861] Dynamic subtest bcs0: SUCCESS (22.551s)
[276.811248] Starting dynamic subtest: vcs0
[299.497532] Dynamic subtest vcs0: SUCCESS (22.693s)
[299.504575] Starting dynamic subtest: vcs1
[322.096501] Dynamic subtest vcs1: SUCCESS (22.591s)
[322.103937] Starting dynamic subtest: vecs0
[344.896641] Dynamic subtest vecs0: SUCCESS (22.806s)
[344.897453] Subtest allocator-evict: SUCCESS (113.975s)
[344.941024] [091/142] (665s left) gem_exec_fair (basic-flow)
[345.040966] Starting subtest: basic-flow
[345.041838] Starting dynamic subtest: rcs0
[352.045815] Dynamic subtest rcs0: SUCCESS (7.004s)
[352.046614] Subtest basic-flow: SUCCESS (7.005s)
[352.199248] [092/142] (658s left) vgem_basic (bad-pad)
[352.258699] Starting subtest: bad-pad
[352.259626] Subtest bad-pad: SUCCESS (0.000s)
[352.298359] [093/142] (658s left) gem_mmap_gtt (bad-object)
[352.350165] Starting subtest: bad-object
[352.350958] Subtest bad-object: SUCCESS (0.000s)
[352.413860] [094/142] (658s left) kms_atomic_interruptible (universal-setplane-primary)
[352.525136] Starting subtest: universal-setplane-primary
[352.527319] Starting dynamic subtest: HDMI-A-1-pipe-A
[358.744034] Dynamic subtest HDMI-A-1-pipe-A: SUCCESS (6.216s)
[358.744868] Subtest universal-setplane-primary: SUCCESS (6.219s)
[358.836346] [095/142] (651s left) api_intel_allocator (simple-allocator)
[358.883758] Starting subtest: simple-allocator
[358.884478] Starting dynamic subtest: basic
[358.885188] Dynamic subtest basic: SUCCESS (0.002s)
[358.893816] Starting dynamic subtest: parallel-one
[358.953166] Dynamic subtest parallel-one: SUCCESS (0.067s)
[358.958947] Starting dynamic subtest: print
[358.959653] Dynamic subtest print: SUCCESS (0.000s)
[358.965409] Starting dynamic subtest: reuse
[358.966116] Dynamic subtest reuse: SUCCESS (0.000s)
[358.972425] Starting dynamic subtest: reserve
[358.973152] Dynamic subtest reserve: SUCCESS (0.000s)
[358.978675] Starting dynamic subtest: fork-reopen-allocator
[358.979395] Dynamic subtest fork-reopen-allocator: SUCCESS (0.012s)
[358.980094] Subtest simple-allocator: SUCCESS (0.085s)
[359.010770] [096/142] (651s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-plflip-blt)
[359.113987] Starting subtest: psr-2p-primscrn-indfb-plflip-blt
[359.115418] Subtest psr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[359.177330] [097/142] (651s left) gen7_exec_parse (basic-allocation)
[359.229295] Subtest basic-allocation: SKIP (0.000s)
[359.253477] [098/142] (651s left) gem_exec_parallel (engines)
[359.305864] Starting subtest: engines
[359.306651] Starting dynamic subtest: basic
[360.715928] Dynamic subtest basic: SUCCESS (1.410s)
[360.721691] Starting dynamic subtest: contexts
[363.628019] Dynamic subtest contexts: SUCCESS (2.911s)
[363.634015] Starting dynamic subtest: fds
[366.347793] Dynamic subtest fds: SUCCESS (2.719s)
[366.361230] Starting dynamic subtest: userptr
[367.888538] Dynamic subtest userptr: SUCCESS (1.540s)
[367.889383] Subtest engines: SUCCESS (8.583s)
[368.054165] [099/142] (642s left) kms_big_fb (linear-64bpp-rotate-270)
[368.164467] Starting subtest: linear-64bpp-rotate-270
[368.196238] Subtest linear-64bpp-rotate-270: SKIP (0.031s)
[368.270353] [100/142] (642s left) kms_pipe_b_c_ivb (pipe-b-dpms-off-modeset-pipe-c)
[368.317618] Subtest pipe-B-dpms-off-modeset-pipe-C: SKIP (0.000s)
[368.338685] [101/142] (642s left) gem_ctx_persistence (smoketest)
[368.388820] Starting subtest: smoketest
[399.176084] Subtest smoketest: SUCCESS (30.787s)
[399.223020] [102/142] (611s left) kms_plane (plane-panning-top-left)
[399.329109] Starting subtest: plane-panning-top-left
[399.330886] Starting dynamic subtest: pipe-A-planes
[399.662866] Dynamic subtest pipe-A-planes: SUCCESS (0.332s)
[399.669784] Starting dynamic subtest: pipe-B-planes
[399.972132] Dynamic subtest pipe-B-planes: SUCCESS (0.308s)
[399.972991] Subtest plane-panning-top-left: SUCCESS (0.644s)
[400.071848] [103/142] (610s left) kms_chamelium_hpd (dp-hpd)
[400.215087] Subtest dp-hpd: SKIP (0.000s)
[400.272851] [104/142] (610s left) gem_pxp (regular-baseline-src-copy-readible)
[402.836041] Subtest regular-baseline-src-copy-readible: SKIP (0.000s)
[402.873057] [105/142] (607s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180)
[402.974557] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180
[402.976154] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s)
[403.036395] [106/142] (607s left) perf_pmu (busy-hang)
[403.084236] Starting subtest: busy-hang
[403.084969] Starting dynamic subtest: rcs0
[404.126310] Dynamic subtest rcs0: SUCCESS (1.041s)
[404.135316] Starting dynamic subtest: bcs0
[405.160241] Dynamic subtest bcs0: SUCCESS (1.032s)
[405.169332] Starting dynamic subtest: vcs0
[406.198273] Dynamic subtest vcs0: SUCCESS (1.037s)
[406.207216] Starting dynamic subtest: vcs1
[407.231199] Dynamic subtest vcs1: SUCCESS (1.032s)
[407.240370] Starting dynamic subtest: vecs0
[408.265226] Dynamic subtest vecs0: SUCCESS (1.033s)
[408.266654] Subtest busy-hang: SUCCESS (5.181s)
[408.309496] [107/142] (602s left) perf_pmu (invalid-open)
[408.360490] Starting subtest: invalid-open
[408.361334] Subtest invalid-open: SUCCESS (0.000s)
[408.399272] [108/142] (602s left) kms_frontbuffer_tracking (fbc-suspend)
[408.505215] Starting subtest: fbc-suspend
[443.275655] Subtest fbc-suspend: SUCCESS (5.012s)
[445.403529] [109/142] (597s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[445.513034] Starting subtest: y-tiled-32bpp-rotate-180
[446.543660] Subtest y-tiled-32bpp-rotate-180: SUCCESS (1.032s)
[446.669152] [110/142] (595s left) kms_ccs (pipe-d-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs_cc)
[447.039356] Starting subtest: pipe-D-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs_cc
[447.839785] Subtest pipe-D-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs_cc: SUCCESS (0.800s)
[447.978691] [111/142] (594s left) syncobj_wait (reset-during-wait-for-submit)
[448.027524] Starting subtest: reset-during-wait-for-submit
[448.128383] Subtest reset-during-wait-for-submit: SUCCESS (0.101s)
[448.170557] [112/142] (594s left) api_intel_bb (reset-flags)
[448.217642] Starting subtest: reset-flags
[448.221817] Subtest reset-flags: SUCCESS (0.005s)
[448.295069] [113/142] (594s left) gem_mmap_gtt (basic-small-bo-tiledx)
[448.341010] Starting subtest: basic-small-bo-tiledX
[448.475572] Subtest basic-small-bo-tiledX: SUCCESS (0.135s)
[448.557294] [114/142] (594s left) kms_cursor_legacy (cursorb-vs-flipa-atomic)
[448.689856] Starting subtest: cursorB-vs-flipA-atomic
[448.692453] Subtest cursorB-vs-flipA-atomic: SKIP (0.003s)
[448.729321] [115/142] (593s left) kms_prime (basic-crc-vgem)
[449.373282] Starting subtest: basic-crc-vgem
[449.374006] Starting dynamic subtest: second-to-first
[449.955243] Dynamic subtest second-to-first: SUCCESS (0.583s)
[449.956125] Subtest basic-crc-vgem: SUCCESS (0.584s)
[450.013420] [116/142] (592s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-wc)
[450.120277] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-wc
[450.121659] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[450.178724] [117/142] (592s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-wc)
[450.277653] Starting subtest: psr-rgb565-draw-mmap-wc
[450.279167] Subtest psr-rgb565-draw-mmap-wc: SKIP (0.000s)
[450.329127] [118/142] (592s left) gem_render_copy (yf-tiled-to-vebox-linear)
[450.380426] Starting subtest: yf-tiled-to-vebox-linear
[450.381179] Starting dynamic subtest: smem
[450.443636] Dynamic subtest smem: SUCCESS (0.062s)
[450.444564] Subtest yf-tiled-to-vebox-linear: SUCCESS (0.063s)
[450.598300] [119/142] (592s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-render)
[450.704157] Starting subtest: fbcpsr-rgb565-draw-render
[450.705543] Subtest fbcpsr-rgb565-draw-render: SKIP (0.000s)
[450.760237] [120/142] (591s left) syncobj_timeline (wait-for-submit-delayed-submit)
[450.806374] Starting subtest: wait-for-submit-delayed-submit
[450.908690] Subtest wait-for-submit-delayed-submit: SUCCESS (0.102s)
[450.956999] [121/142] (591s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-20x20)
[451.057039] Starting subtest: planes-downscale-factor-0-5-upscale-20x20
[451.059405] Starting dynamic subtest: pipe-A-HDMI-A-1
[451.171978] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.114s)
[451.180630] Starting dynamic subtest: pipe-B-HDMI-A-1
[451.280798] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.107s)
[451.288025] Starting dynamic subtest: pipe-C-HDMI-A-1
[451.396951] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.114s)
[451.405996] Starting dynamic subtest: pipe-D-HDMI-A-1
[451.514000] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.115s)
[451.514891] Subtest planes-downscale-factor-0-5-upscale-20x20: SUCCESS (0.457s)
[451.637829] [122/142] (591s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted)
[451.685149] Starting subtest: invalid-multi-wait-unsubmitted-submitted
[451.685983] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s)
[451.720892] [123/142] (591s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc)
[451.820510] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc
[451.822025] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[451.879359] [124/142] (590s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-msflip-blt)
[451.979556] Starting subtest: fbcpsr-2p-scndscrn-shrfb-msflip-blt
[451.980935] Subtest fbcpsr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[452.038036] [125/142] (590s left) kms_invalid_mode (bad-vtotal)
[452.135643] Starting subtest: bad-vtotal
[452.136399] Starting dynamic subtest: HDMI-A-1-pipe-A
[452.191642] Dynamic subtest HDMI-A-1-pipe-A: SUCCESS (0.056s)
[452.198721] Starting dynamic subtest: HDMI-A-1-pipe-B
[452.210482] Dynamic subtest HDMI-A-1-pipe-B: SUCCESS (0.016s)
[452.217269] Starting dynamic subtest: HDMI-A-1-pipe-C
[452.218009] Dynamic subtest HDMI-A-1-pipe-C: SUCCESS (0.002s)
[452.224319] Starting dynamic subtest: HDMI-A-1-pipe-D
[452.225129] Dynamic subtest HDMI-A-1-pipe-D: SUCCESS (0.001s)
[452.225957] Subtest bad-vtotal: SUCCESS (0.082s)
[452.317536] [126/142] (590s left) api_intel_allocator (fork-simple-once)
[452.364485] Starting subtest: fork-simple-once
[452.377541] Subtest fork-simple-once: SUCCESS (0.014s)
[452.450548] [127/142] (590s left) gem_ctx_param (root-set)
[452.497764] Starting subtest: root-set
[452.498493] Subtest root-set: SUCCESS (0.000s)
[452.533761] [128/142] (590s left) gem_userptr_blits (dmabuf-unsync)
[452.584038] Subtest dmabuf-unsync: SKIP (0.000s)
[452.667142] [129/142] (590s left) kms_atomic_transition (modeset-transition-nonblocking)
[452.761339] Starting subtest: modeset-transition-nonblocking
[452.762147] Starting dynamic subtest: 1x-outputs
[456.000417] Dynamic subtest 1x-outputs: SUCCESS (3.239s)
[456.041946] Subtest modeset-transition-nonblocking: SUCCESS (3.280s)
[456.137346] [130/142] (586s left) v3d/v3d_submit_csd (bad-bo)
[456.205499] Subtest bad-bo: SKIP (0.000s)
[456.236258] [131/142] (586s left) kms_atomic_interruptible (universal-setplane-cursor)
[456.333139] Starting subtest: universal-setplane-cursor
[456.335022] Starting dynamic subtest: HDMI-A-1-pipe-A
[462.548142] Dynamic subtest HDMI-A-1-pipe-A: SUCCESS (6.213s)
[462.548914] Subtest universal-setplane-cursor: SUCCESS (6.215s)
[462.657236] [132/142] (580s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[462.760313] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[463.000078] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.240s)
[463.082715] [133/142] (579s left) kms_psr (psr2_no_drrs)
[463.129357] Subtest psr2_no_drrs: SKIP (0.000s)
[463.149499] [134/142] (579s left) vc4/vc4_perfmon (create-perfmon-0)
[463.218000] Subtest create-perfmon-0: SKIP (0.000s)
[463.248766] [135/142] (579s left) gem_ctx_param (invalid-get-no-zeromap)
[463.297877] Starting subtest: invalid-get-no-zeromap
[463.298635] Subtest invalid-get-no-zeromap: SUCCESS (0.000s)
[463.331890] [136/142] (579s left) kms_flip (2x-flip-vs-wf_vblank-interruptible)
[463.416258] Starting subtest: 2x-flip-vs-wf_vblank-interruptible
[463.429536] Subtest 2x-flip-vs-wf_vblank-interruptible: SKIP (0.012s)
[463.474015] [137/142] (579s left) kms_cursor_crc (cursor-onscreen-max-size)
[463.576342] Starting subtest: cursor-onscreen-max-size
[463.578534] Subtest cursor-onscreen-max-size: SKIP (0.000s)
[463.624223] [138/142] (579s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc)
[463.723410] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc
[463.724998] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[463.782726] [139/142] (579s left) gem_basic (create-fd-close)
[463.830199] Starting subtest: create-fd-close
[463.831642] Subtest create-fd-close: SUCCESS (0.000s)
[463.886870] [140/142] (579s left) kms_big_fb (yf-tiled-64bpp-rotate-90)
[463.996444] Starting subtest: yf-tiled-64bpp-rotate-90
[463.997856] Subtest yf-tiled-64bpp-rotate-90: SKIP (0.000s)
[464.048571] [141/142] (578s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[464.148231] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt
[464.149700] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[464.200962] [142/142] (578s left) i915_pm_backlight (fade)
[464.299671] Subtest fade: SKIP (0.000s)
[464.315397] Closing watchdogs
Done.