[57.804742] Initializing watchdogs
[57.804798]   /dev/watchdog0
[57.819467] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[57.823807] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.826280] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.829684] [001/133] (960s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[57.959977] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[57.964563] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[58.075226] [002/133] (960s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-fully-sf)
[58.178787] Starting subtest: pr-overlay-plane-move-continuous-exceed-fully-sf
[58.183222] Subtest pr-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[58.244864] [003/133] (960s left) prime_vgem (coherency-gtt)
[58.375437] Starting subtest: coherency-gtt
[58.380222] Subtest coherency-gtt: SKIP (0.000s)
[58.478986] [FACT prime_vgem (coherency-gtt)] new: kernel.kmod_is_loaded.vgem: true
[58.482528] [004/133] (959s left) gem_exec_whisper (basic-fds-forked)
[58.560254] Starting subtest: basic-fds-forked
[82.836927] Subtest basic-fds-forked: SUCCESS (24.274s)
[83.030035] [005/133] (935s left) gen9_exec_parse (bb-start-param)
[83.090545] Subtest bb-start-param: SKIP (0.000s)
[83.164010] [006/133] (935s left) perf (mi-rpc)
[83.288522] Starting subtest: mi-rpc
[83.292530] Subtest mi-rpc: SKIP (0.000s)
[83.333515] [007/133] (935s left) syncobj_wait (invalid-signal-bad-pad)
[83.393278] Starting subtest: invalid-signal-bad-pad
[83.395623] Subtest invalid-signal-bad-pad: SUCCESS (0.000s)
[83.502914] [008/133] (935s left) syncobj_timeline (wait-all-for-submit-snapshot)
[83.556891] Starting subtest: wait-all-for-submit-snapshot
[83.638670] Subtest wait-all-for-submit-snapshot: SUCCESS (0.082s)
[83.715096] [009/133] (934s left) kms_setmode (basic)
[83.780067] Starting subtest: basic
[84.152653] Starting dynamic subtest: pipe-A-eDP-1
[86.231861] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.074s)
[86.574407] Starting dynamic subtest: pipe-B-eDP-1
[88.661085] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.089s)
[88.974275] Subtest basic: SUCCESS (5.193s)
[89.803080] [010/133] (928s left) gem_ctx_shared (exec-shared-gtt)
[89.866850] Starting subtest: exec-shared-gtt
[89.869250] Starting dynamic subtest: rcs0
[89.874671] Dynamic subtest rcs0: SUCCESS (0.008s)
[89.892630] Starting dynamic subtest: bcs0
[89.895157] Dynamic subtest bcs0: SUCCESS (0.006s)
[89.912047] Starting dynamic subtest: vcs0
[89.914103] Dynamic subtest vcs0: SUCCESS (0.007s)
[89.929961] Starting dynamic subtest: vcs1
[89.932236] Dynamic subtest vcs1: SUCCESS (0.006s)
[89.947625] Starting dynamic subtest: vecs0
[89.949636] Dynamic subtest vecs0: SUCCESS (0.004s)
[89.966763] Starting dynamic subtest: ccs0
[89.969252] Dynamic subtest ccs0: SUCCESS (0.007s)
[89.971279] Subtest exec-shared-gtt: SUCCESS (0.041s)
[90.095898] [011/133] (928s left) kms_pm_backlight (bad-brightness)
[90.188394] Starting subtest: bad-brightness
[90.257157] Starting dynamic subtest: eDP-1
[90.554710] Dynamic subtest eDP-1: SUCCESS (0.296s)
[90.557502] Subtest bad-brightness: SUCCESS (0.367s)
[91.346407] [012/133] (927s left) gem_ctx_param (invalid-get-ringsize)
[91.393759] Starting subtest: invalid-get-ringsize
[91.396163] Subtest invalid-get-ringsize: SUCCESS (0.001s)
[91.500909] [013/133] (927s left) kms_chamelium_color (gamma)
[91.598057] Subtest gamma: SKIP (0.000s)
[91.643395] [014/133] (927s left) gem_exec_create (basic)
[91.699561] Starting subtest: basic
[91.701726] Starting dynamic subtest: smem
[93.786033] Dynamic subtest smem: SUCCESS (2.088s)
[93.788945] Subtest basic: SUCCESS (2.088s)
[93.964560] [015/133] (924s left) gem_flink_basic (flink-lifetime)
[94.016218] Starting subtest: flink-lifetime
[94.018593] Subtest flink-lifetime: SUCCESS (0.002s)
[94.103776] [016/133] (924s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[94.708687] Starting subtest: syncobj-timeline-multiple-ext-nodes
[94.714707] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.007s)
[95.981066] [017/133] (922s left) kms_atomic_transition (plane-all-modeset-transition-internal-panels)
[96.078834] Starting subtest: plane-all-modeset-transition-internal-panels
[96.081054] Starting dynamic subtest: pipe-A-eDP-1
[97.391077] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.312s)
[97.666221] Starting dynamic subtest: pipe-B-eDP-1
[98.726961] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.068s)
[98.994477] Subtest plane-all-modeset-transition-internal-panels: SUCCESS (2.917s)
[99.841607] [018/133] (919s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[99.947796] Starting subtest: bo-too-small-due-to-tiling
[99.952303] Subtest bo-too-small-due-to-tiling: SKIP (0.000s)
[100.043987] [019/133] (919s left) kms_big_fb (4-tiled-32bpp-rotate-0)
[100.146611] Starting subtest: 4-tiled-32bpp-rotate-0
[101.581061] Subtest 4-tiled-32bpp-rotate-0: SUCCESS (1.435s)
[101.726857] [020/133] (917s left) gem_media_fill (media-fill)
[101.788925] Subtest media-fill: SKIP (0.000s)
[101.900379] [021/133] (917s left) kms_psr (fbc-pr-no-drrs)
[101.994086] Starting subtest: fbc-pr-no-drrs
[101.997491] Subtest fbc-pr-no-drrs: SKIP (0.000s)
[102.062954] [022/133] (917s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[102.168147] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt
[102.171831] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[102.267205] [023/133] (916s left) dumb_buffer (create-clear)
[102.327389] Starting subtest: create-clear
[136.755714] Subtest create-clear: SUCCESS (34.425s)
[136.833456] [024/133] (882s left) vgem_basic (bad-pad)
[136.876467] Starting subtest: bad-pad
[136.878641] Subtest bad-pad: SUCCESS (0.000s)
[136.931147] [025/133] (882s left) gem_fence_thrash (bo-write-verify-none)
[136.965089] Starting subtest: bo-write-verify-none
[136.984328] Subtest bo-write-verify-none: SKIP (0.020s)
[137.047146] [026/133] (882s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-cpu)
[137.153692] Starting subtest: fbcpsr-rgb101010-draw-mmap-cpu
[143.886810] Subtest fbcpsr-rgb101010-draw-mmap-cpu: SUCCESS (6.735s)
[144.001820] [027/133] (875s left) kms_async_flips (test-time-stamp)
[144.096446] Starting subtest: test-time-stamp
[144.476896] Starting dynamic subtest: pipe-A-eDP-1
[145.273585] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.794s)
[145.662956] Starting dynamic subtest: pipe-B-eDP-1
[146.421879] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.764s)
[146.800280] Starting dynamic subtest: pipe-C-eDP-1
[147.558399] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.766s)
[147.923910] Starting dynamic subtest: pipe-D-eDP-1
[148.679344] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.760s)
[148.681853] Subtest test-time-stamp: SUCCESS (4.581s)
[149.829349] [028/133] (869s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs)
[149.920850] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs
[149.923204] Starting dynamic subtest: pipe-A-eDP-1
[149.946711] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[149.957441] Starting dynamic subtest: pipe-B-eDP-1
[149.979795] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[149.990220] Starting dynamic subtest: pipe-C-eDP-1
[150.012586] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[150.020863] Starting dynamic subtest: pipe-D-eDP-1
[150.043894] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[150.048241] Subtest crc-primary-rotation-180-yf-tiled-ccs: SKIP (0.004s)
[152.205480] [029/133] (867s left) vgem_basic (dmabuf-fence-before)
[152.253289] Starting subtest: dmabuf-fence-before
[152.255568] Subtest dmabuf-fence-before: SUCCESS (0.000s)
[152.311612] [030/133] (867s left) kms_cursor_edge_walk (64x64-left-edge)
[152.397894] Starting subtest: 64x64-left-edge
[152.400458] Starting dynamic subtest: pipe-A-eDP-1
[155.875064] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.476s)
[155.883611] Starting dynamic subtest: pipe-D-eDP-1
[158.999453] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.124s)
[159.001682] Subtest 64x64-left-edge: SUCCESS (6.602s)
[159.827048] [031/133] (859s left) gem_ringfill (basic-all)
[165.916707] Starting subtest: basic-all
[167.086148] Subtest basic-all: SUCCESS (1.170s)
[167.227184] [032/133] (852s left) gem_mmap_gtt (zero-extend)
[167.297072] Subtest zero-extend: SKIP (0.000s)
[167.370470] [033/133] (852s left) gem_partial_pwrite_pread (write-display)
[167.430991] Subtest write-display: SKIP (0.000s)
[167.503912] [034/133] (852s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping)
[167.591622] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping
[167.596104] Subtest pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s)
[167.685491] [035/133] (852s left) syncobj_timeline (signal)
[167.754984] Starting subtest: signal
[167.757292] Subtest signal: SUCCESS (0.000s)
[167.851495] [036/133] (851s left) kms_draw_crc (draw-method-mmap-gtt)
[167.937715] Starting subtest: draw-method-mmap-gtt
[167.942023] Subtest draw-method-mmap-gtt: SKIP (0.000s)
[168.027587] [037/133] (851s left) gem_lmem_swapping (parallel-multi)
[168.075628] Subtest parallel-multi: SKIP (0.000s)
[168.113651] [038/133] (851s left) kms_big_fb (x-tiled-32bpp-rotate-0)
[168.211867] Starting subtest: x-tiled-32bpp-rotate-0
[169.658634] Subtest x-tiled-32bpp-rotate-0: SUCCESS (1.446s)
[169.808229] [039/133] (850s left) syncobj_wait (multi-wait-submitted-signaled)
[169.857973] Starting subtest: multi-wait-submitted-signaled
[169.859874] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[169.954791] [040/133] (849s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-plflip-blt)
[170.058339] Starting subtest: fbcpsr-2p-scndscrn-indfb-plflip-blt
[170.062152] Subtest fbcpsr-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s)
[170.155338] [041/133] (849s left) gem_ctx_persistence (many-contexts)
[170.224984] Starting subtest: many-contexts
[215.419849] Subtest many-contexts: SUCCESS (45.193s)
[215.512448] [042/133] (804s left) gem_exec_schedule (pi-ringfull)
[215.693085] Starting subtest: pi-ringfull
[215.695512] Starting dynamic subtest: rcs0
[215.727811] Dynamic subtest rcs0: SUCCESS (0.038s)
[215.737197] Starting dynamic subtest: bcs0
[215.766399] Dynamic subtest bcs0: SUCCESS (0.038s)
[215.775199] Starting dynamic subtest: vcs0
[215.800726] Dynamic subtest vcs0: SUCCESS (0.034s)
[215.809240] Starting dynamic subtest: vcs1
[215.832138] Dynamic subtest vcs1: SUCCESS (0.031s)
[215.841920] Starting dynamic subtest: vecs0
[215.866701] Dynamic subtest vecs0: SUCCESS (0.033s)
[215.875221] Starting dynamic subtest: ccs0
[215.900118] Dynamic subtest ccs0: SUCCESS (0.033s)
[215.902375] Subtest pi-ringfull: SUCCESS (0.210s)
[216.121529] [043/133] (803s left) kms_busy (extended-pageflip-modeset-hang-oldfb)
[216.220365] Starting subtest: extended-pageflip-modeset-hang-oldfb
[216.222663] Starting dynamic subtest: pipe-A
[224.111206] Dynamic subtest pipe-A: SUCCESS (7.888s)
[224.120254] Starting dynamic subtest: pipe-D
[232.705601] Dynamic subtest pipe-D: SUCCESS (8.592s)
[232.707888] Subtest extended-pageflip-modeset-hang-oldfb: SUCCESS (16.484s)
[233.574744] [044/133] (786s left) kms_cursor_crc (cursor-random-256x256)
[233.812929] Starting subtest: cursor-random-256x256
[233.815291] Starting dynamic subtest: pipe-A-eDP-1
[237.160784] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.346s)
[237.191439] Starting dynamic subtest: pipe-D-eDP-1
[241.161901] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.976s)
[241.164599] Subtest cursor-random-256x256: SUCCESS (7.348s)
[242.030183] [045/133] (778s left) kms_async_flips (async-flip-with-page-flip-events-linear)
[242.122975] Starting subtest: async-flip-with-page-flip-events-linear
[242.494646] Starting dynamic subtest: pipe-A-eDP-1
[245.300990] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.805s)
[245.667292] Starting dynamic subtest: pipe-B-eDP-1
[248.428353] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.767s)
[248.821727] Starting dynamic subtest: pipe-C-eDP-1
[251.557866] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.752s)
[251.923377] Starting dynamic subtest: pipe-D-eDP-1
[254.688839] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.772s)
[254.691799] Subtest async-flip-with-page-flip-events-linear: SUCCESS (12.566s)
[255.881081] [046/133] (764s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-blt)
[255.984579] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-blt
[255.989024] Subtest psr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[256.066560] [047/133] (764s left) kms_universal_plane (universal-plane-functional)
[256.158813] Starting subtest: universal-plane-functional
[256.160962] Starting dynamic subtest: pipe-A-eDP-1
[260.167821] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.008s)
[260.176513] Starting dynamic subtest: pipe-B-eDP-1
[264.695849] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.528s)
[264.708098] Starting dynamic subtest: pipe-C-eDP-1
[269.036295] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.339s)
[269.045468] Starting dynamic subtest: pipe-D-eDP-1
[273.424278] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.383s)
[273.426196] Subtest universal-plane-functional: SUCCESS (17.264s)
[274.298914] [048/133] (745s left) kms_frontbuffer_tracking (fbcpsr-2p-pri-indfb-multidraw)
[274.407645] Starting subtest: fbcpsr-2p-pri-indfb-multidraw
[274.411787] Subtest fbcpsr-2p-pri-indfb-multidraw: SKIP (0.000s)
[274.512789] [049/133] (745s left) gem_pxp (reject-modify-context-protection-on)
[274.634556] Starting subtest: reject-modify-context-protection-on
[274.636985] Subtest reject-modify-context-protection-on: SUCCESS (0.002s)
[274.750160] [050/133] (745s left) perf_pmu (render-node-busy-idle)
[274.816098] Starting subtest: render-node-busy-idle
[274.818416] Starting dynamic subtest: rcs0
[275.504629] Dynamic subtest rcs0: SUCCESS (0.688s)
[275.515693] Starting dynamic subtest: bcs0
[276.163516] Dynamic subtest bcs0: SUCCESS (0.657s)
[276.174713] Starting dynamic subtest: vcs0
[277.912855] Dynamic subtest vcs0: SUCCESS (1.745s)
[277.923043] Starting dynamic subtest: vcs1
[279.896055] Dynamic subtest vcs1: SUCCESS (1.980s)
[279.907569] Starting dynamic subtest: vecs0
[281.944845] Dynamic subtest vecs0: SUCCESS (2.046s)
[281.956275] Starting dynamic subtest: ccs0
[282.608084] Dynamic subtest ccs0: SUCCESS (0.662s)
[282.611047] Subtest render-node-busy-idle: SUCCESS (7.791s)
[282.700391] [051/133] (737s left) gem_readwrite (write-bad-handle)
[282.752466] Subtest write-bad-handle: SKIP (0.000s)
[282.812344] [052/133] (737s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted)
[282.858899] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted
[282.964043] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.105s)
[283.042647] [053/133] (737s left) syncobj_timeline (invalid-wait-illegal-handle)
[283.084457] Starting subtest: invalid-wait-illegal-handle
[283.086740] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s)
[283.178820] [054/133] (737s left) kms_big_fb (yf-tiled-16bpp-rotate-0)
[283.279626] Starting subtest: yf-tiled-16bpp-rotate-0
[283.284066] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s)
[283.375801] [055/133] (737s left) gem_softpin (safe-alignment)
[283.434877] Starting subtest: safe-alignment
[283.454928] Subtest safe-alignment: SUCCESS (0.020s)
[284.928681] [056/133] (735s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[285.051134] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip
[285.055588] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[285.139230] [057/133] (735s left) gem_userptr_blits (create-destroy-unsync)
[285.210387] Subtest create-destroy-unsync: SKIP (0.000s)
[285.353063] [058/133] (735s left) api_intel_bb (object-noreloc-keep-cache-simple)
[285.406548] Starting subtest: object-noreloc-keep-cache-simple
[285.412587] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.006s)
[285.542619] [059/133] (735s left) gem_exec_params (dr4-dirt)
[285.592795] Starting subtest: DR4-dirt
[285.595147] Subtest DR4-dirt: SUCCESS (0.000s)
[285.696597] [060/133] (735s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff)
[285.807334] Starting subtest: psr-2p-primscrn-spr-indfb-onoff
[285.811700] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[285.887045] [061/133] (734s left) i915_pm_rps (fence-order)
[285.948563] Starting subtest: fence-order
[288.840456] Subtest fence-order: SUCCESS (2.888s)
[288.971134] [062/133] (731s left) gem_exec_fence (expired-history)
[289.431565] Starting subtest: expired-history
[296.640711] Subtest expired-history: SUCCESS (7.208s)
[297.240091] [063/133] (723s left) kms_psr (pr-cursor-plane-onoff)
[297.341675] Starting subtest: pr-cursor-plane-onoff
[297.345908] Subtest pr-cursor-plane-onoff: SKIP (0.000s)
[297.413720] [064/133] (723s left) kms_psr (psr2-cursor-render)
[297.498960] Starting subtest: psr2-cursor-render
[297.501233] Starting dynamic subtest: eDP-1
[299.166235] Dynamic subtest eDP-1: SUCCESS (1.666s)
[299.168157] Subtest psr2-cursor-render: SUCCESS (1.667s)
[299.953123] [065/133] (720s left) gen9_exec_parse (shadow-peek)
[300.024829] Subtest shadow-peek: SKIP (0.000s)
[300.101621] [066/133] (720s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-blt)
[300.210161] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-blt
[307.031382] Subtest psr-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (6.824s)
[307.190249] [067/133] (713s left) gem_exec_reloc (basic-concurrent16)
[307.246789] Subtest basic-concurrent16: SKIP (0.000s)
[307.319305] [068/133] (713s left) kms_frontbuffer_tracking (fbc-2p-rte)
[307.413013] Starting subtest: fbc-2p-rte
[307.416850] Subtest fbc-2p-rte: SKIP (0.000s)
[307.528911] [069/133] (713s left) gem_unfence_active_buffers
[307.680372] [070/133] (713s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs)
[307.768067] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs
[307.770218] Starting dynamic subtest: pipe-A-eDP-1
[307.793071] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[307.803276] Starting dynamic subtest: pipe-B-eDP-1
[307.825690] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[307.833786] Starting dynamic subtest: pipe-C-eDP-1
[307.855810] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[307.863862] Starting dynamic subtest: pipe-D-eDP-1
[307.885838] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[307.890158] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs: SKIP (0.018s)
[310.036151] [071/133] (711s left) gem_wait (wait)
[310.109077] Starting subtest: wait
[310.110957] Starting dynamic subtest: all-engines
[311.896768] Dynamic subtest all-engines: SUCCESS (1.787s)
[311.907951] Starting dynamic subtest: rcs0
[312.941312] Dynamic subtest rcs0: SUCCESS (1.043s)
[312.952492] Starting dynamic subtest: bcs0
[313.988517] Dynamic subtest bcs0: SUCCESS (1.045s)
[313.998536] Starting dynamic subtest: vcs0
[315.032404] Dynamic subtest vcs0: SUCCESS (1.042s)
[315.044083] Starting dynamic subtest: vcs1
[316.077328] Dynamic subtest vcs1: SUCCESS (1.043s)
[316.088712] Starting dynamic subtest: vecs0
[317.123026] Dynamic subtest vecs0: SUCCESS (1.043s)
[317.133776] Starting dynamic subtest: ccs0
[318.169451] Dynamic subtest ccs0: SUCCESS (1.044s)
[318.172090] Subtest wait: SUCCESS (8.063s)
[318.368252] [072/133] (702s left) kms_pm_rpm (cursor)
[320.005789] Starting subtest: cursor
[320.010566] Subtest cursor: SKIP (0.000s)
[320.685310] [073/133] (700s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc)
[320.776296] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc
[320.778684] Starting dynamic subtest: pipe-A-eDP-1
[320.799240] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[320.808465] Starting dynamic subtest: pipe-B-eDP-1
[320.828450] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[320.836634] Starting dynamic subtest: pipe-C-eDP-1
[320.855322] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[320.863598] Starting dynamic subtest: pipe-D-eDP-1
[320.882757] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[320.884984] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.006s)
[323.031698] [074/133] (698s left) i915_hangman (gt-error-state-capture)
[323.101836] Starting subtest: gt-error-state-capture
[323.104190] Starting dynamic subtest: rcs0
[334.902341] Dynamic subtest rcs0: SUCCESS (11.797s)
[334.914661] Starting dynamic subtest: bcs0
[346.870449] Dynamic subtest bcs0: SUCCESS (11.964s)
[346.886180] Starting dynamic subtest: vcs0
[358.838519] Dynamic subtest vcs0: SUCCESS (11.964s)
[358.854025] Starting dynamic subtest: vcs1
[370.806337] Dynamic subtest vcs1: SUCCESS (11.964s)
[370.820546] Starting dynamic subtest: vecs0
[381.814374] Dynamic subtest vecs0: SUCCESS (11.004s)
[381.826523] Starting dynamic subtest: ccs0
[392.885533] Dynamic subtest ccs0: SUCCESS (11.068s)
[392.888306] Subtest gt-error-state-capture: SUCCESS (69.779s)
[393.022989] [075/133] (628s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-upscaling)
[393.119757] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-upscaling
[393.124227] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-upscaling: SKIP (0.000s)
[393.194438] [076/133] (628s left) kms_pm_rpm (modeset-pc8-residency-stress)
[395.120023] Starting subtest: modeset-pc8-residency-stress
[395.124921] Subtest modeset-pc8-residency-stress: SKIP (0.000s)
[395.509258] [077/133] (625s left) kms_plane (plane-panning-bottom-right)
[395.600354] Starting subtest: plane-panning-bottom-right
[395.602722] Starting dynamic subtest: pipe-A
[397.282533] Dynamic subtest pipe-A: SUCCESS (1.682s)
[397.291888] Starting dynamic subtest: pipe-B
[399.635768] Dynamic subtest pipe-B: SUCCESS (2.353s)
[399.638369] Subtest plane-panning-bottom-right: SUCCESS (4.038s)
[400.440460] [078/133] (621s left) kms_flip (absolute-wf_vblank)
[400.543234] Starting subtest: absolute-wf_vblank
[400.545595] Starting dynamic subtest: A-eDP1
[409.303484] Dynamic subtest A-eDP1: SUCCESS (8.761s)
[409.312630] Starting dynamic subtest: B-eDP1
[418.030588] Dynamic subtest B-eDP1: SUCCESS (8.725s)
[418.039695] Starting dynamic subtest: C-eDP1
[426.744664] Dynamic subtest C-eDP1: SUCCESS (8.712s)
[426.756261] Starting dynamic subtest: D-eDP1
[435.480749] Dynamic subtest D-eDP1: SUCCESS (8.732s)
[435.487235] Subtest absolute-wf_vblank: SUCCESS (34.943s)
[436.696160] [079/133] (584s left) kms_invalid_mode (zero-vdisplay)
[436.789106] Starting subtest: zero-vdisplay
[436.791428] Starting dynamic subtest: pipe-A-eDP-1
[437.075419] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.287s)
[437.085080] Starting dynamic subtest: pipe-B-eDP-1
[437.087322] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[437.096454] Starting dynamic subtest: pipe-C-eDP-1
[437.098417] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[437.107367] Starting dynamic subtest: pipe-D-eDP-1
[437.109687] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[437.112059] Subtest zero-vdisplay: SUCCESS (0.293s)
[437.925845] [080/133] (583s left) api_intel_allocator (open-vm)
[437.986364] Starting subtest: open-vm
[437.988818] Subtest open-vm: SUCCESS (0.003s)
[438.122708] [081/133] (583s left) gem_mmap_wc (coherency)
[438.172707] Subtest coherency: SKIP (0.000s)
[438.228455] [082/133] (583s left) kms_psr (fbc-psr-dpms)
[438.351544] Starting subtest: fbc-psr-dpms
[438.353918] Starting dynamic subtest: eDP-1
[438.358454] Dynamic subtest eDP-1: SKIP (0.000s)
[438.362697] Subtest fbc-psr-dpms: SKIP (0.004s)
[438.438337] [083/133] (583s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[438.497341] Subtest no-spare-fences-interruptible: SKIP (0.000s)
[438.563911] [084/133] (583s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-wc)
[438.652123] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-wc
[438.656359] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[438.754162] [085/133] (583s left) kms_cursor_legacy (cursora-vs-flipa-legacy)
[438.867557] Starting subtest: cursorA-vs-flipA-legacy
[450.015289] Subtest cursorA-vs-flipA-legacy: SUCCESS (11.147s)
[450.855330] [086/133] (570s left) kms_plane_multiple (tiling-x)
[450.946848] Starting subtest: tiling-x
[450.949134] Starting dynamic subtest: pipe-A-eDP-1
[454.699260] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.752s)
[454.708656] Starting dynamic subtest: pipe-B-eDP-1
[459.219580] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.517s)
[459.229587] Starting dynamic subtest: pipe-C-eDP-1
[463.641072] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.423s)
[463.650246] Starting dynamic subtest: pipe-D-eDP-1
[467.982093] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.338s)
[467.984317] Subtest tiling-x: SUCCESS (17.035s)
[468.788512] [087/133] (553s left) kms_psr (fbc-pr-suspend)
[468.879114] Starting subtest: fbc-pr-suspend
[468.883539] Subtest fbc-pr-suspend: SKIP (0.000s)
[468.983137] [088/133] (552s left) kms_vrr (seamless-rr-switch-drrs)
[469.081841] Starting subtest: seamless-rr-switch-drrs
[469.088298] Subtest seamless-rr-switch-drrs: SKIP (0.000s)
[469.155402] [089/133] (552s left) kms_prop_blob (invalid-set-prop-any)
[469.221981] Starting subtest: invalid-set-prop-any
[469.224561] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[469.331210] [090/133] (552s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-move)
[469.432662] Starting subtest: fbc-2p-scndscrn-cur-indfb-move
[469.437062] Subtest fbc-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[469.562268] [091/133] (552s left) kms_chamelium_hpd (vga-hpd-after-suspend)
[469.943498] Subtest vga-hpd-after-suspend: SKIP (0.000s)
[470.800901] [092/133] (551s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-wc)
[470.891463] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-wc
[470.895474] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[470.999409] [093/133] (551s left) kms_vblank (wait-forked-hang)
[471.093688] Starting subtest: wait-forked-hang
[471.095820] Starting dynamic subtest: pipe-A-eDP-1
[497.688623] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.592s)
[497.702193] Starting dynamic subtest: pipe-D-eDP-1
[521.688732] Dynamic subtest pipe-D-eDP-1: SUCCESS (23.996s)
[521.691069] Subtest wait-forked-hang: SUCCESS (50.593s)
[522.501414] [094/133] (499s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[522.630305] Starting subtest: cursor-vs-flip-atomic
[551.977936] Subtest cursor-vs-flip-atomic: SUCCESS (29.348s)
[552.819924] [095/133] (469s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0)
[552.938660] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0
[552.942800] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[553.061723] [096/133] (469s left) kms_content_protection (legacy)
[553.202798] Starting subtest: legacy
[553.207242] Subtest legacy: SKIP (0.000s)
[553.322927] [097/133] (469s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-plflip-blt)
[553.424397] Starting subtest: fbcpsr-2p-primscrn-shrfb-plflip-blt
[553.428844] Subtest fbcpsr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[553.516796] [098/133] (468s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[553.618865] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-cpu
[560.217834] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (6.602s)
[560.356694] [099/133] (462s left) gem_fence_thrash (bo-write-verify-threaded-y)
[560.396138] Starting subtest: bo-write-verify-threaded-y
[560.414926] Subtest bo-write-verify-threaded-y: SKIP (0.017s)
[560.478298] [100/133] (461s left) kms_cursor_crc (cursor-offscreen-512x170)
[560.776102] Starting subtest: cursor-offscreen-512x170
[560.780359] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[560.925991] [101/133] (461s left) kms_big_fb (linear-32bpp-rotate-180)
[561.022220] Starting subtest: linear-32bpp-rotate-180
[562.521213] Subtest linear-32bpp-rotate-180: SUCCESS (1.500s)
[562.667196] [102/133] (459s left) kms_color_pipeline (plane-lut1d-pre-ctm3x4)
[562.761808] Starting subtest: plane-lut1d-pre-ctm3x4
[562.908179] Starting dynamic subtest: pipe-A-plane-0
[563.236330] Dynamic subtest pipe-A-plane-0: FAIL (0.193s)
[563.246267] Starting dynamic subtest: pipe-A-plane-1
[563.450601] Dynamic subtest pipe-A-plane-1: FAIL (0.180s)
[563.461982] Starting dynamic subtest: pipe-A-plane-2
[563.665775] Dynamic subtest pipe-A-plane-2: FAIL (0.178s)
[564.646089] Starting dynamic subtest: pipe-B-plane-0
[565.092306] Dynamic subtest pipe-B-plane-0: FAIL (0.186s)
[565.101855] Starting dynamic subtest: pipe-B-plane-1
[565.406265] Dynamic subtest pipe-B-plane-1: FAIL (0.188s)
[565.416647] Starting dynamic subtest: pipe-B-plane-2
[565.711927] Dynamic subtest pipe-B-plane-2: FAIL (0.177s)
[566.465037] Starting dynamic subtest: pipe-C-plane-0
[566.944153] Dynamic subtest pipe-C-plane-0: FAIL (0.129s)
[566.953853] Starting dynamic subtest: pipe-C-plane-1
[567.356734] Dynamic subtest pipe-C-plane-1: FAIL (0.155s)
[567.366117] Starting dynamic subtest: pipe-C-plane-2
[567.735462] Dynamic subtest pipe-C-plane-2: FAIL (0.630s)
[568.598400] Starting dynamic subtest: pipe-D-plane-0
[569.189403] Dynamic subtest pipe-D-plane-0: FAIL (0.140s)
[569.200300] Starting dynamic subtest: pipe-D-plane-1
[569.659623] Dynamic subtest pipe-D-plane-1: FAIL (0.628s)
[569.670227] Starting dynamic subtest: pipe-D-plane-2
[570.122236] Dynamic subtest pipe-D-plane-2: FAIL (0.565s)
[570.227658] Subtest plane-lut1d-pre-ctm3x4: FAIL (7.467s)
[571.070840] [103/133] (451s left) gem_exec_params (batch-first)
[571.126770] Starting subtest: batch-first
[571.132476] Subtest batch-first: SUCCESS (0.006s)
[571.255722] [104/133] (451s left) kms_flip_tiling (flip-change-tiling)
[571.349484] Starting subtest: flip-change-tiling
[571.351500] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-mc-ccs
[571.526455] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (0.178s)
[571.540949] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs
[571.672020] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.143s)
[571.684695] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[571.805344] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.131s)
[571.815665] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-4
[571.948682] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-4: SUCCESS (0.142s)
[571.960973] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-x
[572.081579] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-x: SUCCESS (0.131s)
[572.093787] Starting dynamic subtest: pipe-A-eDP-1-4-mc-ccs-to-linear
[572.215101] Dynamic subtest pipe-A-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.131s)
[572.226743] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-mc-ccs
[572.349446] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.131s)
[572.365646] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs
[572.459588] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.108s)
[572.472887] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[572.627144] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.163s)
[572.638789] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-4
[572.770942] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-4: SUCCESS (0.142s)
[572.782897] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-x
[572.903429] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-x: SUCCESS (0.131s)
[572.918107] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-to-linear
[573.048354] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.142s)
[573.060078] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[573.182068] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.131s)
[573.194337] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[573.327924] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.142s)
[573.339942] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[573.438178] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.109s)
[573.453703] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-4
[573.582277] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.142s)
[573.594692] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-x
[573.725867] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.142s)
[573.738253] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-cc-to-linear
[573.870187] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.142s)
[573.884555] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-mc-ccs
[574.015171] Dynamic subtest pipe-A-eDP-1-4-to-4-mc-ccs: SUCCESS (0.142s)
[574.029708] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-rc-ccs
[574.182880] Dynamic subtest pipe-A-eDP-1-4-to-4-rc-ccs: SUCCESS (0.165s)
[574.195043] Starting dynamic subtest: pipe-A-eDP-1-4-to-4-rc-ccs-cc
[574.338516] Dynamic subtest pipe-A-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.152s)
[574.351472] Starting dynamic subtest: pipe-A-eDP-1-4-to-4
[574.459556] Dynamic subtest pipe-A-eDP-1-4-to-4: SUCCESS (0.119s)
[574.471421] Starting dynamic subtest: pipe-A-eDP-1-4-to-x
[574.603491] Dynamic subtest pipe-A-eDP-1-4-to-x: SUCCESS (0.142s)
[574.615610] Starting dynamic subtest: pipe-A-eDP-1-4-to-linear
[574.747991] Dynamic subtest pipe-A-eDP-1-4-to-linear: SUCCESS (0.142s)
[574.762249] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-mc-ccs
[574.892367] Dynamic subtest pipe-A-eDP-1-x-to-4-mc-ccs: SUCCESS (0.142s)
[574.906433] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-rc-ccs
[575.036813] Dynamic subtest pipe-A-eDP-1-x-to-4-rc-ccs: SUCCESS (0.142s)
[575.050732] Starting dynamic subtest: pipe-A-eDP-1-x-to-4-rc-ccs-cc
[575.181362] Dynamic subtest pipe-A-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.142s)
[575.193034] Starting dynamic subtest: pipe-A-eDP-1-x-to-4
[575.325875] Dynamic subtest pipe-A-eDP-1-x-to-4: SUCCESS (0.142s)
[575.337469] Starting dynamic subtest: pipe-A-eDP-1-x-to-x
[575.448540] Dynamic subtest pipe-A-eDP-1-x-to-x: SUCCESS (0.120s)
[575.460329] Starting dynamic subtest: pipe-A-eDP-1-x-to-linear
[575.593028] Dynamic subtest pipe-A-eDP-1-x-to-linear: SUCCESS (0.142s)
[575.604603] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-mc-ccs
[575.736903] Dynamic subtest pipe-A-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.142s)
[575.748802] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-rc-ccs
[575.881263] Dynamic subtest pipe-A-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.142s)
[575.893077] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4-rc-ccs-cc
[576.026269] Dynamic subtest pipe-A-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.142s)
[576.037827] Starting dynamic subtest: pipe-A-eDP-1-linear-to-4
[576.170419] Dynamic subtest pipe-A-eDP-1-linear-to-4: SUCCESS (0.142s)
[576.182071] Starting dynamic subtest: pipe-A-eDP-1-linear-to-x
[576.314935] Dynamic subtest pipe-A-eDP-1-linear-to-x: SUCCESS (0.142s)
[576.326895] Starting dynamic subtest: pipe-A-eDP-1-linear-to-linear
[576.448543] Dynamic subtest pipe-A-eDP-1-linear-to-linear: SUCCESS (0.131s)
[576.501348] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-mc-ccs
[577.720677] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.226s)
[577.732603] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs
[577.855464] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.131s)
[577.867918] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[577.987882] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.131s)
[577.999933] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-4
[578.131857] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-4: SUCCESS (0.142s)
[578.143738] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-x
[578.275568] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-x: SUCCESS (0.142s)
[578.287814] Starting dynamic subtest: pipe-B-eDP-1-4-mc-ccs-to-linear
[578.419954] Dynamic subtest pipe-B-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.142s)
[578.432078] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-mc-ccs
[578.554075] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.131s)
[578.566198] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs
[578.665235] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.109s)
[578.677151] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[578.811209] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.142s)
[578.823658] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-4
[578.953831] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-4: SUCCESS (0.142s)
[578.966035] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-x
[579.098086] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-x: SUCCESS (0.142s)
[579.110087] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-to-linear
[579.242779] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.142s)
[579.254788] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[579.376021] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.131s)
[579.393771] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[579.522125] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.142s)
[579.534225] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[579.631785] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.109s)
[579.643529] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-4
[579.776352] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.142s)
[579.788039] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-x
[579.908702] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.131s)
[579.920297] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs-cc-to-linear
[580.053623] Dynamic subtest pipe-B-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.142s)
[580.065728] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-mc-ccs
[580.186720] Dynamic subtest pipe-B-eDP-1-4-to-4-mc-ccs: SUCCESS (0.131s)
[580.201643] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-rc-ccs
[580.331767] Dynamic subtest pipe-B-eDP-1-4-to-4-rc-ccs: SUCCESS (0.140s)
[580.343289] Starting dynamic subtest: pipe-B-eDP-1-4-to-4-rc-ccs-cc
[580.476042] Dynamic subtest pipe-B-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.142s)
[580.488497] Starting dynamic subtest: pipe-B-eDP-1-4-to-4
[580.597747] Dynamic subtest pipe-B-eDP-1-4-to-4: SUCCESS (0.120s)
[580.610171] Starting dynamic subtest: pipe-B-eDP-1-4-to-x
[580.753670] Dynamic subtest pipe-B-eDP-1-4-to-x: SUCCESS (0.154s)
[580.765567] Starting dynamic subtest: pipe-B-eDP-1-4-to-linear
[580.897465] Dynamic subtest pipe-B-eDP-1-4-to-linear: SUCCESS (0.142s)
[580.911369] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-mc-ccs
[581.042423] Dynamic subtest pipe-B-eDP-1-x-to-4-mc-ccs: SUCCESS (0.142s)
[581.054778] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-rc-ccs
[581.186799] Dynamic subtest pipe-B-eDP-1-x-to-4-rc-ccs: SUCCESS (0.142s)
[581.198599] Starting dynamic subtest: pipe-B-eDP-1-x-to-4-rc-ccs-cc
[581.331421] Dynamic subtest pipe-B-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.142s)
[581.342652] Starting dynamic subtest: pipe-B-eDP-1-x-to-4
[581.475300] Dynamic subtest pipe-B-eDP-1-x-to-4: SUCCESS (0.142s)
[581.487521] Starting dynamic subtest: pipe-B-eDP-1-x-to-x
[581.598051] Dynamic subtest pipe-B-eDP-1-x-to-x: SUCCESS (0.120s)
[581.609371] Starting dynamic subtest: pipe-B-eDP-1-x-to-linear
[581.742581] Dynamic subtest pipe-B-eDP-1-x-to-linear: SUCCESS (0.142s)
[581.754428] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-mc-ccs
[581.886670] Dynamic subtest pipe-B-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.142s)
[581.898386] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-rc-ccs
[582.030806] Dynamic subtest pipe-B-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.142s)
[582.044410] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4-rc-ccs-cc
[582.175421] Dynamic subtest pipe-B-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.142s)
[582.189685] Starting dynamic subtest: pipe-B-eDP-1-linear-to-4
[582.319939] Dynamic subtest pipe-B-eDP-1-linear-to-4: SUCCESS (0.142s)
[582.334542] Starting dynamic subtest: pipe-B-eDP-1-linear-to-x
[582.464620] Dynamic subtest pipe-B-eDP-1-linear-to-x: SUCCESS (0.141s)
[582.475997] Starting dynamic subtest: pipe-B-eDP-1-linear-to-linear
[582.586886] Dynamic subtest pipe-B-eDP-1-linear-to-linear: SUCCESS (0.120s)
[582.639485] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-mc-ccs
[583.850852] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.217s)
[583.862867] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs
[583.950603] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.098s)
[583.962872] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[584.062083] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.108s)
[584.074038] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-4
[584.173102] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-4: SUCCESS (0.109s)
[584.185326] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-x
[584.283326] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-x: SUCCESS (0.109s)
[584.297887] Starting dynamic subtest: pipe-C-eDP-1-4-mc-ccs-to-linear
[584.394339] Dynamic subtest pipe-C-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.108s)
[584.406188] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-mc-ccs
[584.494893] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.098s)
[584.505079] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs
[584.595050] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.099s)
[584.604698] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[584.694964] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s)
[584.707038] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-4
[584.805573] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-4: SUCCESS (0.109s)
[584.815948] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-x
[584.916151] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-x: SUCCESS (0.109s)
[584.930161] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-to-linear
[585.027267] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.109s)
[585.038406] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[585.139297] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.110s)
[585.151516] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[585.250247] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.108s)
[585.260318] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[585.349651] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.098s)
[585.363094] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-4
[585.461240] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.109s)
[585.472623] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-x
[585.560678] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.098s)
[585.571781] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs-cc-to-linear
[585.671578] Dynamic subtest pipe-C-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.109s)
[585.683532] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-mc-ccs
[585.772054] Dynamic subtest pipe-C-eDP-1-4-to-4-mc-ccs: SUCCESS (0.098s)
[585.783821] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-rc-ccs
[585.883745] Dynamic subtest pipe-C-eDP-1-4-to-4-rc-ccs: SUCCESS (0.109s)
[585.895681] Starting dynamic subtest: pipe-C-eDP-1-4-to-4-rc-ccs-cc
[585.994526] Dynamic subtest pipe-C-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.109s)
[586.006127] Starting dynamic subtest: pipe-C-eDP-1-4-to-4
[586.116582] Dynamic subtest pipe-C-eDP-1-4-to-4: SUCCESS (0.120s)
[586.128882] Starting dynamic subtest: pipe-C-eDP-1-4-to-x
[586.227119] Dynamic subtest pipe-C-eDP-1-4-to-x: SUCCESS (0.109s)
[586.237167] Starting dynamic subtest: pipe-C-eDP-1-4-to-linear
[586.338496] Dynamic subtest pipe-C-eDP-1-4-to-linear: SUCCESS (0.110s)
[586.348690] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-mc-ccs
[586.449643] Dynamic subtest pipe-C-eDP-1-x-to-4-mc-ccs: SUCCESS (0.109s)
[586.460070] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-rc-ccs
[586.560598] Dynamic subtest pipe-C-eDP-1-x-to-4-rc-ccs: SUCCESS (0.109s)
[586.571138] Starting dynamic subtest: pipe-C-eDP-1-x-to-4-rc-ccs-cc
[586.671872] Dynamic subtest pipe-C-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.109s)
[586.682479] Starting dynamic subtest: pipe-C-eDP-1-x-to-4
[586.783111] Dynamic subtest pipe-C-eDP-1-x-to-4: SUCCESS (0.109s)
[586.796568] Starting dynamic subtest: pipe-C-eDP-1-x-to-x
[586.894072] Dynamic subtest pipe-C-eDP-1-x-to-x: SUCCESS (0.109s)
[586.905468] Starting dynamic subtest: pipe-C-eDP-1-x-to-linear
[587.005582] Dynamic subtest pipe-C-eDP-1-x-to-linear: SUCCESS (0.109s)
[587.017041] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-mc-ccs
[587.116215] Dynamic subtest pipe-C-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.109s)
[587.127223] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-rc-ccs
[587.227182] Dynamic subtest pipe-C-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.109s)
[587.238745] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4-rc-ccs-cc
[587.338251] Dynamic subtest pipe-C-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.109s)
[587.349219] Starting dynamic subtest: pipe-C-eDP-1-linear-to-4
[587.449325] Dynamic subtest pipe-C-eDP-1-linear-to-4: SUCCESS (0.109s)
[587.460876] Starting dynamic subtest: pipe-C-eDP-1-linear-to-x
[587.560797] Dynamic subtest pipe-C-eDP-1-linear-to-x: SUCCESS (0.109s)
[587.572545] Starting dynamic subtest: pipe-C-eDP-1-linear-to-linear
[587.672508] Dynamic subtest pipe-C-eDP-1-linear-to-linear: SUCCESS (0.109s)
[587.713909] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-mc-ccs
[588.895290] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-mc-ccs: SUCCESS (1.188s)
[588.907538] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs
[588.995351] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs: SUCCESS (0.098s)
[589.007173] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs-cc
[589.094988] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s)
[589.106382] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-4
[589.205935] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-4: SUCCESS (0.109s)
[589.218169] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-x
[589.316731] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-x: SUCCESS (0.109s)
[589.328140] Starting dynamic subtest: pipe-D-eDP-1-4-mc-ccs-to-linear
[589.427569] Dynamic subtest pipe-D-eDP-1-4-mc-ccs-to-linear: SUCCESS (0.109s)
[589.439268] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-mc-ccs
[589.528705] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-mc-ccs: SUCCESS (0.099s)
[589.540335] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs
[589.628245] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs: SUCCESS (0.099s)
[589.639769] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs-cc
[589.728308] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4-rc-ccs-cc: SUCCESS (0.098s)
[589.739905] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-4
[589.839124] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-4: SUCCESS (0.109s)
[589.850215] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-x
[589.949554] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-x: SUCCESS (0.109s)
[589.960672] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-to-linear
[590.060999] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-to-linear: SUCCESS (0.109s)
[590.073156] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-mc-ccs
[590.160994] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-mc-ccs: SUCCESS (0.098s)
[590.172571] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs
[590.261299] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs: SUCCESS (0.098s)
[590.273266] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc
[590.361523] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4-rc-ccs-cc: SUCCESS (0.098s)
[590.372772] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-4
[590.472666] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-4: SUCCESS (0.110s)
[590.484400] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-x
[590.621936] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-x: SUCCESS (0.148s)
[590.635553] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs-cc-to-linear
[590.732594] Dynamic subtest pipe-D-eDP-1-4-rc-ccs-cc-to-linear: SUCCESS (0.109s)
[590.744024] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-mc-ccs
[590.844843] Dynamic subtest pipe-D-eDP-1-4-to-4-mc-ccs: SUCCESS (0.109s)
[590.856946] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-rc-ccs
[590.955876] Dynamic subtest pipe-D-eDP-1-4-to-4-rc-ccs: SUCCESS (0.109s)
[590.967762] Starting dynamic subtest: pipe-D-eDP-1-4-to-4-rc-ccs-cc
[591.066854] Dynamic subtest pipe-D-eDP-1-4-to-4-rc-ccs-cc: SUCCESS (0.109s)
[591.078792] Starting dynamic subtest: pipe-D-eDP-1-4-to-4
[591.177750] Dynamic subtest pipe-D-eDP-1-4-to-4: SUCCESS (0.109s)
[591.187924] Starting dynamic subtest: pipe-D-eDP-1-4-to-x
[591.288165] Dynamic subtest pipe-D-eDP-1-4-to-x: SUCCESS (0.109s)
[591.299661] Starting dynamic subtest: pipe-D-eDP-1-4-to-linear
[591.399479] Dynamic subtest pipe-D-eDP-1-4-to-linear: SUCCESS (0.109s)
[591.409877] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-mc-ccs
[591.510679] Dynamic subtest pipe-D-eDP-1-x-to-4-mc-ccs: SUCCESS (0.109s)
[591.522022] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-rc-ccs
[591.621829] Dynamic subtest pipe-D-eDP-1-x-to-4-rc-ccs: SUCCESS (0.109s)
[591.631945] Starting dynamic subtest: pipe-D-eDP-1-x-to-4-rc-ccs-cc
[591.732872] Dynamic subtest pipe-D-eDP-1-x-to-4-rc-ccs-cc: SUCCESS (0.110s)
[591.743204] Starting dynamic subtest: pipe-D-eDP-1-x-to-4
[591.844181] Dynamic subtest pipe-D-eDP-1-x-to-4: SUCCESS (0.110s)
[591.854147] Starting dynamic subtest: pipe-D-eDP-1-x-to-x
[591.955360] Dynamic subtest pipe-D-eDP-1-x-to-x: SUCCESS (0.109s)
[591.968616] Starting dynamic subtest: pipe-D-eDP-1-x-to-linear
[592.066745] Dynamic subtest pipe-D-eDP-1-x-to-linear: SUCCESS (0.108s)
[592.078126] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-mc-ccs
[592.177210] Dynamic subtest pipe-D-eDP-1-linear-to-4-mc-ccs: SUCCESS (0.108s)
[592.188314] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-rc-ccs
[592.288627] Dynamic subtest pipe-D-eDP-1-linear-to-4-rc-ccs: SUCCESS (0.110s)
[592.299355] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4-rc-ccs-cc
[592.399998] Dynamic subtest pipe-D-eDP-1-linear-to-4-rc-ccs-cc: SUCCESS (0.110s)
[592.411406] Starting dynamic subtest: pipe-D-eDP-1-linear-to-4
[592.510898] Dynamic subtest pipe-D-eDP-1-linear-to-4: SUCCESS (0.109s)
[592.524256] Starting dynamic subtest: pipe-D-eDP-1-linear-to-x
[592.622169] Dynamic subtest pipe-D-eDP-1-linear-to-x: SUCCESS (0.110s)
[592.633528] Starting dynamic subtest: pipe-D-eDP-1-linear-to-linear
[592.733339] Dynamic subtest pipe-D-eDP-1-linear-to-linear: SUCCESS (0.109s)
[592.766120] Subtest flip-change-tiling: SUCCESS (21.419s)
[593.883992] [105/133] (428s left) perf (sysctl-defaults)
[593.953311] Starting subtest: sysctl-defaults
[593.955764] Subtest sysctl-defaults: SUCCESS (0.000s)
[594.015945] [106/133] (428s left) kms_rotation_crc (primary-yf-tiled-reflect-x-90)
[594.106655] Starting subtest: primary-yf-tiled-reflect-x-90
[594.111058] Subtest primary-yf-tiled-reflect-x-90: SKIP (0.001s)
[594.195435] [107/133] (428s left) gem_exec_schedule (u-fairslice)
[594.275853] Starting subtest: u-fairslice
[594.277891] Starting dynamic subtest: rcs0
[596.289881] Dynamic subtest rcs0: SUCCESS (2.019s)
[596.300225] Starting dynamic subtest: bcs0
[598.308063] Dynamic subtest bcs0: SUCCESS (2.018s)
[598.317947] Starting dynamic subtest: vcs0
[600.328375] Dynamic subtest vcs0: SUCCESS (2.020s)
[600.337057] Starting dynamic subtest: vcs1
[602.350448] Dynamic subtest vcs1: SUCCESS (2.021s)
[602.361703] Starting dynamic subtest: vecs0
[604.369231] Dynamic subtest vecs0: SUCCESS (2.018s)
[604.381478] Starting dynamic subtest: ccs0
[606.393593] Dynamic subtest ccs0: SUCCESS (2.022s)
[606.395879] Subtest u-fairslice: SUCCESS (12.123s)
[606.706977] [108/133] (416s left) gem_exec_flush (basic-uc-set-default)
[606.773091] Starting subtest: basic-uc-set-default
[612.247723] Subtest basic-uc-set-default: SUCCESS (5.474s)
[612.435505] [109/133] (410s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[612.531086] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-cpu
[619.575583] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.048s)
[619.700988] [110/133] (403s left) gem_exec_suspend (basic-s3-devices)
[619.780096] Starting subtest: basic-S3-devices
[619.781968] Starting dynamic subtest: smem
[630.872488] Dynamic subtest smem: SUCCESS (11.092s)
[630.875605] Subtest basic-S3-devices: SUCCESS (11.094s)
[631.058785] [111/133] (391s left) gem_exec_params (rel-constants-invalid-rel-gen5)
[631.124979] Starting subtest: rel-constants-invalid-rel-gen5
[631.127504] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s)
[631.244837] [112/133] (391s left) kms_properties (crtc-properties-legacy)
[631.336078] Starting subtest: crtc-properties-legacy
[631.338390] Starting dynamic subtest: pipe-A-eDP-1
[631.789493] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.452s)
[631.804643] Starting dynamic subtest: pipe-B-eDP-1
[632.944894] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.155s)
[632.954514] Starting dynamic subtest: pipe-C-eDP-1
[634.071271] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.124s)
[634.080941] Starting dynamic subtest: pipe-D-eDP-1
[635.205910] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.135s)
[635.208425] Subtest crtc-properties-legacy: SUCCESS (3.872s)
[636.014499] [113/133] (386s left) kms_flip (2x-nonexisting-fb-interruptible)
[636.112998] Starting subtest: 2x-nonexisting-fb-interruptible
[636.125735] Subtest 2x-nonexisting-fb-interruptible: SKIP (0.011s)
[636.214812] [114/133] (386s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[636.324112] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-wc
[636.328135] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[636.433600] [115/133] (386s left) kms_setmode (invalid-clone-single-crtc)
[636.490108] Starting subtest: invalid-clone-single-crtc
[636.496674] Subtest invalid-clone-single-crtc: SKIP (0.000s)
[636.574651] [116/133] (386s left) gem_create (hog-create)
[636.626270] Starting subtest: hog-create
[636.628501] Starting dynamic subtest: smem0
[670.954848] Dynamic subtest smem0: SUCCESS (34.329s)
[670.957424] Subtest hog-create: SUCCESS (34.330s)
[671.138163] [117/133] (352s left) gem_eio (in-flight-external)
[671.383753] Starting subtest: in-flight-external
[672.999487] Subtest in-flight-external: SUCCESS (1.615s)
[673.143175] [118/133] (350s left) gem_exec_balancer (bonded-chain)
[673.203314] Starting subtest: bonded-chain
[680.210247] Subtest bonded-chain: SUCCESS (7.004s)
[680.532344] [119/133] (342s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-pwrite)
[680.632265] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-pwrite
[687.803910] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (7.172s)
[687.943839] [120/133] (335s left) kms_flip (wf_vblank-ts-check-interruptible)
[688.029737] Starting subtest: wf_vblank-ts-check-interruptible
[688.031949] Starting dynamic subtest: A-eDP1
[696.932752] Dynamic subtest A-eDP1: SUCCESS (8.902s)
[696.944045] Starting dynamic subtest: B-eDP1
[705.851620] Dynamic subtest B-eDP1: SUCCESS (8.917s)
[705.864088] Starting dynamic subtest: C-eDP1
[714.763279] Dynamic subtest C-eDP1: SUCCESS (8.909s)
[714.775663] Starting dynamic subtest: D-eDP1
[723.702654] Dynamic subtest D-eDP1: SUCCESS (8.938s)
[723.707615] Subtest wf_vblank-ts-check-interruptible: SUCCESS (35.678s)
[724.930376] [121/133] (298s left) prime_busy (hang-wait)
[724.988836] Starting subtest: hang-wait
[724.991167] Starting dynamic subtest: rcs0
[751.346239] Dynamic subtest rcs0: SUCCESS (26.353s)
[751.355246] Starting dynamic subtest: bcs0
[758.503576] Dynamic subtest bcs0: SUCCESS (7.156s)
[758.513201] Starting dynamic subtest: vcs0
[765.540990] Dynamic subtest vcs0: SUCCESS (7.033s)
[765.552075] Starting dynamic subtest: vcs1
[772.520173] Dynamic subtest vcs1: SUCCESS (6.976s)
[772.540994] Starting dynamic subtest: vecs0
[779.487996] Dynamic subtest vecs0: SUCCESS (6.969s)
[779.498259] Starting dynamic subtest: ccs0
[793.395690] Dynamic subtest ccs0: SUCCESS (13.900s)
[793.398262] Subtest hang-wait: SUCCESS (68.401s)
[793.528496] [122/133] (229s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions)
[793.660658] Starting subtest: short-busy-flip-before-cursor-atomic-transitions
[793.665250] Subtest short-busy-flip-before-cursor-atomic-transitions: SKIP (0.000s)
[793.819683] [123/133] (229s left) i915_query (test-query-geometry-subslices)
[793.877371] Starting subtest: test-query-geometry-subslices
[793.879279] Subtest test-query-geometry-subslices: SUCCESS (0.000s)
[793.970368] [124/133] (229s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs-cc)
[794.060249] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs-cc
[794.062405] Starting dynamic subtest: pipe-A-eDP-1
[794.082695] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[794.094826] Starting dynamic subtest: pipe-B-eDP-1
[794.113323] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[794.123079] Starting dynamic subtest: pipe-C-eDP-1
[794.141247] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[794.151265] Starting dynamic subtest: pipe-D-eDP-1
[794.170960] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[794.173133] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.006s)
[796.296443] [125/133] (227s left) gem_basic (create-fd-close)
[796.359013] Starting subtest: create-fd-close
[796.363025] Subtest create-fd-close: SUCCESS (0.000s)
[796.463240] [126/133] (227s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-downscaling)
[796.564852] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-downscaling
[796.568824] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-downscaling: SKIP (0.000s)
[796.638108] [127/133] (226s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[796.727818] Starting subtest: read-crc-frame-sequence
[796.729688] Starting dynamic subtest: pipe-A-eDP-1
[797.447511] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.718s)
[797.458054] Starting dynamic subtest: pipe-B-eDP-1
[798.802994] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.356s)
[798.813712] Starting dynamic subtest: pipe-C-eDP-1
[800.179792] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.371s)
[800.190218] Starting dynamic subtest: pipe-D-eDP-1
[801.492952] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.315s)
[801.495176] Subtest read-crc-frame-sequence: SUCCESS (4.766s)
[802.312062] [128/133] (221s left) kms_rotation_crc (multiplane-rotation-cropping-bottom)
[802.413564] Starting subtest: multiplane-rotation-cropping-bottom
[819.860408] Subtest multiplane-rotation-cropping-bottom: SUCCESS (17.449s)
[819.963223] [129/133] (203s left) gem_pwrite (basic-random)
[820.016180] Subtest basic-random: SKIP (0.000s)
[820.074376] [130/133] (203s left) syncobj_timeline (etime-single-wait-for-submit-available-unsubmitted)
[820.125795] Starting subtest: etime-single-wait-for-submit-available-unsubmitted
[820.227840] Subtest etime-single-wait-for-submit-available-unsubmitted: SUCCESS (0.102s)
[820.303997] [131/133] (203s left) kms_mmap_write_crc (main)
[820.401267] Starting subtest: main
[820.403279] Starting dynamic subtest: pipe-A-eDP-1
[823.910308] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.504s)
[823.912636] Subtest main: SUCCESS (3.506s)
[824.748235] [132/133] (199s left) kms_chamelium_audio (dp-audio-edid)
[825.134883] Subtest dp-audio-edid: SKIP (0.000s)
[825.948604] [133/133] (197s left) fbdev (unaligned-write)
[825.994017] Starting subtest: unaligned-write
[826.096064] Subtest unaligned-write: SUCCESS (0.102s)
[826.162135] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_psr2_sf
results: parsing output: 2/ for test: prime_vgem
results: parsing output: 3/ for test: gem_exec_whisper
results: parsing output: 4/ for test: gen9_exec_parse
results: parsing output: 5/ for test: perf
results: parsing output: 6/ for test: syncobj_wait
results: parsing output: 7/ for test: syncobj_timeline
results: parsing output: 8/ for test: kms_setmode
results: parsing output: 9/ for test: gem_ctx_shared
results: parsing output: 10/ for test: kms_pm_backlight
results: parsing output: 11/ for test: gem_ctx_param
results: parsing output: 12/ for test: kms_chamelium_color
results: parsing output: 13/ for test: gem_exec_create
results: parsing output: 14/ for test: gem_flink_basic
results: parsing output: 15/ for test: gem_exec_fence
results: parsing output: 16/ for test: kms_atomic_transition
results: parsing output: 17/ for test: kms_addfb_basic
results: parsing output: 18/ for test: kms_big_fb
results: parsing output: 19/ for test: gem_media_fill
results: parsing output: 20/ for test: kms_psr
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: dumb_buffer
results: parsing output: 23/ for test: vgem_basic
results: parsing output: 24/ for test: gem_fence_thrash
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_async_flips
results: parsing output: 27/ for test: kms_ccs
results: parsing output: 28/ for test: vgem_basic
results: parsing output: 29/ for test: kms_cursor_edge_walk
results: parsing output: 30/ for test: gem_ringfill
results: parsing output: 31/ for test: gem_mmap_gtt
results: parsing output: 32/ for test: gem_partial_pwrite_pread
results: parsing output: 33/ for test: kms_plane
results: parsing output: 34/ for test: syncobj_timeline
results: parsing output: 35/ for test: kms_draw_crc
results: parsing output: 36/ for test: gem_lmem_swapping
results: parsing output: 37/ for test: kms_big_fb
results: parsing output: 38/ for test: syncobj_wait
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: gem_ctx_persistence
results: parsing output: 41/ for test: gem_exec_schedule
results: parsing output: 42/ for test: kms_busy
results: parsing output: 43/ for test: kms_cursor_crc
results: parsing output: 44/ for test: kms_async_flips
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: kms_universal_plane
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: gem_pxp
results: parsing output: 49/ for test: perf_pmu
results: parsing output: 50/ for test: gem_readwrite
results: parsing output: 51/ for test: syncobj_timeline
results: parsing output: 52/ for test: syncobj_timeline
results: parsing output: 53/ for test: kms_big_fb
results: parsing output: 54/ for test: gem_softpin
results: parsing output: 55/ for test: kms_big_fb
results: parsing output: 56/ for test: gem_userptr_blits
results: parsing output: 57/ for test: api_intel_bb
results: parsing output: 58/ for test: gem_exec_params
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: i915_pm_rps
results: parsing output: 61/ for test: gem_exec_fence
results: parsing output: 62/ for test: kms_psr
results: parsing output: 63/ for test: kms_psr
results: parsing output: 64/ for test: gen9_exec_parse
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: gem_exec_reloc
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: gem_unfence_active_buffers
results: parsing output: 69/ for test: kms_ccs
results: parsing output: 70/ for test: gem_wait
results: parsing output: 71/ for test: kms_pm_rpm
results: parsing output: 72/ for test: kms_ccs
results: parsing output: 73/ for test: i915_hangman
results: parsing output: 74/ for test: kms_flip_scaled_crc
results: parsing output: 75/ for test: kms_pm_rpm
results: parsing output: 76/ for test: kms_plane
results: parsing output: 77/ for test: kms_flip
results: parsing output: 78/ for test: kms_invalid_mode
results: parsing output: 79/ for test: api_intel_allocator
results: parsing output: 80/ for test: gem_mmap_wc
results: parsing output: 81/ for test: kms_psr
results: parsing output: 82/ for test: gem_fenced_exec_thrash
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_cursor_legacy
results: parsing output: 85/ for test: kms_plane_multiple
results: parsing output: 86/ for test: kms_psr
results: parsing output: 87/ for test: kms_vrr
results: parsing output: 88/ for test: kms_prop_blob
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_chamelium_hpd
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_vblank
results: parsing output: 93/ for test: kms_cursor_legacy
results: parsing output: 94/ for test: kms_big_fb
results: parsing output: 95/ for test: kms_content_protection
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: gem_fence_thrash
results: parsing output: 99/ for test: kms_cursor_crc
results: parsing output: 100/ for test: kms_big_fb
results: parsing output: 101/ for test: kms_color_pipeline
results: parsing output: 102/ for test: gem_exec_params
results: parsing output: 103/ for test: kms_flip_tiling
results: parsing output: 104/ for test: perf
results: parsing output: 105/ for test: kms_rotation_crc
results: parsing output: 106/ for test: gem_exec_schedule
results: parsing output: 107/ for test: gem_exec_flush
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: gem_exec_suspend
results: parsing output: 110/ for test: gem_exec_params
results: parsing output: 111/ for test: kms_properties
results: parsing output: 112/ for test: kms_flip
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: kms_setmode
results: parsing output: 115/ for test: gem_create
results: parsing output: 116/ for test: gem_eio
results: parsing output: 117/ for test: gem_exec_balancer
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_flip
results: parsing output: 120/ for test: prime_busy
results: parsing output: 121/ for test: kms_cursor_legacy
results: parsing output: 122/ for test: i915_query
results: parsing output: 123/ for test: kms_ccs
results: parsing output: 124/ for test: gem_basic
results: parsing output: 125/ for test: kms_flip_scaled_crc
results: parsing output: 126/ for test: kms_pipe_crc_basic
results: parsing output: 127/ for test: kms_rotation_crc
results: parsing output: 128/ for test: gem_pwrite
results: parsing output: 129/ for test: syncobj_timeline
results: parsing output: 130/ for test: kms_mmap_write_crc
results: parsing output: 131/ for test: kms_chamelium_audio
results: parsing output: 132/ for test: fbdev
Done.