[63.599290] Initializing watchdogs
[63.599355]   /dev/watchdog0
[63.619389] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[63.630790] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[63.634592] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[63.637131] [001/134] (960s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-20x20)
[63.822442] Starting subtest: planes-downscale-factor-0-75-upscale-20x20
[63.823288] Starting dynamic subtest: pipe-A
[63.929255] Dynamic subtest pipe-A: SUCCESS (0.107s)
[63.940383] Starting dynamic subtest: pipe-B
[64.126582] Dynamic subtest pipe-B: SUCCESS (0.197s)
[64.134664] Starting dynamic subtest: pipe-C
[64.322065] Dynamic subtest pipe-C: SUCCESS (0.195s)
[64.334751] Starting dynamic subtest: pipe-D
[64.574010] Dynamic subtest pipe-D: SUCCESS (0.252s)
[64.574879] Subtest planes-downscale-factor-0-75-upscale-20x20: SUCCESS (0.752s)
[64.927702] [002/134] (959s left) gem_userptr_blits (forbidden-operations)
[65.018194] Starting subtest: forbidden-operations
[65.019940] Subtest forbidden-operations: SKIP (0.000s)
[65.193552] [003/134] (959s left) gem_mmap_gtt (big-bo)
[65.270996] Subtest big-bo: SKIP (0.000s)
[65.343799] [004/134] (958s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[65.523389] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[65.525039] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[65.686575] [005/134] (958s left) kms_fence_pin_leak
[65.924978] [006/134] (958s left) kms_big_fb (x-tiled-16bpp-rotate-180)
[66.122577] Starting subtest: x-tiled-16bpp-rotate-180
[67.969708] Subtest x-tiled-16bpp-rotate-180: SUCCESS (1.848s)
[68.151622] [007/134] (956s left) gem_mmap_wc (write-cpu-read-wc-unflushed)
[68.220139] Subtest write-cpu-read-wc-unflushed: SKIP (0.000s)
[68.293246] [008/134] (956s left) kms_flip (2x-flip-vs-expired-vblank-interruptible)
[68.475916] Starting subtest: 2x-flip-vs-expired-vblank-interruptible
[68.490448] Subtest 2x-flip-vs-expired-vblank-interruptible: SKIP (0.015s)
[68.655455] [009/134] (955s left) perf_pmu (busy-check-all)
[68.716920] Starting subtest: busy-check-all
[68.717898] Starting dynamic subtest: rcs0
[69.306395] Dynamic subtest rcs0: SUCCESS (0.589s)
[69.317810] Starting dynamic subtest: bcs0
[69.860206] Dynamic subtest bcs0: SUCCESS (0.553s)
[69.872077] Starting dynamic subtest: vcs0
[70.415378] Dynamic subtest vcs0: SUCCESS (0.554s)
[70.427354] Starting dynamic subtest: vcs1
[70.969822] Dynamic subtest vcs1: SUCCESS (0.553s)
[70.981363] Starting dynamic subtest: vecs0
[71.525178] Dynamic subtest vecs0: SUCCESS (0.554s)
[71.537174] Starting dynamic subtest: vecs1
[72.081511] Dynamic subtest vecs1: SUCCESS (0.555s)
[72.093200] Starting dynamic subtest: ccs0
[72.636586] Dynamic subtest ccs0: SUCCESS (0.554s)
[72.638298] Subtest busy-check-all: SUCCESS (3.920s)
[72.812949] [010/134] (951s left) gem_mmap_wc (coherency)
[72.881091] Subtest coherency: SKIP (0.000s)
[72.941298] [011/134] (951s left) kms_big_fb (yf-tiled-addfb)
[73.133557] Starting subtest: yf-tiled-addfb
[73.135260] Subtest yf-tiled-addfb: SKIP (0.000s)
[73.333093] [012/134] (951s left) kms_busy (extended-modeset-hang-oldfb-with-reset)
[73.527865] Starting subtest: extended-modeset-hang-oldfb-with-reset
[73.528748] Starting dynamic subtest: pipe-A
[84.372121] Dynamic subtest pipe-A: SUCCESS (10.843s)
[84.392267] Starting dynamic subtest: pipe-D
[95.068243] Dynamic subtest pipe-D: SUCCESS (10.690s)
[95.070855] Subtest extended-modeset-hang-oldfb-with-reset: SUCCESS (21.541s)
[95.385459] [013/134] (929s left) kms_plane_alpha_blend (constant-alpha-min)
[95.563346] Starting subtest: constant-alpha-min
[95.832804] Starting dynamic subtest: pipe-A-DP-3
[96.515556] Dynamic subtest pipe-A-DP-3: SUCCESS (0.683s)
[96.529370] Starting dynamic subtest: pipe-D-DP-3
[97.256158] Dynamic subtest pipe-D-DP-3: SUCCESS (0.738s)
[97.257007] Subtest constant-alpha-min: SUCCESS (1.693s)
[97.523971] [014/134] (927s left) sysfs_timeslice_duration (duration)
[97.599593] Starting subtest: duration
[97.600499] Starting dynamic subtest: vecs0
[110.781825] Dynamic subtest vecs0: SUCCESS (13.181s)
[110.794159] Starting dynamic subtest: ccs0
[123.934730] Dynamic subtest ccs0: SUCCESS (13.152s)
[123.947138] Starting dynamic subtest: vcs0
[137.078668] Dynamic subtest vcs0: SUCCESS (13.143s)
[137.091327] Starting dynamic subtest: bcs0
[150.228903] Dynamic subtest bcs0: SUCCESS (13.147s)
[150.240707] Starting dynamic subtest: vecs1
[163.388751] Dynamic subtest vecs1: SUCCESS (13.157s)
[163.400126] Starting dynamic subtest: rcs0
[176.531636] Dynamic subtest rcs0: SUCCESS (13.140s)
[176.543664] Starting dynamic subtest: vcs1
[189.686671] Dynamic subtest vcs1: SUCCESS (13.153s)
[189.688410] Subtest duration: SUCCESS (92.082s)
[189.830737] [015/134] (835s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-cpu)
[190.014532] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-cpu
[192.754957] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (2.741s)
[192.963663] [016/134] (832s left) kms_cursor_crc (cursor-onscreen-64x64)
[193.285756] Starting subtest: cursor-onscreen-64x64
[193.290237] Starting dynamic subtest: pipe-A-DP-3
[195.846822] Dynamic subtest pipe-A-DP-3: SUCCESS (2.557s)
[195.883203] Starting dynamic subtest: pipe-D-DP-3
[198.525508] Dynamic subtest pipe-D-DP-3: SUCCESS (2.651s)
[198.526402] Subtest cursor-onscreen-64x64: SUCCESS (5.239s)
[198.997683] [017/134] (826s left) kms_color (ctm-red-to-blue)
[199.174765] Starting subtest: ctm-red-to-blue
[199.175618] Starting dynamic subtest: pipe-A-DP-3
[199.877198] Dynamic subtest pipe-A-DP-3: SUCCESS (0.700s)
[199.899642] Starting dynamic subtest: pipe-B-DP-3
[200.456507] Dynamic subtest pipe-B-DP-3: SUCCESS (0.580s)
[200.472197] Starting dynamic subtest: pipe-C-DP-3
[201.051599] Dynamic subtest pipe-C-DP-3: SUCCESS (0.594s)
[201.067236] Starting dynamic subtest: pipe-D-DP-3
[201.653460] Dynamic subtest pipe-D-DP-3: SUCCESS (0.596s)
[201.654688] Subtest ctm-red-to-blue: SUCCESS (2.473s)
[201.967137] [018/134] (823s left) gem_partial_pwrite_pread (writes-after-reads-uncached)
[202.049312] Subtest writes-after-reads-uncached: SKIP (0.000s)
[202.110817] [019/134] (823s left) dumb_buffer (invalid-bpp)
[202.183440] Starting subtest: invalid-bpp
[202.184370] Subtest invalid-bpp: SUCCESS (0.000s)
[202.348535] [020/134] (822s left) gem_mmap_gtt (ptrace)
[202.426100] Subtest ptrace: SKIP (0.000s)
[202.541174] [021/134] (822s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions-varying-s
[202.730845] Starting subtest: short-busy-flip-before-cursor-atomic-transitions-varying-size
[202.732560] Subtest short-busy-flip-before-cursor-atomic-transitions-varying-size: SKIP (0.000s)
[202.881369] [022/134] (822s left) gem_lmem_swapping (verify)
[205.558145] Starting subtest: verify
[205.559053] Starting dynamic subtest: lmem0
[241.486432] Dynamic subtest lmem0: SUCCESS (35.928s)
[241.487507] Subtest verify: SUCCESS (35.928s)
[243.612847] [FACT gem_lmem_swapping (verify)] deleted: kernel.kmod_is_loaded.i915: true
[243.614568] [023/134] (781s left) gem_spin_batch (resubmit-new)
[245.152649] Starting subtest: resubmit-new
[245.153599] Starting dynamic subtest: rcs0
[245.201621] Dynamic subtest rcs0: SUCCESS (0.048s)
[245.211717] Starting dynamic subtest: bcs0
[245.212562] Dynamic subtest bcs0: SUCCESS (0.006s)
[245.222157] Starting dynamic subtest: vcs0
[245.223035] Dynamic subtest vcs0: SUCCESS (0.007s)
[245.232640] Starting dynamic subtest: vcs1
[245.233502] Dynamic subtest vcs1: SUCCESS (0.006s)
[245.242537] Starting dynamic subtest: vecs0
[245.243423] Dynamic subtest vecs0: SUCCESS (0.005s)
[245.252559] Starting dynamic subtest: vecs1
[245.253659] Dynamic subtest vecs1: SUCCESS (0.005s)
[245.262946] Starting dynamic subtest: ccs0
[245.264151] Dynamic subtest ccs0: SUCCESS (0.004s)
[245.265195] Subtest resubmit-new: SUCCESS (0.084s)
[245.524921] [FACT gem_spin_batch (resubmit-new)] new: kernel.kmod_is_loaded.i915: true
[245.527831] [024/134] (779s left) kms_cursor_crc (cursor-random-512x512)
[245.982296] Starting subtest: cursor-random-512x512
[245.984145] Subtest cursor-random-512x512: SKIP (0.001s)
[246.251901] [025/134] (779s left) kms_properties (plane-properties-legacy)
[246.428760] Starting subtest: plane-properties-legacy
[246.429599] Starting dynamic subtest: pipe-A-DP-3
[246.936117] Dynamic subtest pipe-A-DP-3: SUCCESS (0.506s)
[246.952406] Starting dynamic subtest: pipe-B-DP-3
[247.459578] Dynamic subtest pipe-B-DP-3: SUCCESS (0.522s)
[247.469418] Starting dynamic subtest: pipe-C-DP-3
[247.978404] Dynamic subtest pipe-C-DP-3: SUCCESS (0.518s)
[247.988162] Starting dynamic subtest: pipe-D-DP-3
[248.493406] Dynamic subtest pipe-D-DP-3: SUCCESS (0.514s)
[248.494261] Subtest plane-properties-legacy: SUCCESS (2.064s)
[248.787859] [026/134] (776s left) kms_vrr (flipline)
[248.965598] Starting subtest: flipline
[248.968228] Subtest flipline: SKIP (0.000s)
[249.114489] [027/134] (776s left) gem_exec_params (secure-non-master)
[249.189989] Starting subtest: secure-non-master
[249.191961] Subtest secure-non-master: SKIP (0.000s)
[249.400722] [028/134] (776s left) gem_exec_balancer (parallel-dmabuf-import-out-fence)
[249.742886] Starting subtest: parallel-dmabuf-import-out-fence
[252.102063] Subtest parallel-dmabuf-import-out-fence: SUCCESS (2.359s)
[252.263030] [029/134] (773s left) kms_pm_dc (dc5-dpms-negative)
[253.455081] Starting subtest: dc5-dpms-negative
[257.682183] Subtest dc5-dpms-negative: SUCCESS (4.226s)
[257.867382] [030/134] (768s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[258.049554] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[258.051241] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[258.251815] [031/134] (767s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite)
[258.437566] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite
[258.439288] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[258.634653] [032/134] (767s left) kms_frontbuffer_tracking (psr-argb161616f-draw-mmap-cpu)
[258.816566] Starting subtest: psr-argb161616f-draw-mmap-cpu
[258.818226] Subtest psr-argb161616f-draw-mmap-cpu: SKIP (0.000s)
[259.017854] [033/134] (767s left) gem_exec_whisper (basic-fds-all)
[259.101232] Starting subtest: basic-fds-all
[281.262020] Subtest basic-fds-all: SUCCESS (22.159s)
[281.540278] [034/134] (744s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[281.734426] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[281.736147] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[281.930172] [035/134] (744s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[282.112730] Starting subtest: psr-rgb565-draw-render
[282.114410] Subtest psr-rgb565-draw-render: SKIP (0.000s)
[282.299672] [036/134] (744s left) gem_render_copy_redux (flink)
[282.392153] Starting subtest: flink
[285.101037] Subtest flink: SUCCESS (2.709s)
[285.341618] [037/134] (741s left) gem_mmap_wc (bad-offset)
[285.412149] Subtest bad-offset: SKIP (0.000s)
[285.496453] [038/134] (741s left) gem_pxp (reject-modify-context-protection-off-2)
[288.093577] Starting subtest: reject-modify-context-protection-off-2
[288.095594] Subtest reject-modify-context-protection-off-2: SKIP (0.000s)
[288.234094] [039/134] (738s left) kms_3d (basic)
[288.302048] Starting subtest: basic
[290.305268] Subtest basic: SUCCESS (2.002s)
[290.732972] [040/134] (735s left) gem_ctx_persistence (smoketest)
[290.812529] Starting subtest: smoketest
[329.615297] Subtest smoketest: SUCCESS (38.803s)
[329.784483] [041/134] (696s left) kms_psr (fbc-pr-suspend)
[329.962563] Subtest fbc-pr-suspend: SKIP (0.000s)
[330.028545] [042/134] (696s left) syncobj_timeline (multi-wait-for-submit-signaled)
[330.094446] Starting subtest: multi-wait-for-submit-signaled
[330.095331] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[330.238557] [043/134] (696s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-upscaling)
[330.418121] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-upscaling
[330.419053] Starting dynamic subtest: pipe-A-valid-mode
[332.174266] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.753s)
[332.175721] Subtest flip-64bpp-4tile-to-32bpp-4tile-upscaling: SUCCESS (1.756s)
[332.481637] [044/134] (694s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling)
[332.659543] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-upscaling
[332.662057] Starting dynamic subtest: pipe-A-valid-mode
[335.147897] Dynamic subtest pipe-A-valid-mode: SUCCESS (2.485s)
[335.149466] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SUCCESS (2.488s)
[335.483829] [045/134] (691s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-cpu)
[335.660732] Starting subtest: psr-rgb565-draw-mmap-cpu
[335.662295] Subtest psr-rgb565-draw-mmap-cpu: SKIP (0.000s)
[335.859175] [046/134] (691s left) vgem_basic (mmap)
[335.961030] Starting subtest: mmap
[335.966692] Subtest mmap: SUCCESS (0.007s)
[336.091639] [FACT vgem_basic (mmap)] new: kernel.kmod_is_loaded.vgem: true
[336.093895] [047/134] (691s left) gem_userptr_blits (sync-unmap-after-close)
[336.192168] Starting subtest: sync-unmap-after-close
[336.211972] Subtest sync-unmap-after-close: SUCCESS (0.021s)
[336.408229] [048/134] (690s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode)
[336.668831] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s)
[336.813937] [049/134] (690s left) kms_frontbuffer_tracking (basic)
[337.007899] Starting subtest: basic
[339.725089] Subtest basic: SUCCESS (2.717s)
[339.975312] [050/134] (687s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[340.165022] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[340.166697] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[340.356108] [051/134] (687s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-blt)
[340.545882] Starting subtest: fbc-rgb101010-draw-blt
[343.425295] Subtest fbc-rgb101010-draw-blt: SUCCESS (2.880s)
[343.658976] [052/134] (683s left) kms_lease (lease-unleased-connector)
[343.845159] Starting subtest: lease-unleased-connector
[343.846052] Starting dynamic subtest: pipe-A-DP-3
[343.949366] Dynamic subtest pipe-A-DP-3: SUCCESS (0.104s)
[343.961950] Starting dynamic subtest: pipe-B-DP-3
[344.055313] Dynamic subtest pipe-B-DP-3: SUCCESS (0.104s)
[344.068120] Starting dynamic subtest: pipe-C-DP-3
[344.159729] Dynamic subtest pipe-C-DP-3: SUCCESS (0.103s)
[344.172339] Starting dynamic subtest: pipe-D-DP-3
[344.265066] Dynamic subtest pipe-D-DP-3: SUCCESS (0.102s)
[344.265988] Subtest lease-unleased-connector: SUCCESS (0.420s)
[344.417469] [053/134] (683s left) gem_tiled_partial_pwrite_pread (reads)
[344.499946] Subtest reads: SKIP (0.000s)
[344.593213] [054/134] (683s left) kms_dp_link_training (uhbr-sst)
[344.779134] Starting subtest: uhbr-sst
[344.780901] Subtest uhbr-sst: SKIP (0.000s)
[344.948122] [055/134] (682s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[345.028299] Starting subtest: etime-multi-wait-all-submitted-signaled
[345.133389] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.104s)
[345.315728] [056/134] (682s left) kms_invalid_mode (overflow-vrefresh)
[345.503509] Starting subtest: overflow-vrefresh
[345.504388] Starting dynamic subtest: pipe-A-DP-3
[345.584730] Dynamic subtest pipe-A-DP-3: SUCCESS (0.079s)
[345.599715] Starting dynamic subtest: pipe-B-DP-3
[345.600870] Dynamic subtest pipe-B-DP-3: SUCCESS (0.001s)
[345.615277] Starting dynamic subtest: pipe-C-DP-3
[345.616539] Dynamic subtest pipe-C-DP-3: SUCCESS (0.001s)
[345.629398] Starting dynamic subtest: pipe-D-DP-3
[345.630309] Dynamic subtest pipe-D-DP-3: SUCCESS (0.001s)
[345.631176] Subtest overflow-vrefresh: SUCCESS (0.090s)
[345.870434] [057/134] (682s left) kms_pm_rpm (i2c)
[348.078211] Starting subtest: i2c
[349.251754] Subtest i2c: SUCCESS (1.176s)
[349.557007] [058/134] (678s left) gem_exec_balancer (busy)
[349.647406] Starting subtest: busy
[350.570538] Subtest busy: SUCCESS (0.923s)
[351.014318] [059/134] (677s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-sf)
[351.205898] Subtest fbc-pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[351.258016] [060/134] (676s left) gen9_exec_parse (batch-without-end)
[351.348187] Subtest batch-without-end: SKIP (0.000s)
[351.425414] [061/134] (676s left) gem_ctx_shared (exec-shared-gtt)
[351.528360] Starting subtest: exec-shared-gtt
[351.529335] Starting dynamic subtest: rcs0
[351.540498] Dynamic subtest rcs0: SUCCESS (0.012s)
[351.553172] Starting dynamic subtest: bcs0
[351.554108] Dynamic subtest bcs0: SUCCESS (0.007s)
[351.565453] Starting dynamic subtest: vcs0
[351.566362] Dynamic subtest vcs0: SUCCESS (0.007s)
[351.577501] Starting dynamic subtest: vcs1
[351.578399] Dynamic subtest vcs1: SUCCESS (0.008s)
[351.590025] Starting dynamic subtest: vecs0
[351.590945] Dynamic subtest vecs0: SUCCESS (0.007s)
[351.602502] Starting dynamic subtest: vecs1
[351.603530] Dynamic subtest vecs1: SUCCESS (0.006s)
[351.614835] Starting dynamic subtest: ccs0
[351.615719] Dynamic subtest ccs0: SUCCESS (0.007s)
[351.616871] Subtest exec-shared-gtt: SUCCESS (0.061s)
[351.880848] [062/134] (676s left) perf (invalid-oa-metric-set-id)
[352.294318] Starting subtest: invalid-oa-metric-set-id
[352.311970] Subtest invalid-oa-metric-set-id: SUCCESS (0.019s)
[352.377762] [063/134] (675s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-signaled)
[352.459557] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[352.460484] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[352.661548] [064/134] (675s left) gem_tiled_pread_pwrite
[352.814364] [065/134] (675s left) i915_pm_rps (thresholds-park)
[352.900570] Starting subtest: thresholds-park
[352.902361] Subtest thresholds-park: SKIP (0.000s)
[353.081782] [066/134] (675s left) gem_ctx_engines (invalid-engines)
[353.175201] Starting subtest: invalid-engines
[353.210960] Subtest invalid-engines: SUCCESS (0.036s)
[353.531730] [067/134] (675s left) vgem_basic (create)
[353.600621] Starting subtest: create
[353.601816] Subtest create: SUCCESS (0.000s)
[353.765969] [068/134] (674s left) kms_psr (fbc-psr2-sprite-mmap-cpu)
[353.951152] Subtest fbc-psr2-sprite-mmap-cpu: SKIP (0.000s)
[354.034263] [069/134] (674s left) gem_mmap_gtt (big-copy-odd)
[354.117233] Subtest big-copy-odd: SKIP (0.000s)
[354.191436] [070/134] (674s left) gem_exec_reloc (basic-gtt-cpu-active)
[354.276836] Subtest basic-gtt-cpu-active: SKIP (0.000s)
[354.359030] [071/134] (674s left) prime_busy (before-wait)
[354.445300] Starting subtest: before-wait
[354.450390] Starting dynamic subtest: rcs0
[354.503529] Dynamic subtest rcs0: SUCCESS (0.053s)
[354.515298] Starting dynamic subtest: bcs0
[354.567565] Dynamic subtest bcs0: SUCCESS (0.063s)
[354.597074] Starting dynamic subtest: vcs0
[354.610709] Dynamic subtest vcs0: SUCCESS (0.041s)
[354.639831] Starting dynamic subtest: vcs1
[354.651492] Dynamic subtest vcs1: SUCCESS (0.039s)
[354.672563] Starting dynamic subtest: vecs0
[354.693478] Dynamic subtest vecs0: SUCCESS (0.040s)
[354.714243] Starting dynamic subtest: vecs1
[354.734603] Dynamic subtest vecs1: SUCCESS (0.040s)
[354.755555] Starting dynamic subtest: ccs0
[354.776875] Dynamic subtest ccs0: SUCCESS (0.041s)
[354.899834] Subtest before-wait: SUCCESS (0.445s)
[355.115862] [072/134] (673s left) gem_exec_fence (keep-in-fence)
[355.326129] Starting subtest: keep-in-fence
[355.327054] Starting dynamic subtest: rcs0
[355.414395] Dynamic subtest rcs0: SUCCESS (0.094s)
[355.438182] Starting dynamic subtest: bcs0
[355.472091] Dynamic subtest bcs0: SUCCESS (0.056s)
[355.489156] Starting dynamic subtest: vcs0
[355.529308] Dynamic subtest vcs0: SUCCESS (0.055s)
[355.549859] Starting dynamic subtest: vcs1
[355.587744] Dynamic subtest vcs1: SUCCESS (0.057s)
[355.620128] Starting dynamic subtest: vecs0
[355.651598] Dynamic subtest vecs0: SUCCESS (0.062s)
[355.680558] Starting dynamic subtest: vecs1
[355.714879] Dynamic subtest vecs1: SUCCESS (0.061s)
[355.741850] Starting dynamic subtest: ccs0
[355.943275] Dynamic subtest ccs0: SUCCESS (0.226s)
[355.944324] Subtest keep-in-fence: SUCCESS (0.624s)
[356.698150] [073/134] (672s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-blt)
[356.889055] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-blt
[359.664478] Subtest fbc-1p-primscrn-spr-indfb-draw-blt: SUCCESS (2.776s)
[359.928771] [074/134] (669s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[360.129338] Starting subtest: 4-tiled-8bpp-rotate-270
[360.181317] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.051s)
[360.385474] [075/134] (668s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf)
[360.584992] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[360.641807] [076/134] (668s left) gem_ccs (block-multicopy-inplace)
[360.729374] Starting subtest: block-multicopy-inplace
[360.731943] Starting dynamic subtest: linear-compressed-compfmt0-smem-lmem0-multicopy
[360.777282] Dynamic subtest linear-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.047s)
[360.788612] Starting dynamic subtest: linear-compressed-compfmt0-lmem0-lmem0-multicopy
[360.877517] Dynamic subtest linear-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.099s)
[360.890667] Starting dynamic subtest: xmajor-compressed-compfmt0-smem-lmem0-multicopy
[360.893169] Dynamic subtest xmajor-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.014s)
[360.904595] Starting dynamic subtest: xmajor-compressed-compfmt0-lmem0-lmem0-multicopy
[360.991555] Dynamic subtest xmajor-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.097s)
[361.004369] Starting dynamic subtest: tile4-compressed-compfmt0-smem-lmem0-multicopy
[361.007160] Dynamic subtest tile4-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.014s)
[361.019687] Starting dynamic subtest: tile4-compressed-compfmt0-lmem0-lmem0-multicopy
[361.113848] Dynamic subtest tile4-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.106s)
[361.127028] Starting dynamic subtest: tile64-compressed-compfmt0-smem-lmem0-multicopy
[361.129479] Dynamic subtest tile64-compressed-compfmt0-smem-lmem0-multicopy: SUCCESS (0.014s)
[361.141154] Starting dynamic subtest: tile64-compressed-compfmt0-lmem0-lmem0-multicopy
[361.228233] Dynamic subtest tile64-compressed-compfmt0-lmem0-lmem0-multicopy: SUCCESS (0.098s)
[361.229163] Subtest block-multicopy-inplace: SUCCESS (0.499s)
[361.449878] [077/134] (667s left) kms_big_fb (x-tiled-addfb-size-offset-overflow)
[361.645503] Starting subtest: x-tiled-addfb-size-offset-overflow
[361.647942] Subtest x-tiled-addfb-size-offset-overflow: SUCCESS (0.001s)
[361.865009] [078/134] (667s left) kms_atomic (crtc-invalid-params)
[362.051257] Starting subtest: crtc-invalid-params
[362.052199] Starting dynamic subtest: pipe-A-DP-3
[362.576287] Dynamic subtest pipe-A-DP-3: SUCCESS (0.523s)
[362.577338] Subtest crtc-invalid-params: SUCCESS (0.525s)
[362.908909] [079/134] (666s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[363.091775] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[363.094210] Starting dynamic subtest: pipe-A-DP-3
[363.102579] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[363.114037] Starting dynamic subtest: pipe-B-DP-3
[363.122294] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[363.133563] Starting dynamic subtest: pipe-C-DP-3
[363.141802] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[363.153145] Starting dynamic subtest: pipe-D-DP-3
[363.163480] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[363.165399] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SKIP (0.007s)
[363.555543] [080/134] (666s left) gem_lmem_swapping (heavy-verify-multi)
[366.187614] Starting subtest: heavy-verify-multi
[366.188512] Starting dynamic subtest: lmem0
[380.773990] Dynamic subtest lmem0: SUCCESS (14.591s)
[380.775053] Subtest heavy-verify-multi: SUCCESS (14.592s)
[381.965672] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[381.966686] [FACT gem_lmem_swapping (heavy-verify-multi)] deleted: kernel.kmod_is_loaded.i915: true
[381.968580] [081/134] (647s left) kms_chamelium_frames (hdmi-crc-fast)
[383.517118] Subtest hdmi-crc-fast: SKIP (0.000s)
[383.666545] [FACT kms_chamelium_frames (hdmi-crc-fast)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[383.668863] [FACT kms_chamelium_frames (hdmi-crc-fast)] new: kernel.kmod_is_loaded.i915: true
[383.671541] [082/134] (646s left) kms_vblank (query-forked-busy-hang)
[383.854405] Starting subtest: query-forked-busy-hang
[383.855273] Starting dynamic subtest: pipe-A-DP-3
[410.546963] Dynamic subtest pipe-A-DP-3: SUCCESS (26.691s)
[410.559809] Starting dynamic subtest: pipe-D-DP-3
[435.570186] Dynamic subtest pipe-D-DP-3: SUCCESS (25.018s)
[435.571166] Subtest query-forked-busy-hang: SUCCESS (51.715s)
[435.816563] [083/134] (593s left) kms_big_fb (linear-16bpp-rotate-90)
[436.014167] Starting subtest: linear-16bpp-rotate-90
[436.069412] Subtest linear-16bpp-rotate-90: SKIP (0.055s)
[436.314713] [084/134] (593s left) gem_flink_race (flink_close)
[436.363433] Starting subtest: flink_close
[441.448551] Subtest flink_close: SUCCESS (5.085s)
[441.636193] [085/134] (588s left) kms_frontbuffer_tracking (fbcpsr-modesetfrombusy)
[441.843048] Starting subtest: fbcpsr-modesetfrombusy
[441.844823] Subtest fbcpsr-modesetfrombusy: SKIP (0.000s)
[442.044674] [086/134] (588s left) gem_exec_schedule (thriceslice)
[442.140009] Starting subtest: thriceslice
[442.140966] Starting dynamic subtest: rcs0
[442.193115] Dynamic subtest rcs0: SUCCESS (0.053s)
[442.207936] Starting dynamic subtest: bcs0
[442.249479] Dynamic subtest bcs0: SUCCESS (0.055s)
[442.281463] Starting dynamic subtest: vcs0
[442.321699] Dynamic subtest vcs0: SUCCESS (0.069s)
[442.343394] Starting dynamic subtest: vcs1
[442.386372] Dynamic subtest vcs1: SUCCESS (0.062s)
[442.403818] Starting dynamic subtest: vecs0
[442.424424] Dynamic subtest vecs0: SUCCESS (0.036s)
[442.447225] Starting dynamic subtest: vecs1
[442.465837] Dynamic subtest vecs1: SUCCESS (0.039s)
[442.488146] Starting dynamic subtest: ccs0
[442.508418] Dynamic subtest ccs0: SUCCESS (0.040s)
[442.509517] Subtest thriceslice: SUCCESS (0.369s)
[442.932903] [087/134] (587s left) kms_flip (flip-vs-dpms-off-vs-modeset)
[443.120339] Starting subtest: flip-vs-dpms-off-vs-modeset
[443.125082] Starting dynamic subtest: A-DP3
[444.135660] Dynamic subtest A-DP3: SUCCESS (1.009s)
[444.149265] Starting dynamic subtest: B-DP3
[444.899220] Dynamic subtest B-DP3: SUCCESS (0.759s)
[444.918440] Starting dynamic subtest: C-DP3
[445.679362] Dynamic subtest C-DP3: SUCCESS (0.777s)
[445.699559] Starting dynamic subtest: D-DP3
[446.446675] Dynamic subtest D-DP3: SUCCESS (0.765s)
[446.449847] Subtest flip-vs-dpms-off-vs-modeset: SUCCESS (3.328s)
[446.815234] [088/134] (583s left) i915_pm_rps (min-max-config-idle)
[446.920248] Starting subtest: min-max-config-idle
[446.922184] Subtest min-max-config-idle: SKIP (0.001s)
[447.089465] [089/134] (583s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[447.285160] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[447.286913] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[447.489458] [090/134] (582s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-sf)
[447.684196] Subtest psr2-overlay-plane-move-continuous-sf: SKIP (0.000s)
[447.740697] [091/134] (582s left) kms_concurrent (multi-plane-atomic-lowres)
[447.932422] Starting subtest: multi-plane-atomic-lowres
[447.933280] Starting dynamic subtest: pipe-A-DP-3
[448.457648] Dynamic subtest pipe-A-DP-3: SUCCESS (0.522s)
[448.458905] Subtest multi-plane-atomic-lowres: SUCCESS (0.525s)
[448.817763] [092/134] (581s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[449.014817] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-gtt
[449.016652] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[449.217363] [093/134] (581s left) api_intel_allocator (reopen)
[449.294568] Starting subtest: reopen
[449.325210] Subtest reopen: SUCCESS (0.032s)
[449.496209] [094/134] (581s left) kms_flip (dpms-vs-vblank-race)
[449.689054] Starting subtest: dpms-vs-vblank-race
[449.693619] Starting dynamic subtest: A-DP3
[452.892164] Dynamic subtest A-DP3: SUCCESS (3.197s)
[452.914480] Starting dynamic subtest: B-DP3
[456.070982] Dynamic subtest B-DP3: SUCCESS (3.176s)
[456.083872] Starting dynamic subtest: C-DP3
[459.196310] Dynamic subtest C-DP3: SUCCESS (3.124s)
[459.206952] Starting dynamic subtest: D-DP3
[462.352232] Dynamic subtest D-DP3: SUCCESS (3.155s)
[462.354664] Subtest dpms-vs-vblank-race: SUCCESS (12.665s)
[462.657196] [095/134] (568s left) syncobj_timeline (single-wait-all-available-signaled)
[462.740663] Starting subtest: single-wait-all-available-signaled
[462.741525] Subtest single-wait-all-available-signaled: SUCCESS (0.000s)
[462.956761] [096/134] (567s left) kms_atomic_transition (plane-all-modeset-transition-fencing-internal-panels)
[463.146449] Starting subtest: plane-all-modeset-transition-fencing-internal-panels
[463.148201] Subtest plane-all-modeset-transition-fencing-internal-panels: SKIP (0.000s)
[463.307285] [097/134] (567s left) gem_exec_params (rs-invalid)
[463.396137] Starting subtest: rs-invalid
[463.399756] Subtest rs-invalid: SUCCESS (0.002s)
[463.622891] [098/134] (567s left) kms_scaling_modes (scaling-mode-full-aspect)
[463.812887] Starting subtest: scaling-mode-full-aspect
[463.817954] Subtest scaling-mode-full-aspect: SKIP (0.001s)
[463.984025] [099/134] (567s left) kms_plane (plane-panning-top-left)
[464.168273] Starting subtest: plane-panning-top-left
[464.169179] Starting dynamic subtest: pipe-A
[464.950555] Dynamic subtest pipe-A: SUCCESS (0.781s)
[464.964478] Starting dynamic subtest: pipe-B
[465.613052] Dynamic subtest pipe-B: SUCCESS (0.660s)
[465.613997] Subtest plane-panning-top-left: SUCCESS (1.445s)
[465.906801] [100/134] (565s left) kms_psr (psr2-sprite-mmap-cpu)
[466.094587] Subtest psr2-sprite-mmap-cpu: SKIP (0.000s)
[466.164391] [101/134] (565s left) gem_exec_params (rel-constants-invalid-ring)
[466.247286] Starting subtest: rel-constants-invalid-ring
[466.248222] Subtest rel-constants-invalid-ring: SUCCESS (0.000s)
[466.455215] [102/134] (564s left) i915_query (query-garbage)
[466.534596] Starting subtest: query-garbage
[466.535480] Subtest query-garbage: SUCCESS (0.000s)
[466.739550] [103/134] (564s left) kms_psr (psr-cursor-mmap-cpu)
[466.923833] Subtest psr-cursor-mmap-cpu: SKIP (0.000s)
[466.981732] [104/134] (564s left) kms_big_fb (y-tiled-16bpp-rotate-90)
[467.185388] Starting subtest: y-tiled-16bpp-rotate-90
[467.187176] Subtest y-tiled-16bpp-rotate-90: SKIP (0.000s)
[467.388048] [105/134] (564s left) kms_ccs (crc-primary-suspend-4-tiled-bmg-ccs)
[467.586287] Starting subtest: crc-primary-suspend-4-tiled-bmg-ccs
[467.588028] Subtest crc-primary-suspend-4-tiled-bmg-ccs: SKIP (0.000s)
[467.937092] [106/134] (563s left) kms_cursor_legacy (flip-vs-cursor-legacy)
[468.129273] Starting subtest: flip-vs-cursor-legacy
[478.219896] Subtest flip-vs-cursor-legacy: SUCCESS (10.090s)
[478.513994] [107/134] (553s left) kms_frontbuffer_tracking (fbcpsr-argb161616f-draw-blt)
[478.705991] Starting subtest: fbcpsr-argb161616f-draw-blt
[478.707700] Subtest fbcpsr-argb161616f-draw-blt: SKIP (0.000s)
[478.896741] [108/134] (553s left) kms_flip (flip-vs-fences)
[479.082187] Starting subtest: flip-vs-fences
[479.083954] Subtest flip-vs-fences: SKIP (0.000s)
[479.286664] [109/134] (552s left) gem_exec_reloc (basic-gtt-cpu-noreloc)
[479.371256] Subtest basic-gtt-cpu-noreloc: SKIP (0.000s)
[479.474079] [110/134] (552s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs-cc)
[479.663964] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs-cc
[479.666350] Starting dynamic subtest: pipe-A-DP-3
[479.674608] Dynamic subtest pipe-A-DP-3: SKIP (0.001s)
[479.684694] Starting dynamic subtest: pipe-B-DP-3
[479.692966] Dynamic subtest pipe-B-DP-3: SKIP (0.001s)
[479.703046] Starting dynamic subtest: pipe-C-DP-3
[479.711260] Dynamic subtest pipe-C-DP-3: SKIP (0.001s)
[479.721339] Starting dynamic subtest: pipe-D-DP-3
[479.731536] Dynamic subtest pipe-D-DP-3: SKIP (0.001s)
[479.733506] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs-cc: SKIP (0.009s)
[480.145673] [111/134] (551s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-gtt)
[480.337446] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-gtt
[480.339187] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[480.527920] [112/134] (551s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs)
[480.719307] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs
[480.720206] Starting dynamic subtest: pipe-A-DP-3
[480.729241] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[480.739596] Starting dynamic subtest: pipe-B-DP-3
[480.748888] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[480.759061] Starting dynamic subtest: pipe-C-DP-3
[480.768100] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[480.778483] Starting dynamic subtest: pipe-D-DP-3
[480.790535] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[480.792832] Subtest random-ccs-data-4-tiled-mtl-rc-ccs: SKIP (0.007s)
[481.207666] [113/134] (551s left) i915_drm_fdinfo (memory-info-shared)
[481.277887] Starting subtest: memory-info-shared
[481.278826] Starting dynamic subtest: lmem0
[481.364634] Dynamic subtest lmem0: SUCCESS (0.086s)
[481.377806] Starting dynamic subtest: smem0
[481.419405] Dynamic subtest smem0: SUCCESS (0.053s)
[481.420388] Subtest memory-info-shared: SUCCESS (0.142s)
[481.555360] [114/134] (550s left) gem_exec_flush (basic-wb-set-default)
[481.644060] Subtest basic-wb-set-default: SKIP (0.000s)
[481.718530] [115/134] (550s left) sysfs_timeslice_duration (timeout)
[481.806310] Starting subtest: timeout
[481.808496] Starting dynamic subtest: vecs0
[483.732170] Dynamic subtest vecs0: SUCCESS (1.924s)
[483.742978] Starting dynamic subtest: ccs0
[485.495225] Dynamic subtest ccs0: SUCCESS (1.762s)
[485.506563] Starting dynamic subtest: vcs0
[487.207359] Dynamic subtest vcs0: SUCCESS (1.711s)
[487.219405] Starting dynamic subtest: bcs0
[488.281107] Dynamic subtest bcs0: SUCCESS (1.072s)
[488.291984] Starting dynamic subtest: vecs1
[489.991289] Dynamic subtest vecs1: SUCCESS (1.709s)
[490.002582] Starting dynamic subtest: rcs0
[491.700237] Dynamic subtest rcs0: SUCCESS (1.708s)
[491.711131] Starting dynamic subtest: vcs1
[493.408057] Dynamic subtest vcs1: SUCCESS (1.707s)
[493.409126] Subtest timeout: SUCCESS (11.602s)
[493.575238] [116/134] (538s left) sriov_basic (enable-vfs-bind-unbind-each)
[493.662222] Subtest enable-vfs-bind-unbind-each: SKIP (0.000s)
[493.767197] [117/134] (538s left) kms_ccs (bad-rotation-90-4-tiled-lnl-ccs)
[493.954420] Starting subtest: bad-rotation-90-4-tiled-lnl-ccs
[493.956185] Subtest bad-rotation-90-4-tiled-lnl-ccs: SKIP (0.000s)
[494.284620] [118/134] (538s left) kms_getfb (getfb-handle-not-fb)
[494.468918] Starting subtest: getfb-handle-not-fb
[494.469832] Subtest getfb-handle-not-fb: SUCCESS (0.000s)
[494.690021] [119/134] (538s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-mc-ccs)
[494.777798] Starting subtest: y-tiled-ccs-to-yf-tiled-mc-ccs
[494.779897] Subtest y-tiled-ccs-to-yf-tiled-mc-ccs: SKIP (0.000s)
[495.056880] [120/134] (537s left) gem_workarounds (reset-context)
[495.154608] Starting subtest: reset-context
[495.373472] Subtest reset-context: SUCCESS (0.219s)
[495.571109] [121/134] (537s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[495.762920] Starting subtest: psr-farfromfence-mmap-gtt
[495.764569] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[495.957453] [122/134] (536s left) gem_wait (write-busy)
[496.050305] Starting subtest: write-busy
[496.051259] Starting dynamic subtest: all-engines
[496.652470] Dynamic subtest all-engines: SUCCESS (0.602s)
[496.667176] Starting dynamic subtest: rcs0
[497.200039] Dynamic subtest rcs0: SUCCESS (0.546s)
[497.211439] Starting dynamic subtest: bcs0
[497.742996] Dynamic subtest bcs0: SUCCESS (0.542s)
[497.754663] Starting dynamic subtest: vcs0
[498.286127] Dynamic subtest vcs0: SUCCESS (0.542s)
[498.298773] Starting dynamic subtest: vcs1
[498.828963] Dynamic subtest vcs1: SUCCESS (0.542s)
[498.840484] Starting dynamic subtest: vecs0
[499.372035] Dynamic subtest vecs0: SUCCESS (0.542s)
[499.384939] Starting dynamic subtest: vecs1
[499.913980] Dynamic subtest vecs1: SUCCESS (0.541s)
[499.925366] Starting dynamic subtest: ccs0
[500.456183] Dynamic subtest ccs0: SUCCESS (0.541s)
[500.457075] Subtest write-busy: SUCCESS (4.406s)
[500.758085] [123/134] (532s left) i915_hangman (detector)
[500.853129] Starting subtest: detector
[500.854121] Starting dynamic subtest: rcs0
[511.224388] Dynamic subtest rcs0: SUCCESS (10.371s)
[511.238268] Starting dynamic subtest: bcs0
[521.237776] Dynamic subtest bcs0: SUCCESS (10.012s)
[521.250656] Starting dynamic subtest: vcs0
[531.166112] Dynamic subtest vcs0: SUCCESS (9.927s)
[531.178988] Starting dynamic subtest: vcs1
[541.222376] Dynamic subtest vcs1: SUCCESS (10.055s)
[541.234110] Starting dynamic subtest: vecs0
[551.204533] Dynamic subtest vecs0: SUCCESS (9.981s)
[551.217565] Starting dynamic subtest: vecs1
[561.185346] Dynamic subtest vecs1: SUCCESS (9.980s)
[561.198462] Starting dynamic subtest: ccs0
[571.218867] Dynamic subtest ccs0: SUCCESS (10.032s)
[571.220022] Subtest detector: SUCCESS (70.367s)
[571.458805] [124/134] (461s left) kms_frontbuffer_tracking (fbcpsr-2p-pri-indfb-multidraw)
[571.652148] Starting subtest: fbcpsr-2p-pri-indfb-multidraw
[571.653911] Subtest fbcpsr-2p-pri-indfb-multidraw: SKIP (0.000s)
[571.858826] [125/134] (461s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions-varying-size)
[572.055300] Starting subtest: cursorA-vs-flipB-atomic-transitions-varying-size
[572.057058] Subtest cursorA-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s)
[572.203928] [126/134] (461s left) gem_mmap_gtt (basic-write-cpu-read-gtt)
[572.281160] Subtest basic-write-cpu-read-gtt: SKIP (0.000s)
[572.354965] [127/134] (460s left) gem_exec_schedule (noreorder-corked)
[572.571117] Starting subtest: noreorder-corked
[572.572140] Starting dynamic subtest: rcs0
[573.742604] Dynamic subtest rcs0: SUCCESS (1.171s)
[573.757403] Starting dynamic subtest: bcs0
[574.850381] Dynamic subtest bcs0: SUCCESS (1.106s)
[574.863061] Starting dynamic subtest: vcs0
[575.994393] Dynamic subtest vcs0: SUCCESS (1.143s)
[576.009369] Starting dynamic subtest: vcs1
[577.137483] Dynamic subtest vcs1: SUCCESS (1.142s)
[577.151140] Starting dynamic subtest: vecs0
[578.281438] Dynamic subtest vecs0: SUCCESS (1.143s)
[578.295824] Starting dynamic subtest: vecs1
[579.428407] Dynamic subtest vecs1: SUCCESS (1.146s)
[579.442361] Starting dynamic subtest: ccs0
[580.568379] Dynamic subtest ccs0: SUCCESS (1.138s)
[580.569262] Subtest noreorder-corked: SUCCESS (7.998s)
[580.832241] [128/134] (452s left) kms_psr (pr-cursor-mmap-cpu)
[581.018253] Subtest pr-cursor-mmap-cpu: SKIP (0.000s)
[581.072718] [129/134] (452s left) perf (invalid-oa-format-id)
[581.484233] Starting subtest: invalid-oa-format-id
[581.503180] Subtest invalid-oa-format-id: SUCCESS (0.019s)
[581.557674] [130/134] (451s left) gem_eio (in-flight-internal-immediate)
[581.818948] Starting subtest: in-flight-internal-immediate
[582.912455] Subtest in-flight-internal-immediate: SUCCESS (1.094s)
[583.174926] [131/134] (450s left) kms_cursor_edge_walk (256x256-top-edge)
[583.364307] Starting subtest: 256x256-top-edge
[583.365211] Starting dynamic subtest: pipe-A-DP-3
[586.845794] Dynamic subtest pipe-A-DP-3: SUCCESS (3.481s)
[586.863268] Starting dynamic subtest: pipe-D-DP-3
[590.155924] Dynamic subtest pipe-D-DP-3: SUCCESS (3.307s)
[590.156875] Subtest 256x256-top-edge: SUCCESS (6.792s)
[590.463851] [132/134] (443s left) gem_ctx_persistence (engines-persistence)
[590.573114] Starting subtest: engines-persistence
[590.574060] Starting dynamic subtest: rcs0
[591.438768] Dynamic subtest rcs0: SUCCESS (0.865s)
[591.454244] Starting dynamic subtest: bcs0
[592.257348] Dynamic subtest bcs0: SUCCESS (0.815s)
[592.272758] Starting dynamic subtest: vcs0
[593.022359] Dynamic subtest vcs0: SUCCESS (0.760s)
[593.037866] Starting dynamic subtest: vcs1
[593.790338] Dynamic subtest vcs1: SUCCESS (0.763s)
[593.805869] Starting dynamic subtest: vecs0
[594.558369] Dynamic subtest vecs0: SUCCESS (0.763s)
[594.573772] Starting dynamic subtest: vecs1
[595.327120] Dynamic subtest vecs1: SUCCESS (0.764s)
[595.342705] Starting dynamic subtest: ccs0
[596.087097] Dynamic subtest ccs0: SUCCESS (0.755s)
[596.092137] Subtest engines-persistence: SUCCESS (5.516s)
[596.308022] [133/134] (437s left) api_intel_bb (render-ccs)
[596.387569] Starting subtest: render-ccs
[596.481563] Subtest render-ccs: SUCCESS (0.094s)
[596.650928] [134/134] (437s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-plflip-blt)
[596.846915] Starting subtest: fbcpsr-2p-primscrn-shrfb-plflip-blt
[596.848567] Subtest fbcpsr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[597.041376] Closing watchdogs
results: parsing output: 0/ for test: kms_plane_scaling
results: parsing output: 1/ for test: gem_userptr_blits
results: parsing output: 2/ for test: gem_mmap_gtt
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: kms_fence_pin_leak
results: parsing output: 5/ for test: kms_big_fb
results: parsing output: 6/ for test: gem_mmap_wc
results: parsing output: 7/ for test: kms_flip
results: parsing output: 8/ for test: perf_pmu
results: parsing output: 9/ for test: gem_mmap_wc
results: parsing output: 10/ for test: kms_big_fb
results: parsing output: 11/ for test: kms_busy
results: parsing output: 12/ for test: kms_plane_alpha_blend
results: parsing output: 13/ for test: sysfs_timeslice_duration
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_cursor_crc
results: parsing output: 16/ for test: kms_color
results: parsing output: 17/ for test: gem_partial_pwrite_pread
results: parsing output: 18/ for test: dumb_buffer
results: parsing output: 19/ for test: gem_mmap_gtt
results: parsing output: 20/ for test: kms_cursor_legacy
results: parsing output: 21/ for test: gem_lmem_swapping
results: parsing output: 22/ for test: gem_spin_batch
results: parsing output: 23/ for test: kms_cursor_crc
results: parsing output: 24/ for test: kms_properties
results: parsing output: 25/ for test: kms_vrr
results: parsing output: 26/ for test: gem_exec_params
results: parsing output: 27/ for test: gem_exec_balancer
results: parsing output: 28/ for test: kms_pm_dc
results: parsing output: 29/ for test: kms_frontbuffer_tracking
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: gem_exec_whisper
results: parsing output: 33/ for test: kms_frontbuffer_tracking
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: gem_render_copy_redux
results: parsing output: 36/ for test: gem_mmap_wc
results: parsing output: 37/ for test: gem_pxp
results: parsing output: 38/ for test: kms_3d
results: parsing output: 39/ for test: gem_ctx_persistence
results: parsing output: 40/ for test: kms_psr
results: parsing output: 41/ for test: syncobj_timeline
results: parsing output: 42/ for test: kms_flip_scaled_crc
results: parsing output: 43/ for test: kms_flip_scaled_crc
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: vgem_basic
results: parsing output: 46/ for test: gem_userptr_blits
results: parsing output: 47/ for test: kms_chamelium_hpd
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: kms_lease
results: parsing output: 52/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 53/ for test: kms_dp_link_training
results: parsing output: 54/ for test: syncobj_timeline
results: parsing output: 55/ for test: kms_invalid_mode
results: parsing output: 56/ for test: kms_pm_rpm
results: parsing output: 57/ for test: gem_exec_balancer
results: parsing output: 58/ for test: kms_psr2_sf
results: parsing output: 59/ for test: gen9_exec_parse
results: parsing output: 60/ for test: gem_ctx_shared
results: parsing output: 61/ for test: perf
results: parsing output: 62/ for test: syncobj_timeline
results: parsing output: 63/ for test: gem_tiled_pread_pwrite
results: parsing output: 64/ for test: i915_pm_rps
results: parsing output: 65/ for test: gem_ctx_engines
results: parsing output: 66/ for test: vgem_basic
results: parsing output: 67/ for test: kms_psr
results: parsing output: 68/ for test: gem_mmap_gtt
results: parsing output: 69/ for test: gem_exec_reloc
results: parsing output: 70/ for test: prime_busy
results: parsing output: 71/ for test: gem_exec_fence
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_big_fb
results: parsing output: 74/ for test: kms_psr2_sf
results: parsing output: 75/ for test: gem_ccs
results: parsing output: 76/ for test: kms_big_fb
results: parsing output: 77/ for test: kms_atomic
results: parsing output: 78/ for test: kms_ccs
results: parsing output: 79/ for test: gem_lmem_swapping
results: parsing output: 80/ for test: kms_chamelium_frames
results: parsing output: 81/ for test: kms_vblank
results: parsing output: 82/ for test: kms_big_fb
results: parsing output: 83/ for test: gem_flink_race
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: gem_exec_schedule
results: parsing output: 86/ for test: kms_flip
results: parsing output: 87/ for test: i915_pm_rps
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: kms_psr2_sf
results: parsing output: 90/ for test: kms_concurrent
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: api_intel_allocator
results: parsing output: 93/ for test: kms_flip
results: parsing output: 94/ for test: syncobj_timeline
results: parsing output: 95/ for test: kms_atomic_transition
results: parsing output: 96/ for test: gem_exec_params
results: parsing output: 97/ for test: kms_scaling_modes
results: parsing output: 98/ for test: kms_plane
results: parsing output: 99/ for test: kms_psr
results: parsing output: 100/ for test: gem_exec_params
results: parsing output: 101/ for test: i915_query
results: parsing output: 102/ for test: kms_psr
results: parsing output: 103/ for test: kms_big_fb
results: parsing output: 104/ for test: kms_ccs
results: parsing output: 105/ for test: kms_cursor_legacy
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_flip
results: parsing output: 108/ for test: gem_exec_reloc
results: parsing output: 109/ for test: kms_ccs
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_ccs
results: parsing output: 112/ for test: i915_drm_fdinfo
results: parsing output: 113/ for test: gem_exec_flush
results: parsing output: 114/ for test: sysfs_timeslice_duration
results: parsing output: 115/ for test: sriov_basic
results: parsing output: 116/ for test: kms_ccs
results: parsing output: 117/ for test: kms_getfb
results: parsing output: 118/ for test: gem_render_copy
results: parsing output: 119/ for test: gem_workarounds
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: gem_wait
results: parsing output: 122/ for test: i915_hangman
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_cursor_legacy
results: parsing output: 125/ for test: gem_mmap_gtt
results: parsing output: 126/ for test: gem_exec_schedule
results: parsing output: 127/ for test: kms_psr
results: parsing output: 128/ for test: perf
results: parsing output: 129/ for test: gem_eio
results: parsing output: 130/ for test: kms_cursor_edge_walk
results: parsing output: 131/ for test: gem_ctx_persistence
results: parsing output: 132/ for test: api_intel_bb
results: parsing output: 133/ for test: kms_frontbuffer_tracking
Done.