[53.523239] Initializing watchdogs
[53.523479]   /dev/watchdog0
[53.574343] [001/141] (960s left) i915_query (query-garbage)
[53.896522] Starting subtest: query-garbage
[53.914945] Subtest query-garbage: SUCCESS (0.000s)
[54.003070] [002/141] (960s left) kms_ccs (pipe-c-bad-aux-stride-4_tiled_mtl_rc_ccs)
[54.711373] Starting subtest: pipe-C-bad-aux-stride-4_tiled_mtl_rc_ccs
[54.753701] Subtest pipe-C-bad-aux-stride-4_tiled_mtl_rc_ccs: SKIP (0.000s)
[55.280077] [003/141] (959s left) gem_pxp (fail-invalid-protected-context)
[58.307257] Subtest fail-invalid-protected-context: SKIP (0.000s)
[58.459791] [004/141] (955s left) gem_exec_schedule (deep)
[58.983149] Starting subtest: deep
[59.011224] Starting dynamic subtest: rcs0
[73.124931] Dynamic subtest rcs0: SUCCESS (14.220s)
[73.157792] Starting dynamic subtest: bcs0
[88.345448] Dynamic subtest bcs0: SUCCESS (15.215s)
[88.380273] Starting dynamic subtest: vcs0
[102.715214] Dynamic subtest vcs0: SUCCESS (14.363s)
[102.748388] Starting dynamic subtest: vecs0
[116.873478] Dynamic subtest vecs0: SUCCESS (14.162s)
[116.894860] Subtest deep: SUCCESS (57.967s)
[117.918152] [005/141] (896s left) gem_create (create-valid-nonaligned)
[118.216128] Starting subtest: create-valid-nonaligned
[118.234633] Subtest create-valid-nonaligned: SUCCESS (0.000s)
[118.425573] [006/141] (896s left) perf (polling)
[118.883639] Starting subtest: polling
[118.902526] Starting dynamic subtest: 0-rcs0
[129.104524] Dynamic subtest 0-rcs0: SUCCESS (10.094s)
[129.122939] Subtest polling: SUCCESS (10.094s)
[129.229423] [007/141] (885s left) kms_ccs (pipe-d-bad-rotation-90-y_tiled_gen12_mc_ccs)
[129.981903] Subtest pipe-D-bad-rotation-90-y_tiled_gen12_mc_ccs: SKIP (0.000s)
[130.316455] [008/141] (884s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[130.721546] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip
[130.803091] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.021s)
[130.906664] [009/141] (883s left) kms_ccs (pipe-b-crc-sprite-planes-basic-y_tiled_gen12_mc_ccs)
[131.520287] Starting subtest: pipe-B-crc-sprite-planes-basic-y_tiled_gen12_mc_ccs
[131.561798] Subtest pipe-B-crc-sprite-planes-basic-y_tiled_gen12_mc_ccs: SKIP (0.005s)
[131.984604] [010/141] (882s left) i915_pm_rps (fence-order)
[132.307391] Starting subtest: fence-order
[135.474911] Subtest fence-order: SUCCESS (3.173s)
[135.694522] [011/141] (879s left) kms_flip (2x-modeset-vs-vblank-race-interruptible)
[136.077478] Starting subtest: 2x-modeset-vs-vblank-race-interruptible
[136.119692] Subtest 2x-modeset-vs-vblank-race-interruptible: SKIP (0.003s)
[136.224129] [012/141] (878s left) gem_ctx_isolation (preservation-s3)
[136.526038] Starting subtest: preservation-S3
[136.545263] Starting dynamic subtest: rcs0
[154.595079] Dynamic subtest rcs0: SUCCESS (2.727s)
[154.635310] Starting dynamic subtest: bcs0
[173.710416] Dynamic subtest bcs0: SUCCESS (3.022s)
[173.749175] Starting dynamic subtest: vcs0
[192.554927] Dynamic subtest vcs0: SUCCESS (2.605s)
[192.605169] Starting dynamic subtest: vecs0
[211.543591] Dynamic subtest vecs0: SUCCESS (2.597s)
[211.564626] Subtest preservation-S3: SUCCESS (10.953s)
[216.049026] [013/141] (867s left) kms_psr (cursor_plane_onoff)
[216.390622] Subtest cursor_plane_onoff: SKIP (0.000s)
[216.476922] [014/141] (867s left) kms_cursor_crc (cursor-onscreen-128x128)
[216.875914] Starting subtest: cursor-onscreen-128x128
[216.896801] Starting dynamic subtest: pipe-A-DP-1
[219.407630] Dynamic subtest pipe-A-DP-1: SUCCESS (2.522s)
[219.505273] Starting dynamic subtest: pipe-C-DP-1
[222.153710] Dynamic subtest pipe-C-DP-1: SUCCESS (2.684s)
[222.174110] Subtest cursor-onscreen-128x128: SUCCESS (5.286s)
[222.544528] [015/141] (861s left) api_intel_allocator (simple-allocator)
[222.867259] Starting subtest: simple-allocator
[222.892347] Starting dynamic subtest: basic
[222.918494] Dynamic subtest basic: SUCCESS (0.006s)
[222.965509] Starting dynamic subtest: parallel-one
[222.991613] Dynamic subtest parallel-one: SUCCESS (0.153s)
[223.035944] Starting dynamic subtest: print
[223.062516] Dynamic subtest print: SUCCESS (0.000s)
[223.112511] Starting dynamic subtest: reuse
[223.139083] Dynamic subtest reuse: SUCCESS (0.000s)
[223.183802] Starting dynamic subtest: reserve
[223.209005] Dynamic subtest reserve: SUCCESS (0.000s)
[223.253418] Starting dynamic subtest: fork-reopen-allocator
[223.279796] Dynamic subtest fork-reopen-allocator: SUCCESS (0.042s)
[223.305952] Subtest simple-allocator: SUCCESS (0.203s)
[223.415834] [016/141] (860s left) gem_mmap_gtt (bad-object)
[223.710686] Starting subtest: bad-object
[223.731908] Subtest bad-object: SUCCESS (0.000s)
[223.818922] [017/141] (860s left) gem_exec_nop (basic-parallel)
[224.272769] Starting subtest: basic-parallel
[227.268650] Subtest basic-parallel: SUCCESS (3.161s)
[227.521951] [018/141] (856s left) kms_invalid_mode (zero-vdisplay)
[227.929474] Starting subtest: zero-vdisplay
[227.950505] Starting dynamic subtest: DP-1-pipe-A
[227.997309] Dynamic subtest DP-1-pipe-A: SUCCESS (0.093s)
[228.037389] Starting dynamic subtest: DP-1-pipe-B
[228.056519] Dynamic subtest DP-1-pipe-B: SUCCESS (0.014s)
[228.102141] Starting dynamic subtest: DP-1-pipe-C
[228.123458] Dynamic subtest DP-1-pipe-C: SUCCESS (0.014s)
[228.144761] Subtest zero-vdisplay: SUCCESS (0.127s)
[228.393062] [019/141] (855s left) drm_fdinfo (isolation)
[228.695193] Starting subtest: isolation
[228.716005] Starting dynamic subtest: rcs0
[229.203601] Dynamic subtest rcs0: SUCCESS (0.534s)
[229.240182] Starting dynamic subtest: bcs0
[229.742879] Dynamic subtest bcs0: SUCCESS (0.531s)
[229.781909] Starting dynamic subtest: vcs0
[230.268534] Dynamic subtest vcs0: SUCCESS (0.530s)
[230.304886] Starting dynamic subtest: vecs0
[230.804022] Dynamic subtest vecs0: SUCCESS (0.531s)
[230.824825] Subtest isolation: SUCCESS (2.126s)
[230.909975] [020/141] (853s left) api_intel_allocator (open-vm)
[231.203138] Starting subtest: open-vm
[231.222190] Subtest open-vm: SUCCESS (0.004s)
[231.308983] [021/141] (852s left) perf (polling-small-buf)
[231.680224] Starting subtest: polling-small-buf
[231.804194] Subtest polling-small-buf: SUCCESS (0.121s)
[231.907511] [022/141] (852s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[232.326732] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[232.364548] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[232.470204] [023/141] (851s left) kms_ccs (pipe-b-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc)
[233.074765] Starting subtest: pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc
[233.113007] Subtest pipe-B-ccs-on-another-bo-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[233.562522] [024/141] (850s left) kms_vblank (pipe-b-ts-continuation-suspend)
[233.920077] Starting subtest: pipe-B-ts-continuation-suspend
[252.252706] Subtest pipe-B-ts-continuation-suspend: SUCCESS (2.201s)
[258.586670] [025/141] (848s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite)
[259.028489] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite
[259.067861] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[259.172568] [026/141] (847s left) syncobj_timeline (single-wait-all-available-signaled)
[259.456887] Starting subtest: single-wait-all-available-signaled
[259.476055] Subtest single-wait-all-available-signaled: SUCCESS (0.001s)
[259.566706] [027/141] (847s left) gem_lmem_evict (dontneed-evict-race)
[259.881605] Subtest dontneed-evict-race: SKIP (0.000s)
[259.972350] [028/141] (847s left) gem_exec_balancer (hang)
[264.297258] Starting subtest: hang
[267.961405] Subtest hang: SUCCESS (3.669s)
[268.049559] [029/141] (839s left) v3d/v3d_submit_cl (bad-multisync-extension)
[268.386907] Subtest bad-multisync-extension: SKIP (0.000s)
[268.470696] [030/141] (838s left) kms_psr (psr2_sprite_blt)
[268.780272] Subtest psr2_sprite_blt: SKIP (0.000s)
[268.870372] [031/141] (838s left) kms_ccs (pipe-c-crc-primary-rotation-180-4_tiled_dg2_rc_ccs_cc)
[269.550087] Starting subtest: pipe-C-crc-primary-rotation-180-4_tiled_dg2_rc_ccs_cc
[269.591664] Subtest pipe-C-crc-primary-rotation-180-4_tiled_dg2_rc_ccs_cc: SKIP (0.001s)
[269.965558] [032/141] (837s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[270.397231] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu
[270.440428] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[270.547384] [033/141] (836s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-pgflip-blt)
[270.994341] Starting subtest: psr-1p-primscrn-indfb-pgflip-blt
[271.034353] Subtest psr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[271.141217] [034/141] (836s left) kms_vblank (pipe-c-ts-continuation-modeset-rpm)
[271.495671] Starting subtest: pipe-C-ts-continuation-modeset-rpm
[273.830455] Subtest pipe-C-ts-continuation-modeset-rpm: SUCCESS (2.331s)
[274.379350] [035/141] (833s left) gem_wait (await)
[274.736433] Starting subtest: await
[274.760405] Starting dynamic subtest: all-engines
[275.785882] Dynamic subtest all-engines: SUCCESS (1.034s)
[275.832134] Starting dynamic subtest: rcs0
[276.806969] Dynamic subtest rcs0: SUCCESS (1.025s)
[276.853672] Starting dynamic subtest: bcs0
[277.840856] Dynamic subtest bcs0: SUCCESS (1.033s)
[277.889573] Starting dynamic subtest: vcs0
[278.862917] Dynamic subtest vcs0: SUCCESS (1.022s)
[278.903614] Starting dynamic subtest: vecs0
[279.891754] Dynamic subtest vecs0: SUCCESS (1.025s)
[279.912380] Subtest await: SUCCESS (5.143s)
[280.144618] [036/141] (827s left) core_auth (many-magics)
[280.441005] Starting subtest: many-magics
[281.644072] Subtest many-magics: SUCCESS (1.234s)
[281.795516] [037/141] (826s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[282.229970] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu
[282.269950] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[282.379114] [038/141] (825s left) gem_close_race (multigpu-basic-threads)
[282.683066] Starting subtest: multigpu-basic-threads
[282.722445] Subtest multigpu-basic-threads: SKIP (0.000s)
[282.909706] [039/141] (825s left) gem_ctx_sseu (mmap-args)
[283.227314] Subtest mmap-args: SKIP (0.000s)
[283.316771] [040/141] (824s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-plflip-blt)
[283.754770] Starting subtest: psr-2p-scndscrn-shrfb-plflip-blt
[283.799992] Subtest psr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[283.904095] [041/141] (824s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render)
[284.344981] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render
[284.381765] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[284.492445] [042/141] (823s left) kms_draw_crc (draw-method-blt)
[284.876790] Starting subtest: draw-method-blt
[284.895618] Starting dynamic subtest: xrgb8888-untiled
[285.178464] Dynamic subtest xrgb8888-untiled: SUCCESS (0.320s)
[285.216167] Starting dynamic subtest: rgb565-untiled
[285.477812] Dynamic subtest rgb565-untiled: SUCCESS (0.299s)
[285.517583] Starting dynamic subtest: xrgb2101010-untiled
[285.779756] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.300s)
[285.822098] Starting dynamic subtest: xrgb8888-xtiled
[285.947646] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.165s)
[285.996777] Starting dynamic subtest: rgb565-xtiled
[286.112485] Dynamic subtest rgb565-xtiled: SUCCESS (0.166s)
[286.151552] Starting dynamic subtest: xrgb2101010-xtiled
[286.281602] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.166s)
[286.330121] Starting dynamic subtest: xrgb8888-ytiled
[286.464343] Dynamic subtest xrgb8888-ytiled: SUCCESS (0.182s)
[286.503643] Starting dynamic subtest: rgb565-ytiled
[286.631291] Dynamic subtest rgb565-ytiled: SUCCESS (0.166s)
[286.674053] Starting dynamic subtest: xrgb2101010-ytiled
[286.809425] Dynamic subtest xrgb2101010-ytiled: SUCCESS (0.182s)
[286.831036] Subtest draw-method-blt: SUCCESS (1.954s)
[286.959592] [043/141] (821s left) kms_panel_fitting (legacy)
[287.324322] Starting subtest: legacy
[287.361537] Subtest legacy: SKIP (0.000s)
[287.478490] [044/141] (821s left) kms_content_protection (dp-mst-type-1)
[287.884418] Starting subtest: dp-mst-type-1
[287.924877] Subtest dp-mst-type-1: SKIP (0.001s)
[288.034709] [045/141] (820s left) gem_exec_fence (basic-wait-all)
[288.380787] Starting subtest: basic-wait-all
[288.399633] Subtest basic-wait-all: SUCCESS (0.037s)
[289.194689] [046/141] (819s left) gem_exec_balancer (nohangcheck)
[293.518657] Starting subtest: nohangcheck
[297.297947] Subtest nohangcheck: SUCCESS (3.782s)
[297.388819] [047/141] (811s left) kms_ccs (pipe-a-ccs-on-another-bo-y_tiled_gen12_rc_ccs)
[297.895742] Starting subtest: pipe-A-ccs-on-another-bo-y_tiled_gen12_rc_ccs
[297.937577] Subtest pipe-A-ccs-on-another-bo-y_tiled_gen12_rc_ccs: SKIP (0.000s)
[298.483786] [048/141] (810s left) gem_exec_fence (long-history)
[299.210760] Starting subtest: long-history
[304.920334] Subtest long-history: SUCCESS (5.733s)
[305.578652] [049/141] (803s left) prime_vgem (busy)
[305.920860] Starting subtest: busy
[305.939550] Starting dynamic subtest: rcs0
[305.958209] Dynamic subtest rcs0: SUCCESS (0.035s)
[305.995579] Starting dynamic subtest: vcs0
[306.014188] Dynamic subtest vcs0: SUCCESS (0.020s)
[306.053885] Starting dynamic subtest: vecs0
[306.075222] Dynamic subtest vecs0: SUCCESS (0.019s)
[306.095666] Subtest busy: SUCCESS (0.077s)
[306.202009] [050/141] (802s left) gem_mmap_offset (pf-nonblock)
[306.506240] Starting subtest: pf-nonblock
[306.524933] Subtest pf-nonblock: SUCCESS (0.015s)
[306.626642] [051/141] (802s left) kms_plane_lowres (tiling-x)
[307.012738] Starting subtest: tiling-x
[307.033667] Starting dynamic subtest: pipe-A-DP-1
[313.401947] Dynamic subtest pipe-A-DP-1: SUCCESS (6.404s)
[313.549430] Starting dynamic subtest: pipe-B-DP-1
[319.789457] Dynamic subtest pipe-B-DP-1: SUCCESS (6.270s)
[319.924550] Starting dynamic subtest: pipe-C-DP-1
[324.153401] Dynamic subtest pipe-C-DP-1: SUCCESS (4.250s)
[324.264979] Subtest tiling-x: SUCCESS (17.258s)
[324.776137] [052/141] (784s left) gem_eio (banned)
[325.122071] Starting subtest: banned
[325.275681] Subtest banned: SUCCESS (0.170s)
[325.508081] [053/141] (783s left) kms_chamelium_frames (hdmi-frame-dump)
[326.010144] Subtest hdmi-frame-dump: SKIP (0.000s)
[326.325186] [054/141] (783s left) kms_big_fb (x-tiled-32bpp-rotate-180)
[326.754332] Starting subtest: x-tiled-32bpp-rotate-180
[331.711964] Subtest x-tiled-32bpp-rotate-180: SUCCESS (5.002s)
[332.285180] [055/141] (777s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move)
[332.782955] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move
[332.837478] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[332.968791] [056/141] (776s left) i915_pm_freq_api (freq-suspend)
[333.298181] Subtest freq-suspend: SKIP (0.000s)
[333.410416] [057/141] (776s left) i915_query (query-topology-matches-eu-total)
[333.698480] Starting subtest: query-topology-matches-eu-total
[333.719993] Subtest query-topology-matches-eu-total: SUCCESS (0.000s)
[333.832983] [058/141] (776s left) kms_flip (2x-flip-vs-rmfb-interruptible)
[334.188543] Starting subtest: 2x-flip-vs-rmfb-interruptible
[334.225874] Subtest 2x-flip-vs-rmfb-interruptible: SKIP (0.003s)
[334.345756] [059/141] (775s left) i915_hangman (engine-error-state-capture)
[334.642575] Starting subtest: engine-error-state-capture
[334.663130] Starting dynamic subtest: rcs0
[339.105057] Dynamic subtest rcs0: SUCCESS (4.343s)
[339.145857] Starting dynamic subtest: bcs0
[343.075120] Dynamic subtest bcs0: SUCCESS (3.953s)
[343.112894] Starting dynamic subtest: vcs0
[347.108214] Dynamic subtest vcs0: SUCCESS (4.035s)
[347.147584] Starting dynamic subtest: vecs0
[351.136195] Dynamic subtest vecs0: SUCCESS (4.023s)
[351.154970] Subtest engine-error-state-capture: SUCCESS (16.362s)
[351.248650] [060/141] (759s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-pwrite)
[351.688585] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-pwrite
[351.728338] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[351.841290] [061/141] (758s left) kms_ccs (pipe-b-bad-aux-stride-y_tiled_gen12_mc_ccs)
[352.472593] Starting subtest: pipe-B-bad-aux-stride-y_tiled_gen12_mc_ccs
[352.514700] Subtest pipe-B-bad-aux-stride-y_tiled_gen12_mc_ccs: SKIP (0.000s)
[352.940289] [062/141] (757s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[353.337441] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[353.379803] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[353.493958] [063/141] (757s left) kms_big_fb (linear-64bpp-rotate-90)
[353.891765] Starting subtest: linear-64bpp-rotate-90
[354.001504] Subtest linear-64bpp-rotate-90: SKIP (0.085s)
[354.120893] [064/141] (756s left) kms_ccs (pipe-d-missing-ccs-buffer-4_tiled_mtl_rc_ccs)
[354.869069] Subtest pipe-D-missing-ccs-buffer-4_tiled_mtl_rc_ccs: SKIP (0.000s)
[355.210241] [065/141] (755s left) gem_mmap_gtt (basic-write-read)
[355.500311] Starting subtest: basic-write-read
[355.522617] Subtest basic-write-read: SUCCESS (0.033s)
[355.639610] [066/141] (755s left) kms_plane_scaling (planes-downscale-factor-0-5)
[356.002343] Starting subtest: planes-downscale-factor-0-5
[356.021039] Starting dynamic subtest: pipe-A-DP-1
[356.362652] Dynamic subtest pipe-A-DP-1: SUCCESS (0.340s)
[356.401687] Starting dynamic subtest: pipe-B-DP-1
[356.748225] Dynamic subtest pipe-B-DP-1: SUCCESS (0.393s)
[356.800412] Starting dynamic subtest: pipe-C-DP-1
[356.869161] Dynamic subtest pipe-C-DP-1: SKIP (0.093s)
[356.889323] Subtest planes-downscale-factor-0-5: SUCCESS (0.841s)
[357.282674] [067/141] (753s left) perf (enable-disable)
[357.670109] Starting subtest: enable-disable
[357.691426] Starting dynamic subtest: 0-rcs0
[360.796437] Dynamic subtest 0-rcs0: SUCCESS (2.966s)
[360.814915] Subtest enable-disable: SUCCESS (2.968s)
[360.947437] [068/141] (750s left) kms_vrr (flip-suspend)
[361.312288] Starting subtest: flip-suspend
[361.349299] Subtest flip-suspend: SKIP (0.000s)
[361.464172] [069/141] (749s left) gem_ctx_persistence (engines-mixed)
[361.760903] Starting subtest: engines-mixed
[361.782205] Starting dynamic subtest: rcs0
[361.826653] Dynamic subtest rcs0: SUCCESS (0.060s)
[361.867598] Starting dynamic subtest: bcs0
[361.886548] Dynamic subtest bcs0: SUCCESS (0.049s)
[361.926275] Starting dynamic subtest: vcs0
[361.945610] Dynamic subtest vcs0: SUCCESS (0.050s)
[361.984597] Starting dynamic subtest: vecs0
[362.006100] Dynamic subtest vecs0: SUCCESS (0.052s)
[362.027333] Subtest engines-mixed: SUCCESS (0.219s)
[362.138353] [070/141] (749s left) gem_exec_reloc (basic-cpu-read)
[362.442706] Starting subtest: basic-cpu-read
[362.461684] Subtest basic-cpu-read: SUCCESS (0.020s)
[362.669292] [071/141] (748s left) perf_pmu (busy-idle-check-all)
[362.967908] Starting subtest: busy-idle-check-all
[362.988517] Starting dynamic subtest: rcs0
[363.578611] Dynamic subtest rcs0: SUCCESS (0.637s)
[363.618072] Starting dynamic subtest: bcs0
[364.221307] Dynamic subtest bcs0: SUCCESS (0.630s)
[364.261366] Starting dynamic subtest: vcs0
[364.849002] Dynamic subtest vcs0: SUCCESS (0.634s)
[364.888330] Starting dynamic subtest: vecs0
[365.490133] Dynamic subtest vecs0: SUCCESS (0.631s)
[365.510611] Subtest busy-idle-check-all: SUCCESS (2.540s)
[365.617575] [072/141] (746s left) kms_frontbuffer_tracking (fbcpsr-1p-indfb-fliptrack-mmap-gtt)
[366.060885] Starting subtest: fbcpsr-1p-indfb-fliptrack-mmap-gtt
[366.097954] Subtest fbcpsr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[366.214953] [073/141] (745s left) gem_mmap_gtt (basic-write-read-distinct)
[366.503013] Starting subtest: basic-write-read-distinct
[366.525574] Subtest basic-write-read-distinct: SUCCESS (0.033s)
[366.646511] [074/141] (745s left) gem_exec_flush (basic-wb-ro-before-default)
[366.983278] Starting subtest: basic-wb-ro-before-default
[372.590008] Subtest basic-wb-ro-before-default: SUCCESS (5.489s)
[372.700261] [075/141] (739s left) kms_vblank (pipe-c-ts-continuation-suspend)
[373.056628] Starting subtest: pipe-C-ts-continuation-suspend
[391.217061] Subtest pipe-C-ts-continuation-suspend: SUCCESS (2.238s)
[398.409816] [076/141] (736s left) gem_reg_read (timestamp-moving)
[398.681811] Starting subtest: timestamp-moving
[399.653382] Subtest timestamp-moving: SUCCESS (1.001s)
[399.798819] [077/141] (735s left) gem_partial_pwrite_pread (writes-after-reads-display)
[400.141443] Starting subtest: writes-after-reads-display
[420.915735] Subtest writes-after-reads-display: SUCCESS (20.805s)
[421.047635] [078/141] (713s left) gem_softpin (evict-prime)
[421.358166] Starting subtest: evict-prime
[421.378931] Starting dynamic subtest: rcs0
[422.449563] Dynamic subtest rcs0: SUCCESS (1.120s)
[422.494785] Starting dynamic subtest: bcs0
[423.563795] Dynamic subtest bcs0: SUCCESS (1.113s)
[423.634431] Starting dynamic subtest: vcs0
[424.681939] Dynamic subtest vcs0: SUCCESS (1.111s)
[424.731426] Starting dynamic subtest: vecs0
[425.799293] Dynamic subtest vecs0: SUCCESS (1.119s)
[425.842441] Starting dynamic subtest: all
[426.916375] Dynamic subtest all: SUCCESS (1.112s)
[426.935186] Subtest evict-prime: SUCCESS (5.589s)
[427.028528] [079/141] (708s left) kms_big_fb (yf-tiled-8bpp-rotate-0)
[427.455656] Starting subtest: yf-tiled-8bpp-rotate-0
[427.493307] Subtest yf-tiled-8bpp-rotate-0: SKIP (0.000s)
[427.600513] [080/141] (707s left) kms_ccs (pipe-c-crc-sprite-planes-basic-yf_tiled_ccs)
[428.355084] Starting subtest: pipe-C-crc-sprite-planes-basic-yf_tiled_ccs
[428.408296] Subtest pipe-C-crc-sprite-planes-basic-yf_tiled_ccs: SKIP (0.004s)
[428.748130] [081/141] (706s left) v3d/v3d_get_param (get-bad-param)
[429.163316] Subtest get-bad-param: SKIP (0.000s)
[429.304253] [082/141] (706s left) perf_pmu (frequency)
[429.618991] Starting subtest: frequency
[429.644337] Starting dynamic subtest: gt0
[431.744392] Dynamic subtest gt0: SUCCESS (2.109s)
[431.786299] Starting dynamic subtest: idle-gt0
[432.225285] Dynamic subtest idle-gt0: SUCCESS (0.505s)
[432.249195] Subtest frequency: SUCCESS (2.620s)
[432.381086] [083/141] (703s left) kms_chamelium_hpd (hdmi-hpd-fast)
[432.871623] Subtest hdmi-hpd-fast: SKIP (0.000s)
[433.201369] [084/141] (702s left) kms_flip (flip-vs-dpms-off-vs-modeset)
[433.562654] Starting subtest: flip-vs-dpms-off-vs-modeset
[433.583999] Starting dynamic subtest: A-DP1
[434.828385] Dynamic subtest A-DP1: SUCCESS (1.256s)
[434.870897] Starting dynamic subtest: B-DP1
[435.913901] Dynamic subtest B-DP1: SUCCESS (1.104s)
[435.953730] Starting dynamic subtest: C-DP1
[437.029284] Dynamic subtest C-DP1: SUCCESS (1.090s)
[437.049148] Subtest flip-vs-dpms-off-vs-modeset: SUCCESS (3.463s)
[437.414060] [085/141] (698s left) kms_cursor_crc (cursor-sliding-512x512)
[437.801995] Starting subtest: cursor-sliding-512x512
[437.839374] Subtest cursor-sliding-512x512: SKIP (0.003s)
[437.956000] [086/141] (697s left) gem_exec_reloc (basic-gtt-read)
[438.244039] Starting subtest: basic-gtt-read
[438.265665] Subtest basic-gtt-read: SUCCESS (0.019s)
[438.478736] [087/141] (697s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-pgflip-blt)
[438.920600] Starting subtest: fbcpsr-2p-scndscrn-shrfb-pgflip-blt
[438.963058] Subtest fbcpsr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[439.074345] [088/141] (696s left) kms_ccs (pipe-d-crc-primary-basic-4_tiled_mtl_rc_ccs)
[439.830621] Subtest pipe-D-crc-primary-basic-4_tiled_mtl_rc_ccs: SKIP (0.000s)
[440.152544] [089/141] (696s left) vc4/vc4_dmabuf_poll (poll-write-waits-until-write-done)
[440.501426] Subtest poll-write-waits-until-write-done: SKIP (0.000s)
[440.615394] [090/141] (695s left) kms_ccs (pipe-a-missing-ccs-buffer-y_tiled_gen12_mc_ccs)
[441.114753] Starting subtest: pipe-A-missing-ccs-buffer-y_tiled_gen12_mc_ccs
[441.162337] Subtest pipe-A-missing-ccs-buffer-y_tiled_gen12_mc_ccs: SKIP (0.000s)
[441.710691] [091/141] (694s left) gem_mmap_wc (copy)
[442.007835] Starting subtest: copy
[442.320609] Subtest copy: SUCCESS (0.344s)
[442.453951] [092/141] (694s left) gem_render_copy (linear-to-vebox-yf-tiled)
[442.750326] Starting subtest: linear-to-vebox-yf-tiled
[442.788186] Subtest linear-to-vebox-yf-tiled: SKIP (0.000s)
[442.990795] [093/141] (693s left) kms_plane_scaling (plane-upscale-with-pixel-format-20x20)
[443.350256] Starting subtest: plane-upscale-with-pixel-format-20x20
[443.372080] Starting dynamic subtest: pipe-A-DP-1
[443.861413] Dynamic subtest pipe-A-DP-1: SUCCESS (0.497s)
[443.933061] Starting dynamic subtest: pipe-B-DP-1
[444.678182] Dynamic subtest pipe-B-DP-1: SUCCESS (0.808s)
[444.759267] Starting dynamic subtest: pipe-C-DP-1
[445.081483] Dynamic subtest pipe-C-DP-1: SUCCESS (0.370s)
[445.104883] Subtest plane-upscale-with-pixel-format-20x20: SUCCESS (1.692s)
[445.510550] [094/141] (691s left) syncobj_basic (bad-flags-handle-to-fd)
[445.827816] Starting subtest: bad-flags-handle-to-fd
[445.852316] Subtest bad-flags-handle-to-fd: SUCCESS (0.000s)
[445.979583] [095/141] (690s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-shrfb-draw-mmap-cpu)
[446.449869] Starting subtest: psr-1p-offscren-pri-shrfb-draw-mmap-cpu
[446.498339] Subtest psr-1p-offscren-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[446.634623] [096/141] (690s left) kms_ccs (pipe-c-bad-rotation-90-4_tiled_dg2_mc_ccs)
[447.305917] Starting subtest: pipe-C-bad-rotation-90-4_tiled_dg2_mc_ccs
[447.359690] Subtest pipe-C-bad-rotation-90-4_tiled_dg2_mc_ccs: SKIP (0.000s)
[447.735198] [097/141] (689s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[448.132334] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[448.152955] Starting dynamic subtest: pipe-A-valid-mode
[448.213191] Dynamic subtest pipe-A-valid-mode: SKIP (0.085s)
[448.252770] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.089s)
[448.563114] [098/141] (688s left) gem_ctx_bad_destroy (invalid-default-ctx)
[448.854042] Starting subtest: invalid-default-ctx
[448.874584] Subtest invalid-default-ctx: SUCCESS (0.000s)
[448.991676] [099/141] (688s left) i915_pm_dc (dc5-dpms-negative)
[450.387482] Starting subtest: dc5-dpms-negative
[454.660537] Subtest dc5-dpms-negative: SUCCESS (4.297s)
[454.905844] [100/141] (682s left) kms_busy (extended-pageflip-modeset-hang-oldfb)
[455.276304] Starting subtest: extended-pageflip-modeset-hang-oldfb
[455.297806] Starting dynamic subtest: pipe-A
[459.232395] Dynamic subtest pipe-A: SUCCESS (3.849s)
[459.287292] Starting dynamic subtest: pipe-C
[463.194708] Dynamic subtest pipe-C: SUCCESS (3.950s)
[463.216050] Subtest extended-pageflip-modeset-hang-oldfb: SUCCESS (7.812s)
[463.482649] [101/141] (674s left) syncobj_wait (multi-wait-for-submit-unsubmitted-signaled)
[463.761228] Starting subtest: multi-wait-for-submit-unsubmitted-signaled
[463.782636] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.001s)
[463.898192] [102/141] (673s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[464.264637] Starting subtest: compare-crc-sanitycheck-nv12
[464.283349] Starting dynamic subtest: pipe-A-DP-1
[464.323587] Dynamic subtest pipe-A-DP-1: SKIP (0.001s)
[464.366608] Starting dynamic subtest: pipe-B-DP-1
[464.407589] Dynamic subtest pipe-B-DP-1: SKIP (0.001s)
[464.446897] Starting dynamic subtest: pipe-C-DP-1
[464.483734] Dynamic subtest pipe-C-DP-1: SKIP (0.001s)
[464.523095] Subtest compare-crc-sanitycheck-nv12: SKIP (0.020s)
[464.642116] [103/141] (673s left) kms_atomic (plane-overlay-legacy)
[465.125944] Starting subtest: plane-overlay-legacy
[465.263396] Subtest plane-overlay-legacy: SUCCESS (0.128s)
[465.741630] [104/141] (672s left) gem_wait (invalid-flags)
[466.034783] Starting subtest: invalid-flags
[466.053381] Subtest invalid-flags: SUCCESS (0.000s)
[466.344079] [105/141] (671s left) gem_ppgtt (blt-vs-render-ctx0)
[466.642814] Starting subtest: blt-vs-render-ctx0
[500.434774] Subtest blt-vs-render-ctx0: SUCCESS (33.818s)
[500.595976] [106/141] (637s left) syncobj_timeline (reset-during-wait-for-submit)
[501.055087] Starting subtest: reset-during-wait-for-submit
[501.167440] Subtest reset-during-wait-for-submit: SUCCESS (0.107s)
[501.290502] [107/141] (636s left) i915_pm_rpm (sysfs-read)
[503.347326] Starting subtest: sysfs-read
[503.776693] Subtest sysfs-read: SUCCESS (0.408s)
[504.281057] [108/141] (633s left) sysfs_preempt_timeout (invalid)
[504.577963] Starting subtest: invalid
[504.600056] Starting dynamic subtest: vecs0
[504.621087] Dynamic subtest vecs0: SUCCESS (0.001s)
[504.664316] Starting dynamic subtest: vcs0
[504.682825] Dynamic subtest vcs0: SUCCESS (0.001s)
[504.723156] Starting dynamic subtest: bcs0
[504.742044] Dynamic subtest bcs0: SUCCESS (0.001s)
[504.782622] Starting dynamic subtest: rcs0
[504.803752] Dynamic subtest rcs0: SUCCESS (0.001s)
[504.824765] Subtest invalid: SUCCESS (0.019s)
[504.938745] [109/141] (633s left) api_intel_bb (simple-bb-ctx)
[505.243036] Starting subtest: simple-bb-ctx
[505.261784] Subtest simple-bb-ctx: SUCCESS (0.015s)
[505.397264] [110/141] (633s left) kms_plane_scaling (plane-downscale-with-pixel-format-factor-0-75)
[505.777546] Starting subtest: plane-downscale-with-pixel-format-factor-0-75
[505.798367] Starting dynamic subtest: pipe-A-DP-1
[508.157586] Dynamic subtest pipe-A-DP-1: SUCCESS (2.396s)
[508.226634] Starting dynamic subtest: pipe-B-DP-1
[510.809069] Dynamic subtest pipe-B-DP-1: SUCCESS (2.630s)
[510.851050] Starting dynamic subtest: pipe-C-DP-1
[511.202102] Dynamic subtest pipe-C-DP-1: SUCCESS (0.379s)
[511.228297] Subtest plane-downscale-with-pixel-format-factor-0-75: SUCCESS (5.422s)
[511.638721] [111/141] (626s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-pwrite)
[512.094005] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-pwrite
[514.094669] Subtest fbc-1p-primscrn-cur-indfb-draw-pwrite: SUCCESS (2.075s)
[514.252928] [112/141] (624s left) kms_vblank (pipe-d-query-idle)
[514.669164] Subtest pipe-D-query-idle: SKIP (0.000s)
[514.861783] [113/141] (623s left) gem_spin_batch (spin-all)
[515.157757] Starting subtest: spin-all
[515.179735] Subtest spin-all: SUCCESS (0.027s)
[515.464551] [114/141] (623s left) kms_vblank (pipe-b-wait-busy)
[515.827958] Starting subtest: pipe-B-wait-busy
[518.695299] Subtest pipe-B-wait-busy: SUCCESS (2.863s)
[519.057282] [115/141] (619s left) kms_ccs (pipe-c-random-ccs-data-yf_tiled_ccs)
[519.756048] Starting subtest: pipe-C-random-ccs-data-yf_tiled_ccs
[519.819490] Subtest pipe-C-random-ccs-data-yf_tiled_ccs: SKIP (0.000s)
[520.163323] [116/141] (618s left) kms_addfb_basic (unused-offsets)
[520.463390] Starting subtest: unused-offsets
[520.482296] Subtest unused-offsets: SUCCESS (0.000s)
[520.679458] [117/141] (618s left) gem_partial_pwrite_pread (write-snoop)
[520.984683] Starting subtest: write-snoop
[535.130943] Subtest write-snoop: SUCCESS (14.152s)
[535.263310] [118/141] (604s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-render)
[535.720418] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-render
[535.760137] Subtest fbcpsr-1p-offscren-pri-indfb-draw-render: SKIP (0.000s)
[535.879915] [119/141] (603s left) kms_chamelium_color (ctm-green-to-red)
[536.260449] Subtest ctm-green-to-red: SKIP (0.000s)
[536.379186] [120/141] (603s left) gem_exec_fence (parallel)
[536.837361] Starting subtest: parallel
[536.857421] Starting dynamic subtest: rcs0
[539.138729] Dynamic subtest rcs0: SUCCESS (2.153s)
[539.183957] Starting dynamic subtest: bcs0
[541.121251] Dynamic subtest bcs0: SUCCESS (2.152s)
[541.167846] Starting dynamic subtest: vcs0
[543.444919] Dynamic subtest vcs0: SUCCESS (2.149s)
[543.487401] Starting dynamic subtest: vecs0
[545.426418] Dynamic subtest vecs0: SUCCESS (2.151s)
[545.447478] Subtest parallel: SUCCESS (8.616s)
[546.129608] [121/141] (593s left) feature_discovery (display-2x)
[546.495631] Starting subtest: display-2x
[546.534136] Subtest display-2x: SKIP (0.000s)
[546.656292] [122/141] (593s left) kms_psr (psr2_cursor_blt)
[546.974584] Subtest psr2_cursor_blt: SKIP (0.000s)
[547.067429] [123/141] (592s left) prime_vgem (basic-gtt)
[547.386165] Starting subtest: basic-gtt
[547.405298] Subtest basic-gtt: SUCCESS (0.031s)
[547.547491] [124/141] (592s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-upscaling)
[547.927899] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-upscaling
[547.947018] Starting dynamic subtest: pipe-A-valid-mode
[548.369884] Dynamic subtest pipe-A-valid-mode: SKIP (0.420s)
[548.413182] Subtest flip-64bpp-ytile-to-32bpp-ytile-upscaling: SKIP (0.424s)
[548.761090] [125/141] (591s left) gem_mmap_wc (read)
[549.072633] Starting subtest: read
[549.163403] Subtest read: SUCCESS (0.133s)
[549.331013] [126/141] (590s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[549.699916] Starting subtest: addfb25-yf-tiled-legacy
[549.724544] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[549.889418] [127/141] (590s left) kms_frontbuffer_tracking (fbc-rgb565-draw-pwrite)
[550.369035] Starting subtest: fbc-rgb565-draw-pwrite
[552.640914] Subtest fbc-rgb565-draw-pwrite: SUCCESS (2.377s)
[552.810446] [128/141] (587s left) syncobj_timeline (invalid-signal-illegal-point)
[553.136981] Starting subtest: invalid-signal-illegal-point
[553.166364] Subtest invalid-signal-illegal-point: SUCCESS (0.000s)
[553.280471] [129/141] (587s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[553.682707] Starting subtest: cursor-rapid-movement-512x512
[553.725539] Subtest cursor-rapid-movement-512x512: SKIP (0.003s)
[553.841405] [130/141] (586s left) vc4/vc4_perfmon (create-single-perfmon)
[554.211516] Subtest create-single-perfmon: SKIP (0.000s)
[554.314100] [131/141] (586s left) gem_exec_schedule (semaphore-noskip)
[554.769299] Starting subtest: semaphore-noskip
[554.863712] Subtest semaphore-noskip: SUCCESS (0.247s)
[555.256733] [132/141] (585s left) gem_readwrite (new-obj)
[555.533797] Starting subtest: new-obj
[555.571267] Subtest new-obj: SUCCESS (0.000s)
[555.667030] [133/141] (585s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-fullscreen)
[556.070414] Starting subtest: psr-1p-primscrn-spr-indfb-fullscreen
[556.108255] Subtest psr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[556.231307] [134/141] (584s left) gem_exec_params (invalid-flag)
[556.528785] Starting subtest: invalid-flag
[556.549931] Subtest invalid-flag: SUCCESS (0.001s)
[556.657184] [135/141] (584s left) gem_exec_whisper (basic-contexts-priority)
[556.980130] Starting subtest: basic-contexts-priority
[572.388861] Subtest basic-contexts-priority: SUCCESS (15.437s)
[572.606758] [136/141] (568s left) syncobj_basic (bad-destroy-pad)
[572.904169] Starting subtest: bad-destroy-pad
[572.922671] Subtest bad-destroy-pad: SUCCESS (0.000s)
[573.022497] [137/141] (568s left) gem_exec_schedule (preempt-other)
[573.475981] Starting subtest: preempt-other
[573.497492] Starting dynamic subtest: rcs0
[573.518717] Dynamic subtest rcs0: SUCCESS (0.073s)
[573.568860] Starting dynamic subtest: bcs0
[573.589447] Dynamic subtest bcs0: SUCCESS (0.079s)
[573.631466] Starting dynamic subtest: vcs0
[573.650286] Dynamic subtest vcs0: SUCCESS (0.071s)
[573.691336] Starting dynamic subtest: vecs0
[573.711270] Dynamic subtest vecs0: SUCCESS (0.074s)
[573.732763] Subtest preempt-other: SUCCESS (0.310s)
[573.991034] [138/141] (567s left) gem_render_copy_redux (flink)
[574.295492] Starting subtest: flink
[579.045419] Subtest flink: SUCCESS (4.759s)
[579.191676] [139/141] (562s left) syncobj_timeline (etime-single-wait-for-submit-available-unsubmitted)
[579.485754] Starting subtest: etime-single-wait-for-submit-available-unsubmitted
[579.559254] Subtest etime-single-wait-for-submit-available-unsubmitted: SUCCESS (0.107s)
[579.676940] [140/141] (561s left) kms_universal_plane (universal-plane-pipe-c-functional)
[580.027999] Starting subtest: universal-plane-pipe-C-functional
[583.018759] Subtest universal-plane-pipe-C-functional: SUCCESS (2.994s)
[583.394491] [141/141] (558s left) kms_ccs (pipe-a-bad-rotation-90-y_tiled_gen12_rc_ccs_cc)
[583.858916] Starting subtest: pipe-A-bad-rotation-90-y_tiled_gen12_rc_ccs_cc
[583.898347] Subtest pipe-A-bad-rotation-90-y_tiled_gen12_rc_ccs_cc: SKIP (0.000s)
[584.445043] Closing watchdogs
Done.