[47.139850] Initializing watchdogs
[47.140202]   /dev/watchdog0
[47.156755] [001/142] (960s left) kms_psr (dpms)
[47.342688] Subtest dpms: SKIP (0.000s)
[47.411412] [002/142] (960s left) syncobj_timeline (device-signal-unordered)
[47.603291] Starting subtest: device-signal-unordered
[47.608344] Subtest device-signal-unordered: SUCCESS (0.004s)
[47.686762] [003/142] (960s left) kms_ccs (pipe-a-random-ccs-data-4_tiled_dg2_mc_ccs)
[48.248932] Starting subtest: pipe-A-random-ccs-data-4_tiled_dg2_mc_ccs
[48.255806] Subtest pipe-A-random-ccs-data-4_tiled_dg2_mc_ccs: SKIP (0.000s)
[48.712831] [004/142] (959s left) kms_ccs (pipe-c-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs)
[49.202231] Starting subtest: pipe-C-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs
[49.205617] Subtest pipe-C-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs: SKIP (0.004s)
[49.523934] [005/142] (958s left) kms_frontbuffer_tracking (fbc-2p-rte)
[49.776946] Starting subtest: fbc-2p-rte
[49.779680] Subtest fbc-2p-rte: SKIP (0.000s)
[49.873647] [006/142] (957s left) kms_cursor_crc (cursor-onscreen-128x42)
[50.122157] Starting subtest: cursor-onscreen-128x42
[50.132979] Starting dynamic subtest: pipe-A-DP-1
[52.656779] Dynamic subtest pipe-A-DP-1: SUCCESS (2.520s)
[52.734566] Starting dynamic subtest: pipe-C-DP-1
[55.172528] Dynamic subtest pipe-C-DP-1: SUCCESS (2.449s)
[55.173822] Subtest cursor-onscreen-128x42: SUCCESS (5.050s)
[55.530177] [007/142] (952s left) kms_pipe_crc_basic (suspend-read-crc)
[55.766394] Starting subtest: suspend-read-crc
[55.769198] Starting dynamic subtest: pipe-A-DP-1
[73.380651] Dynamic subtest pipe-A-DP-1: SUCCESS (2.265s)
[73.399022] Starting dynamic subtest: pipe-B-DP-1
[91.372652] Dynamic subtest pipe-B-DP-1: SUCCESS (2.470s)
[91.391195] Starting dynamic subtest: pipe-C-DP-1
[109.369146] Dynamic subtest pipe-C-DP-1: SUCCESS (2.477s)
[109.370550] Subtest suspend-read-crc: SUCCESS (7.222s)
[113.798418] [008/142] (944s left) syncobj_wait (multi-wait-submitted)
[113.950080] Starting subtest: multi-wait-submitted
[114.057596] Subtest multi-wait-submitted: SUCCESS (0.106s)
[114.140951] [009/142] (944s left) gen7_exec_parse (basic-rejected)
[114.301822] Subtest basic-rejected: SKIP (0.000s)
[114.370943] [010/142] (944s left) sysfs_heartbeat_interval (invalid)
[114.514788] Starting subtest: invalid
[114.516435] Starting dynamic subtest: vecs0
[114.517961] Dynamic subtest vecs0: SUCCESS (0.001s)
[114.534344] Starting dynamic subtest: vcs0
[114.537974] Dynamic subtest vcs0: SUCCESS (0.001s)
[114.553266] Starting dynamic subtest: bcs0
[114.555514] Dynamic subtest bcs0: SUCCESS (0.001s)
[114.571440] Starting dynamic subtest: rcs0
[114.572811] Dynamic subtest rcs0: SUCCESS (0.001s)
[114.574115] Subtest invalid: SUCCESS (0.006s)
[114.605599] [011/142] (943s left) gen9_exec_parse (valid-registers)
[114.776193] Starting subtest: valid-registers
[114.973075] Subtest valid-registers: SUCCESS (0.197s)
[115.190481] [012/142] (943s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[115.331621] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[115.333306] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.001s)
[115.409526] [013/142] (943s left) fbdev (pan)
[115.545703] Starting subtest: pan
[115.589178] Subtest pan: SUCCESS (0.043s)
[115.675157] [014/142] (942s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-downscaling)
[115.915449] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-downscaling
[115.917018] Starting dynamic subtest: pipe-A-valid-mode
[116.612379] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.698s)
[116.613768] Subtest flip-64bpp-xtile-to-32bpp-xtile-downscaling: SUCCESS (0.700s)
[116.952316] [015/142] (941s left) gem_ctx_isolation (dirty-create)
[117.117744] Starting subtest: dirty-create
[117.119357] Starting dynamic subtest: rcs0
[118.896578] Dynamic subtest rcs0: SUCCESS (1.775s)
[118.917847] Starting dynamic subtest: bcs0
[121.094969] Dynamic subtest bcs0: SUCCESS (2.197s)
[121.113251] Starting dynamic subtest: vcs0
[122.750167] Dynamic subtest vcs0: SUCCESS (1.656s)
[122.768193] Starting dynamic subtest: vecs0
[124.408067] Dynamic subtest vecs0: SUCCESS (1.659s)
[124.409357] Subtest dirty-create: SUCCESS (7.289s)
[124.603243] [016/142] (933s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-render)
[124.855963] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-render
[124.858522] Subtest fbc-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[124.952070] [017/142] (933s left) gem_userptr_blits (readonly-unsync)
[125.105513] Subtest readonly-unsync: SKIP (0.000s)
[125.269599] [018/142] (933s left) gem_mmap_gtt (basic-small-copy-odd)
[125.412849] Starting subtest: basic-small-copy-odd
[129.340031] Subtest basic-small-copy-odd: SUCCESS (3.928s)
[129.425266] [019/142] (929s left) gem_flink_race (flink_name)
[129.680450] Starting subtest: flink_name
[135.058017] Subtest flink_name: SUCCESS (5.375s)
[135.153578] [020/142] (923s left) gem_mmap_wc (fault-concurrent)
[135.290849] Starting subtest: fault-concurrent
[137.001956] Subtest fault-concurrent: SUCCESS (1.710s)
[137.086638] [021/142] (921s left) kms_ccs (pipe-c-bad-aux-stride-y_tiled_ccs)
[137.550578] Starting subtest: pipe-C-bad-aux-stride-y_tiled_ccs
[137.553217] Subtest pipe-C-bad-aux-stride-y_tiled_ccs: SKIP (0.000s)
[137.880034] [022/142] (920s left) kms_cursor_edge_walk (64x64-right-edge)
[138.114292] Starting subtest: 64x64-right-edge
[138.115641] Starting dynamic subtest: pipe-A-DP-1
[141.942318] Dynamic subtest pipe-A-DP-1: SUCCESS (3.827s)
[141.962464] Starting dynamic subtest: pipe-C-DP-1
[145.404422] Dynamic subtest pipe-C-DP-1: SUCCESS (3.459s)
[145.405667] Subtest 64x64-right-edge: SUCCESS (7.292s)
[145.719208] [023/142] (913s left) gem_fence_thrash (bo-write-verify-x)
[145.856610] Starting subtest: bo-write-verify-x
[147.048907] Subtest bo-write-verify-x: SUCCESS (1.192s)
[147.134476] [024/142] (911s left) kms_invalid_mode (bad-vtotal)
[147.376968] Starting subtest: bad-vtotal
[147.379047] Starting dynamic subtest: DP-1-pipe-A
[147.459485] Dynamic subtest DP-1-pipe-A: SUCCESS (0.084s)
[147.479920] Starting dynamic subtest: DP-1-pipe-B
[147.481753] Dynamic subtest DP-1-pipe-B: SUCCESS (0.002s)
[147.511250] Starting dynamic subtest: DP-1-pipe-C
[147.513176] Dynamic subtest DP-1-pipe-C: SUCCESS (0.002s)
[147.515151] Subtest bad-vtotal: SUCCESS (0.095s)
[147.792515] [025/142] (911s left) gem_readwrite (read-bad-handle)
[147.934791] Starting subtest: read-bad-handle
[147.937376] Subtest read-bad-handle: SUCCESS (0.000s)
[148.041351] [026/142] (910s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-plflip-blt)
[148.293768] Starting subtest: fbc-2p-scndscrn-shrfb-plflip-blt
[148.296440] Subtest fbc-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[148.391622] [027/142] (910s left) kms_ccs (pipe-d-crc-primary-rotation-180-4_tiled_dg2_mc_ccs)
[148.859547] Subtest pipe-D-crc-primary-rotation-180-4_tiled_dg2_mc_ccs: SKIP (0.000s)
[149.163056] [028/142] (909s left) gem_media_fill (media-fill)
[149.322782] Starting subtest: media-fill
[149.324375] Starting dynamic subtest: smem
[149.334319] Dynamic subtest smem: SUCCESS (0.011s)
[149.336212] Subtest media-fill: SUCCESS (0.012s)
[149.561082] [029/142] (909s left) v3d/v3d_get_bo_offset (create-get-offsets)
[149.775694] Subtest create-get-offsets: SKIP (0.000s)
[149.845170] [030/142] (909s left) kms_ccs (pipe-d-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs)
[150.313646] Subtest pipe-D-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs: SKIP (0.000s)
[150.632719] [031/142] (908s left) gem_exec_params (invalid-ring2)
[150.785137] Starting subtest: invalid-ring2
[150.786539] Subtest invalid-ring2: SUCCESS (0.001s)
[150.883676] [032/142] (908s left) kms_atomic (crtc-invalid-params)
[151.240178] Starting subtest: crtc-invalid-params
[151.296896] Subtest crtc-invalid-params: SUCCESS (0.057s)
[151.732603] [033/142] (907s left) gem_mmap_gtt (medium-copy-xy)
[151.874514] Starting subtest: medium-copy-XY
[158.078936] Subtest medium-copy-XY: SUCCESS (6.203s)
[158.198739] [034/142] (901s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[158.570297] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[158.573005] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[158.661725] [035/142] (900s left) kms_plane_scaling (planes-downscale-factor-0-25)
[158.904209] Starting subtest: planes-downscale-factor-0-25
[158.905693] Starting dynamic subtest: pipe-A-DP-1
[158.935447] Dynamic subtest pipe-A-DP-1: SKIP (0.029s)
[158.965622] Starting dynamic subtest: pipe-B-DP-1
[159.021569] Dynamic subtest pipe-B-DP-1: SKIP (0.083s)
[159.044425] Starting dynamic subtest: pipe-C-DP-1
[159.121487] Dynamic subtest pipe-C-DP-1: SKIP (0.095s)
[159.124454] Subtest planes-downscale-factor-0-25: SKIP (0.217s)
[159.213379] [036/142] (900s left) kms_cursor_crc (cursor-rapid-movement-128x128)
[159.460293] Starting subtest: cursor-rapid-movement-128x128
[159.471240] Starting dynamic subtest: pipe-A-DP-1
[160.157241] Dynamic subtest pipe-A-DP-1: SUCCESS (0.681s)
[160.235888] Starting dynamic subtest: pipe-C-DP-1
[160.826521] Dynamic subtest pipe-C-DP-1: SUCCESS (0.606s)
[160.827878] Subtest cursor-rapid-movement-128x128: SUCCESS (1.364s)
[161.194655] [037/142] (898s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[161.337830] Starting subtest: addfb25-x-tiled-mismatch-legacy
[161.339134] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.001s)
[161.526727] [038/142] (897s left) gem_exec_schedule (manyslice)
[161.712927] Starting subtest: manyslice
[161.714341] Starting dynamic subtest: rcs0
[163.328427] Dynamic subtest rcs0: SUCCESS (1.607s)
[163.376041] Starting dynamic subtest: bcs0
[164.331247] Dynamic subtest bcs0: SUCCESS (1.004s)
[164.385147] Starting dynamic subtest: vcs0
[165.195701] Dynamic subtest vcs0: SUCCESS (0.866s)
[165.216765] Starting dynamic subtest: vecs0
[165.961121] Dynamic subtest vecs0: SUCCESS (0.765s)
[165.963942] Subtest manyslice: SUCCESS (4.246s)
[166.309304] [039/142] (893s left) kms_flip (busy-flip)
[166.536028] Starting subtest: busy-flip
[166.539884] Starting dynamic subtest: A-DP1
[167.570980] Dynamic subtest A-DP1: SUCCESS (1.033s)
[167.592341] Starting dynamic subtest: B-DP1
[168.539024] Dynamic subtest B-DP1: SUCCESS (0.966s)
[168.558698] Starting dynamic subtest: C-DP1
[169.501055] Dynamic subtest C-DP1: SUCCESS (0.961s)
[169.502678] Subtest busy-flip: SUCCESS (2.969s)
[169.935037] [040/142] (889s left) gem_tiled_fence_blits (basic)
[170.356752] Starting subtest: basic
[170.395922] Subtest basic: SUCCESS (0.040s)
[170.543425] [041/142] (889s left) kms_pm_dc (dc5-psr)
[171.948767] Starting subtest: dc5-psr
[171.954328] Subtest dc5-psr: SKIP (0.000s)
[172.133390] [042/142] (887s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[172.280275] Starting subtest: etime-multi-wait-all-submitted-signaled
[172.384627] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.104s)
[172.463334] [043/142] (887s left) kms_universal_plane (universal-plane-pageflip-windowed-pipe-d)
[172.701653] Subtest universal-plane-pageflip-windowed-pipe-D: SKIP (0.000s)
[172.780058] [044/142] (886s left) gem_exec_whisper (basic-contexts-forked)
[172.948417] Starting subtest: basic-contexts-forked
[187.674006] Subtest basic-contexts-forked: SUCCESS (14.724s)
[187.882933] [045/142] (871s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-msflip-blt)
[188.125300] Starting subtest: fbcpsr-2p-primscrn-indfb-msflip-blt
[188.128016] Subtest fbcpsr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[188.231244] [046/142] (871s left) vgem_basic (dmabuf-fence)
[188.445013] Starting subtest: dmabuf-fence
[188.446638] Subtest dmabuf-fence: SUCCESS (0.003s)
[188.514753] [047/142] (871s left) i915_pm_rpm (pc8-residency)
[190.414521] Starting subtest: pc8-residency
[190.419851] Subtest pc8-residency: SKIP (0.000s)
[190.924648] [048/142] (868s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-indfb-draw-render)
[191.178671] Starting subtest: psr-1p-offscren-pri-indfb-draw-render
[191.181481] Subtest psr-1p-offscren-pri-indfb-draw-render: SKIP (0.000s)
[191.290197] [049/142] (868s left) kms_vblank (pipe-b-ts-continuation-suspend)
[191.532075] Starting subtest: pipe-B-ts-continuation-suspend
[209.201858] Subtest pipe-B-ts-continuation-suspend: SUCCESS (2.025s)
[215.541769] [050/142] (866s left) gem_render_copy (x-tiled-to-vebox-yf-tiled)
[215.707677] Starting subtest: x-tiled-to-vebox-yf-tiled
[215.710388] Subtest x-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[215.917880] [051/142] (865s left) kms_big_fb (linear-64bpp-rotate-180)
[216.179070] Starting subtest: linear-64bpp-rotate-180
[224.744170] Subtest linear-64bpp-rotate-180: SUCCESS (8.563s)
[225.669491] [052/142] (856s left) kms_chamelium_frames (dp-frame-dump)
[226.009976] Subtest dp-frame-dump: SKIP (0.000s)
[226.314277] [053/142] (855s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions)
[226.559057] Starting subtest: cursorA-vs-flipA-atomic-transitions
[237.647240] Subtest cursorA-vs-flipA-atomic-transitions: SUCCESS (11.088s)
[237.994825] [054/142] (843s left) kms_dirtyfb (dirtyfb-ioctl)
[238.253717] Starting subtest: dirtyfb-ioctl
[238.255257] Starting dynamic subtest: default-DP-1
[239.726621] Dynamic subtest default-DP-1: SUCCESS (1.472s)
[239.750062] Starting dynamic subtest: drrs-DP-1
[239.752901] Dynamic subtest drrs-DP-1: SKIP (0.001s)
[239.777990] Starting dynamic subtest: fbc-DP-1
[239.785726] Dynamic subtest fbc-DP-1: SKIP (0.053s)
[239.812900] Starting dynamic subtest: psr-DP-1
[239.815552] Dynamic subtest psr-DP-1: SKIP (0.000s)
[239.816852] Subtest dirtyfb-ioctl: SUCCESS (1.535s)
[240.140368] [055/142] (841s left) gem_mmap_gtt (cpuset-medium-copy-xy)
[240.281662] Starting subtest: cpuset-medium-copy-XY
[252.656354] Subtest cpuset-medium-copy-XY: SUCCESS (12.374s)
[252.792710] [056/142] (829s left) kms_atomic_transition (plane-use-after-nonblocking-unbind)
[253.164542] Starting subtest: plane-use-after-nonblocking-unbind
[253.169169] Starting dynamic subtest: pipe-A-DP-1
[253.329438] Dynamic subtest pipe-A-DP-1: SUCCESS (0.163s)
[253.453945] Starting dynamic subtest: pipe-B-DP-1
[253.994594] Dynamic subtest pipe-B-DP-1: SUCCESS (0.562s)
[254.110316] Subtest plane-use-after-nonblocking-unbind: SUCCESS (0.943s)
[254.453648] [057/142] (827s left) gem_set_tiling_vs_gtt
[254.969760] [058/142] (827s left) vgem_basic (dmabuf-mmap)
[255.128525] Starting subtest: dmabuf-mmap
[255.169077] Subtest dmabuf-mmap: SUCCESS (0.040s)
[255.252531] [059/142] (826s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-blt)
[255.500582] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-blt
[257.626519] Subtest fbc-1p-primscrn-cur-indfb-draw-blt: SUCCESS (2.128s)
[257.771122] [060/142] (824s left) kms_chamelium_hpd (dp-hpd-storm)
[258.091502] Subtest dp-hpd-storm: SKIP (0.000s)
[258.385872] [061/142] (823s left) kms_ccs (pipe-b-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs)
[258.807174] Starting subtest: pipe-B-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs
[258.813049] Subtest pipe-B-crc-sprite-planes-basic-y_tiled_gen12_rc_ccs: SKIP (0.005s)
[259.197648] [062/142] (822s left) gem_ctx_persistence (legacy-engines-hang)
[259.350748] Starting subtest: legacy-engines-hang
[259.356634] Starting dynamic subtest: render
[259.397684] Dynamic subtest render: SUCCESS (0.041s)
[259.427542] Starting dynamic subtest: bsd
[259.442815] Dynamic subtest bsd: SUCCESS (0.043s)
[259.475909] Starting dynamic subtest: blt
[259.478754] Dynamic subtest blt: SKIP (0.005s)
[259.501563] Starting dynamic subtest: vebox
[259.502975] Dynamic subtest vebox: SUCCESS (0.048s)
[259.504534] Subtest legacy-engines-hang: SUCCESS (0.153s)
[259.596628] [063/142] (822s left) gem_exec_reloc (basic-write-gtt-active)
[259.751689] Starting subtest: basic-write-gtt-active
[259.890233] Subtest basic-write-gtt-active: SUCCESS (0.138s)
[260.079950] [064/142] (822s left) gem_ctx_shared (single-timeline)
[260.248861] Starting subtest: single-timeline
[260.262824] Subtest single-timeline: SUCCESS (0.013s)
[260.497089] [065/142] (821s left) v3d/v3d_submit_cl (bad-flag)
[260.706134] Subtest bad-flag: SKIP (0.000s)
[260.778261] [066/142] (821s left) kms_big_fb (4-tiled-32bpp-rotate-270)
[261.053149] Starting subtest: 4-tiled-32bpp-rotate-270
[261.056284] Subtest 4-tiled-32bpp-rotate-270: SKIP (0.000s)
[261.146242] [067/142] (821s left) gem_exec_capture (pi)
[261.300477] Starting subtest: pi
[261.301846] Starting dynamic subtest: rcs0
[290.812493] Dynamic subtest rcs0: SUCCESS (29.511s)
[290.837473] Starting dynamic subtest: bcs0
[321.497376] Dynamic subtest bcs0: SUCCESS (30.683s)
[321.525910] Starting dynamic subtest: vcs0
[350.964382] Dynamic subtest vcs0: SUCCESS (29.463s)
[350.988614] Starting dynamic subtest: vecs0
[380.887729] Dynamic subtest vecs0: SUCCESS (29.918s)
[380.891654] Subtest pi: SUCCESS (119.585s)
[380.983744] [068/142] (701s left) kms_ccs (pipe-a-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc)
[381.482754] Starting subtest: pipe-A-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc
[381.485388] Subtest pipe-A-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[381.915217] [069/142] (700s left) gem_pxp (create-protected-buffer)
[384.585681] Subtest create-protected-buffer: SKIP (0.000s)
[384.683218] [070/142] (697s left) kms_frontbuffer_tracking (fbc-tiling-y)
[384.933338] Starting subtest: fbc-tiling-y
[387.171687] Subtest fbc-tiling-y: SUCCESS (2.238s)
[387.316570] [071/142] (695s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt)
[387.561429] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt
[387.564272] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[387.665601] [072/142] (694s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-plflip-blt)
[387.919159] Starting subtest: psr-2p-primscrn-indfb-plflip-blt
[387.922156] Subtest psr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[388.014537] [073/142] (694s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted)
[388.173206] Starting subtest: multi-wait-for-submit-unsubmitted-submitted
[388.278146] Subtest multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.103s)
[388.364096] [074/142] (694s left) kms_vblank (pipe-a-ts-continuation-modeset-hang)
[388.610216] Starting subtest: pipe-A-ts-continuation-modeset-hang
[396.028628] Subtest pipe-A-ts-continuation-modeset-hang: SUCCESS (7.419s)
[396.375189] [075/142] (686s left) gem_exec_flush (basic-wb-rw-default)
[396.544181] Starting subtest: basic-wb-rw-default
[402.015726] Subtest basic-wb-rw-default: SUCCESS (5.470s)
[402.225799] [076/142] (680s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt)
[402.471903] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt
[402.475215] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[402.576816] [077/142] (680s left) kms_frontbuffer_tracking (fbc-shrfb-scaledprimary)
[402.824601] Starting subtest: fbc-shrfb-scaledprimary
[406.082539] Subtest fbc-shrfb-scaledprimary: SUCCESS (3.259s)
[406.228168] [078/142] (676s left) gem_exec_fence (syncobj-invalid-wait)
[406.856438] Starting subtest: syncobj-invalid-wait
[406.858323] Subtest syncobj-invalid-wait: SUCCESS (0.001s)
[407.210931] [079/142] (675s left) prime_vgem (fence-flip-hang)
[407.387370] Subtest fence-flip-hang: SKIP (0.000s)
[407.494080] [080/142] (675s left) gem_exec_schedule (pi-ringfull)
[407.802739] Starting subtest: pi-ringfull
[407.804182] Starting dynamic subtest: rcs0
[407.900142] Dynamic subtest rcs0: SUCCESS (0.094s)
[407.929195] Starting dynamic subtest: bcs0
[407.995893] Dynamic subtest bcs0: SUCCESS (0.093s)
[408.023392] Starting dynamic subtest: vcs0
[408.091532] Dynamic subtest vcs0: SUCCESS (0.093s)
[408.119573] Starting dynamic subtest: vecs0
[408.185605] Dynamic subtest vecs0: SUCCESS (0.092s)
[408.187124] Subtest pi-ringfull: SUCCESS (0.383s)
[408.402435] [081/142] (674s left) i915_pm_rc6_residency (rc6-idle)
[408.543915] Starting subtest: rc6-idle
[408.554829] Starting dynamic subtest: rcs0
[420.832081] Dynamic subtest rcs0: SUCCESS (12.279s)
[420.860247] Starting dynamic subtest: bcs0
[433.116070] Dynamic subtest bcs0: SUCCESS (12.281s)
[433.142623] Starting dynamic subtest: vcs0
[445.396120] Dynamic subtest vcs0: SUCCESS (12.277s)
[445.422622] Starting dynamic subtest: vecs0
[457.677638] Dynamic subtest vecs0: SUCCESS (12.279s)
[457.679433] Subtest rc6-idle: SUCCESS (49.136s)
[457.977100] [082/142] (625s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[458.225208] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[458.227939] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[458.327297] [083/142] (624s left) kms_ccs (pipe-b-crc-primary-rotation-180-y_tiled_gen12_rc_ccs)
[458.725652] Starting subtest: pipe-B-crc-primary-rotation-180-y_tiled_gen12_rc_ccs
[458.728579] Subtest pipe-B-crc-primary-rotation-180-y_tiled_gen12_rc_ccs: SKIP (0.001s)
[459.148311] [084/142] (623s left) gem_ccs (block-multicopy-inplace)
[459.297872] Subtest block-multicopy-inplace: SKIP (0.000s)
[459.365387] [085/142] (623s left) gem_exec_params (rel-constants-invalid-rel-gen5)
[459.510459] Starting subtest: rel-constants-invalid-rel-gen5
[459.511930] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.001s)
[459.629248] [086/142] (623s left) gem_spin_batch (engines)
[459.794942] Starting subtest: engines
[459.796493] Starting dynamic subtest: rcs0
[463.122505] Dynamic subtest rcs0: SUCCESS (3.324s)
[463.145807] Starting dynamic subtest: bcs0
[466.449421] Dynamic subtest bcs0: SUCCESS (3.323s)
[466.472606] Starting dynamic subtest: vcs0
[469.774164] Dynamic subtest vcs0: SUCCESS (3.322s)
[469.797433] Starting dynamic subtest: vecs0
[473.098563] Dynamic subtest vecs0: SUCCESS (3.322s)
[473.099922] Subtest engines: SUCCESS (13.303s)
[473.313851] [087/142] (609s left) kms_feature_discovery (display-2x)
[473.552456] Starting subtest: display-2x
[473.555276] Subtest display-2x: SKIP (0.000s)
[473.647342] [088/142] (609s left) syncobj_wait (invalid-single-wait-all-unsubmitted)
[473.790540] Starting subtest: invalid-single-wait-all-unsubmitted
[473.792173] Subtest invalid-single-wait-all-unsubmitted: SUCCESS (0.000s)
[473.879885] [089/142] (609s left) gem_softpin (noreloc)
[474.032989] Starting subtest: noreloc
[479.558544] Subtest noreloc: SUCCESS (5.523s)
[479.679535] [090/142] (603s left) kms_ccs (pipe-d-bad-pixel-format-4_tiled_mtl_rc_ccs)
[480.167021] Subtest pipe-D-bad-pixel-format-4_tiled_mtl_rc_ccs: SKIP (0.000s)
[480.501503] [091/142] (602s left) kms_big_fb (x-tiled-16bpp-rotate-270)
[480.766781] Starting subtest: x-tiled-16bpp-rotate-270
[480.853928] Subtest x-tiled-16bpp-rotate-270: SKIP (0.085s)
[480.964373] [092/142] (602s left) perf_pmu (invalid-open)
[481.117375] Starting subtest: invalid-open
[481.119038] Subtest invalid-open: SUCCESS (0.001s)
[481.214479] [093/142] (602s left) i915_pm_rps (min-max-config-idle)
[481.367833] Starting subtest: min-max-config-idle
[481.776836] Subtest min-max-config-idle: SUCCESS (0.409s)
[481.865484] [094/142] (601s left) gem_mmap_wc (read)
[482.008823] Starting subtest: read
[482.149498] Subtest read: SUCCESS (0.142s)
[482.247567] [095/142] (601s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted)
[482.398293] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[482.399930] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.002s)
[482.499911] [096/142] (601s left) gem_pread (bench)
[482.640528] Starting subtest: bench
[487.020309] Subtest bench: SUCCESS (4.377s)
[487.130841] [097/142] (596s left) perf_pmu (busy-double-start)
[487.277490] Starting subtest: busy-double-start
[487.278839] Starting dynamic subtest: rcs0
[490.829948] Dynamic subtest rcs0: SUCCESS (3.550s)
[490.856365] Starting dynamic subtest: bcs0
[494.396157] Dynamic subtest bcs0: SUCCESS (3.563s)
[494.422952] Starting dynamic subtest: vcs0
[497.948038] Dynamic subtest vcs0: SUCCESS (3.548s)
[497.974967] Starting dynamic subtest: vecs0
[501.500163] Dynamic subtest vecs0: SUCCESS (3.548s)
[501.501874] Subtest busy-double-start: SUCCESS (14.224s)
[501.600508] [098/142] (582s left) kms_ccs (pipe-c-random-ccs-data-4_tiled_dg2_rc_ccs)
[502.056904] Starting subtest: pipe-C-random-ccs-data-4_tiled_dg2_rc_ccs
[502.060725] Subtest pipe-C-random-ccs-data-4_tiled_dg2_rc_ccs: SKIP (0.000s)
[502.409362] [099/142] (581s left) api_intel_bb (blit-reloc-purge-cache)
[502.559952] Starting subtest: blit-reloc-purge-cache
[502.576848] Subtest blit-reloc-purge-cache: SUCCESS (0.019s)
[502.693860] [100/142] (581s left) device_reset (unbind-cold-reset-rebind)
[502.872883] Subtest unbind-cold-reset-rebind: SKIP (0.000s)
[502.959790] [101/142] (580s left) prime_vgem (basic-fence-flip)
[503.130390] Starting subtest: basic-fence-flip
[503.699135] Subtest basic-fence-flip: SUCCESS (0.569s)
[503.809230] [102/142] (580s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-cpu)
[504.053727] Starting subtest: psr-rgb101010-draw-mmap-cpu
[504.056919] Subtest psr-rgb101010-draw-mmap-cpu: SKIP (0.000s)
[504.174781] [103/142] (579s left) kms_plane (plane-position-covered)
[504.418450] Starting subtest: plane-position-covered
[504.422387] Starting dynamic subtest: pipe-A-planes
[505.918226] Dynamic subtest pipe-A-planes: SUCCESS (1.497s)
[505.944891] Starting dynamic subtest: pipe-B-planes
[507.654777] Dynamic subtest pipe-B-planes: SUCCESS (1.730s)
[507.656130] Subtest plane-position-covered: SUCCESS (3.238s)
[508.005658] [104/142] (576s left) vc4/vc4_perfmon (get-values-valid-perfmon)
[508.214452] Subtest get-values-valid-perfmon: SKIP (0.000s)
[508.287771] [105/142] (575s left) dmabuf_sync_file (import-basic)
[508.428090] Starting subtest: import-basic
[508.434325] Subtest import-basic: SUCCESS (0.006s)
[508.504550] [106/142] (575s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[508.758837] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[508.761997] Subtest psr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[508.861826] [107/142] (575s left) gem_exec_params (cliprects-invalid)
[509.010152] Starting subtest: cliprects-invalid
[509.012092] Subtest cliprects-invalid: SUCCESS (0.001s)
[509.121990] [108/142] (575s left) kms_ccs (pipe-a-bad-rotation-90-4_tiled_dg2_rc_ccs)
[509.462610] Starting subtest: pipe-A-bad-rotation-90-4_tiled_dg2_rc_ccs
[509.465108] Subtest pipe-A-bad-rotation-90-4_tiled_dg2_rc_ccs: SKIP (0.000s)
[509.927136] [109/142] (574s left) kms_scaling_modes (scaling-mode-full)
[510.166879] Starting subtest: scaling-mode-full
[510.169643] Subtest scaling-mode-full: SKIP (0.001s)
[510.259480] [110/142] (574s left) kms_universal_plane (disable-primary-vs-flip-pipe-b)
[510.496740] Starting subtest: disable-primary-vs-flip-pipe-B
[511.482665] Subtest disable-primary-vs-flip-pipe-B: SUCCESS (0.984s)
[511.844259] [111/142] (572s left) kms_ccs (pipe-b-ccs-on-another-bo-4_tiled_mtl_rc_ccs_cc)
[512.251372] Starting subtest: pipe-B-ccs-on-another-bo-4_tiled_mtl_rc_ccs_cc
[512.254023] Subtest pipe-B-ccs-on-another-bo-4_tiled_mtl_rc_ccs_cc: SKIP (0.000s)
[512.639458] [112/142] (571s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render)
[512.884685] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render
[515.225275] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (2.342s)
[515.386594] [113/142] (569s left) gem_mmap (big-bo)
[515.530796] Starting subtest: big-bo
[517.471114] Subtest big-bo: SUCCESS (1.939s)
[517.598803] [114/142] (566s left) kms_ccs (pipe-c-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc)
[518.188648] Starting subtest: pipe-C-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc
[518.191535] Subtest pipe-C-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[518.536972] [115/142] (566s left) kms_big_fb (y-tiled-8bpp-rotate-0)
[518.800066] Starting subtest: y-tiled-8bpp-rotate-0
[521.887248] Subtest y-tiled-8bpp-rotate-0: SUCCESS (3.085s)
[522.132937] [116/142] (562s left) gem_exec_balancer (full-late-pulse)
[522.300164] Starting subtest: full-late-pulse
[526.327680] Subtest full-late-pulse: SUCCESS (4.028s)
[530.265899] [117/142] (554s left) gem_userptr_blits (map-fixed-invalidate-busy)
[530.451488] Starting subtest: map-fixed-invalidate-busy
[530.453018] Starting dynamic subtest: gtt
[534.264008] Dynamic subtest gtt: SUCCESS (3.780s)
[534.289767] Starting dynamic subtest: wb
[537.895319] Dynamic subtest wb: SUCCESS (3.657s)
[537.918876] Starting dynamic subtest: wc
[541.563274] Dynamic subtest wc: SUCCESS (3.666s)
[541.588063] Starting dynamic subtest: uc
[545.293764] Dynamic subtest uc: SUCCESS (3.726s)
[545.295218] Subtest map-fixed-invalidate-busy: SUCCESS (14.841s)
[545.433233] [118/142] (539s left) kms_plane_scaling (plane-upscale-with-rotation-20x20)
[545.679980] Starting subtest: plane-upscale-with-rotation-20x20
[545.681506] Starting dynamic subtest: pipe-A-DP-1
[545.739794] Dynamic subtest pipe-A-DP-1: SKIP (0.058s)
[545.766906] Starting dynamic subtest: pipe-B-DP-1
[546.098677] Dynamic subtest pipe-B-DP-1: SKIP (0.353s)
[546.141817] Starting dynamic subtest: pipe-C-DP-1
[546.455784] Dynamic subtest pipe-C-DP-1: SKIP (0.350s)
[546.458912] Subtest plane-upscale-with-rotation-20x20: SKIP (0.776s)
[546.846501] [119/142] (537s left) kms_cdclk (mode-transition)
[546.991481] Subtest mode-transition: SKIP (0.000s)
[547.046985] [120/142] (537s left) kms_ccs (pipe-a-crc-sprite-planes-basic-yf_tiled_ccs)
[547.423087] Starting subtest: pipe-A-crc-sprite-planes-basic-yf_tiled_ccs
[547.965144] Subtest pipe-A-crc-sprite-planes-basic-yf_tiled_ccs: SUCCESS (0.542s)
[548.500600] [121/142] (536s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[548.775539] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip
[548.807275] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.031s)
[548.932642] [122/142] (535s left) gem_userptr_blits (set-cache-level)
[549.083783] Starting subtest: set-cache-level
[549.085277] Subtest set-cache-level: SUCCESS (0.000s)
[549.270324] [123/142] (535s left) prime_mmap (test_errors)
[549.416809] Starting subtest: test_errors
[549.418153] Starting dynamic subtest: test_errors-smem
[549.433229] Dynamic subtest test_errors-smem: SUCCESS (0.017s)
[549.435143] Subtest test_errors: SUCCESS (0.020s)
[549.532816] [124/142] (535s left) v3d/v3d_wait_bo (map-bo-1ns)
[549.724904] Subtest map-bo-1ns: SKIP (0.000s)
[549.799712] [125/142] (535s left) kms_color (invalid-gamma-lut-sizes)
[550.040126] Starting subtest: invalid-gamma-lut-sizes
[550.041433] Starting dynamic subtest: pipe-A
[550.139186] Dynamic subtest pipe-A: SUCCESS (0.099s)
[550.183198] Starting dynamic subtest: pipe-B
[550.185508] Dynamic subtest pipe-B: SUCCESS (0.003s)
[550.226620] Starting dynamic subtest: pipe-C
[550.228245] Dynamic subtest pipe-C: SUCCESS (0.003s)
[550.229715] Subtest invalid-gamma-lut-sizes: SUCCESS (0.115s)
[550.484676] [126/142] (534s left) syncobj_timeline (single-wait-available-submitted)
[550.632050] Starting subtest: single-wait-available-submitted
[550.633739] Subtest single-wait-available-submitted: SUCCESS (0.001s)
[550.728302] [127/142] (534s left) kms_addfb_basic (clobberred-modifier)
[550.871673] Starting subtest: clobberred-modifier
[550.873110] Subtest clobberred-modifier: SUCCESS (0.000s)
[551.079198] [128/142] (534s left) kms_flip (dpms-off-confusion)
[551.302698] Starting subtest: dpms-off-confusion
[551.304083] Starting dynamic subtest: A-DP1
[561.818207] Dynamic subtest A-DP1: SUCCESS (10.511s)
[561.841512] Starting dynamic subtest: B-DP1
[572.327647] Dynamic subtest B-DP1: SUCCESS (10.510s)
[572.354369] Starting dynamic subtest: C-DP1
[582.789788] Dynamic subtest C-DP1: SUCCESS (10.455s)
[582.791380] Subtest dpms-off-confusion: SUCCESS (31.490s)
[583.207693] [129/142] (502s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-pwrite)
[583.460343] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-pwrite
[583.463673] Subtest psr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[583.552355] [130/142] (501s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-mmap-gtt)
[583.795805] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-mmap-gtt
[583.798864] Subtest fbcpsr-1p-offscren-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[583.903202] [131/142] (501s left) kms_big_joiner (basic)
[584.138503] Subtest basic: SKIP (0.000s)
[584.203267] [132/142] (501s left) gem_ctx_param (set-priority-invalid-size)
[584.346026] Starting subtest: set-priority-invalid-size
[584.347579] Subtest set-priority-invalid-size: SUCCESS (0.000s)
[584.435456] [133/142] (500s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[584.696031] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[584.701668] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.003s)
[584.818668] [134/142] (500s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-msflip-blt)
[585.069905] Starting subtest: fbcpsr-2p-scndscrn-shrfb-msflip-blt
[585.072708] Subtest fbcpsr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[585.169212] [135/142] (500s left) gem_exec_schedule (u-fairslice-all)
[585.341237] Starting subtest: u-fairslice-all
[587.464936] Subtest u-fairslice-all: SUCCESS (2.123s)
[587.854922] [136/142] (497s left) sw_sync (sync_random_merge)
[587.996573] Starting subtest: sync_random_merge
[588.148784] Subtest sync_random_merge: SUCCESS (0.154s)
[588.220654] [137/142] (497s left) kms_psr2_sf (overlay-plane-move-continuous-exceed-sf)
[588.369752] Subtest overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[588.436535] [138/142] (497s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling)
[588.677432] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling
[588.678754] Starting dynamic subtest: pipe-A-valid-mode
[589.428126] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.748s)
[589.429568] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SUCCESS (0.753s)
[589.779531] [139/142] (495s left) gem_exec_fence (long-history)
[590.380257] Starting subtest: long-history
[596.154625] Subtest long-history: SUCCESS (5.765s)
[596.798055] [140/142] (488s left) kms_flip (blocking-wf_vblank)
[597.018366] Starting subtest: blocking-wf_vblank
[597.022771] Starting dynamic subtest: A-DP1
[607.823638] Dynamic subtest A-DP1: SUCCESS (10.802s)
[607.850427] Starting dynamic subtest: B-DP1
[618.565368] Dynamic subtest B-DP1: SUCCESS (10.738s)
[618.594844] Starting dynamic subtest: C-DP1
[629.307176] Dynamic subtest C-DP1: SUCCESS (10.739s)
[629.313372] Subtest blocking-wf_vblank: SUCCESS (32.293s)
[629.738072] [141/142] (456s left) vc4/vc4_tiling (get-after-free)
[629.945582] Subtest get-after-free: SKIP (0.000s)
[630.020980] [142/142] (455s left) kms_vblank (pipe-d-wait-forked-busy)
[630.263395] Subtest pipe-D-wait-forked-busy: SKIP (0.000s)
[630.347973] Closing watchdogs
Done.