[57.781545] Initializing watchdogs
[57.781594]   /dev/watchdog0
[57.797081] [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.801542] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.804038] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.807502] [001/133] (960s left) kms_color (legacy-gamma)
[57.926865] Starting subtest: legacy-gamma
[57.928795] Starting dynamic subtest: pipe-A-eDP-1
[58.698684] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.766s)
[58.706271] Starting dynamic subtest: pipe-B-eDP-1
[60.160690] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.455s)
[60.169792] Starting dynamic subtest: pipe-C-eDP-1
[61.530405] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.360s)
[61.538383] Starting dynamic subtest: pipe-D-eDP-1
[62.871994] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.337s)
[62.874504] Subtest legacy-gamma: SUCCESS (4.919s)
[63.706031] [002/133] (954s left) gem_exec_async (forked-writes)
[63.773674] Starting subtest: forked-writes
[63.776069] Starting dynamic subtest: rcs0
[63.802745] Dynamic subtest rcs0: SUCCESS (0.029s)
[63.813852] Starting dynamic subtest: bcs0
[63.828556] Dynamic subtest bcs0: SUCCESS (0.025s)
[63.839270] Starting dynamic subtest: vcs0
[63.853027] Dynamic subtest vcs0: SUCCESS (0.024s)
[63.860997] Starting dynamic subtest: vcs1
[63.875001] Dynamic subtest vcs1: SUCCESS (0.022s)
[63.882626] Starting dynamic subtest: vecs0
[63.895836] Dynamic subtest vecs0: SUCCESS (0.021s)
[63.903495] Starting dynamic subtest: ccs0
[63.919848] Dynamic subtest ccs0: SUCCESS (0.024s)
[63.922336] Subtest forked-writes: SUCCESS (0.146s)
[64.139357] [003/133] (954s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted)
[64.203210] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted
[64.304042] Subtest etime-multi-wait-all-available-unsubmitted-submitted: SUCCESS (0.101s)
[64.379442] [004/133] (954s left) syncobj_timeline (invalid-signal-one-illegal-handle)
[64.451822] Starting subtest: invalid-signal-one-illegal-handle
[64.453712] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[64.573734] [005/133] (953s left) gem_exec_schedule (preempt-engines)
[64.652688] Starting subtest: preempt-engines
[64.654916] Starting dynamic subtest: rcs0
[66.887666] Dynamic subtest rcs0: SUCCESS (2.235s)
[66.897829] Starting dynamic subtest: bcs0
[69.300158] Dynamic subtest bcs0: SUCCESS (2.407s)
[69.310949] Starting dynamic subtest: vcs0
[71.578209] Dynamic subtest vcs0: SUCCESS (2.275s)
[71.586650] Starting dynamic subtest: vcs1
[73.928733] Dynamic subtest vcs1: SUCCESS (2.347s)
[73.939485] Starting dynamic subtest: vecs0
[76.199528] Dynamic subtest vecs0: SUCCESS (2.269s)
[76.207037] Starting dynamic subtest: ccs0
[78.502349] Dynamic subtest ccs0: SUCCESS (2.300s)
[78.504852] Subtest preempt-engines: SUCCESS (13.837s)
[78.806787] [006/133] (939s left) syncobj_timeline (signal-point-0)
[78.880914] Starting subtest: signal-point-0
[78.883421] Subtest signal-point-0: SUCCESS (0.000s)
[78.997357] [007/133] (939s left) gem_mmap_offset (basic-uaf)
[79.063065] Starting subtest: basic-uaf
[79.065369] Subtest basic-uaf: SUCCESS (0.001s)
[79.190680] [008/133] (939s left) kms_addfb_basic (invalid-set-prop-any)
[79.243792] Starting subtest: invalid-set-prop-any
[79.246053] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[79.378032] [009/133] (939s left) vgem_basic (second-client)
[79.468594] Starting subtest: second-client
[79.492687] Subtest second-client: SUCCESS (0.022s)
[79.548317] [FACT vgem_basic (second-client)] new: kernel.kmod_is_loaded.vgem: true
[79.551292] [010/133] (939s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-pwrite)
[79.638137] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-pwrite
[79.642154] Subtest fbc-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[79.749772] [011/133] (938s left) kms_flip (2x-flip-vs-dpms-on-nop-interruptible)
[79.845918] Starting subtest: 2x-flip-vs-dpms-on-nop-interruptible
[79.857953] Subtest 2x-flip-vs-dpms-on-nop-interruptible: SKIP (0.011s)
[79.935701] [012/133] (938s left) kms_pm_backlight (fade-with-suspend)
[80.029525] Starting subtest: fade-with-suspend
[95.981491] Starting dynamic subtest: eDP-1
[98.450154] Dynamic subtest eDP-1: SUCCESS (2.469s)
[98.452540] Subtest fade-with-suspend: SUCCESS (4.179s)
[103.310218] [013/133] (919s left) kms_plane_lowres (tiling-x)
[103.445770] Starting subtest: tiling-x
[103.448182] Starting dynamic subtest: pipe-A-eDP-1
[103.452869] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[103.750217] Starting dynamic subtest: pipe-B-eDP-1
[103.754778] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[103.763118] Starting dynamic subtest: pipe-C-eDP-1
[103.767769] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[103.776021] Starting dynamic subtest: pipe-D-eDP-1
[103.780568] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[103.784763] Subtest tiling-x: SKIP (0.293s)
[104.575317] [014/133] (918s left) kms_psr (fbc-psr-basic)
[104.672299] Starting subtest: fbc-psr-basic
[104.674661] Starting dynamic subtest: eDP-1
[104.679260] Dynamic subtest eDP-1: SKIP (0.000s)
[104.684317] Subtest fbc-psr-basic: SKIP (0.001s)
[104.762037] [015/133] (918s left) kms_big_fb (y-tiled-addfb-size-overflow)
[104.868260] Starting subtest: y-tiled-addfb-size-overflow
[104.872580] Subtest y-tiled-addfb-size-overflow: SKIP (0.000s)
[104.996351] [016/133] (917s left) kms_ccs (bad-pixel-format-yf-tiled-ccs)
[105.104071] Starting subtest: bad-pixel-format-yf-tiled-ccs
[105.106371] Starting dynamic subtest: pipe-A-eDP-1
[105.129813] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[105.142579] Starting dynamic subtest: pipe-B-eDP-1
[105.165268] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[105.176531] Starting dynamic subtest: pipe-C-eDP-1
[105.199134] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[105.207432] Starting dynamic subtest: pipe-D-eDP-1
[105.230117] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[105.234246] Subtest bad-pixel-format-yf-tiled-ccs: SKIP (0.003s)
[107.298035] [017/133] (915s left) gem_exec_fence (long-history)
[107.725153] Starting subtest: long-history
[114.991695] Subtest long-history: SUCCESS (7.179s)
[115.647773] [018/133] (907s left) kms_cursor_crc (cursor-onscreen-128x128)
[115.869230] Starting subtest: cursor-onscreen-128x128
[115.871621] Starting dynamic subtest: pipe-A-eDP-1
[117.990541] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.107s)
[118.020115] Starting dynamic subtest: pipe-D-eDP-1
[121.526182] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.497s)
[121.528662] Subtest cursor-onscreen-128x128: SUCCESS (5.628s)
[122.007199] [019/133] (901s left) vgem_basic (unload)
[122.042143] Starting subtest: unload
[151.041424] Subtest unload: SUCCESS (28.972s)
[151.157053] [020/133] (871s left) prime_mmap (test_aperture_limit)
[151.210615] Starting subtest: test_aperture_limit
[151.212940] Starting dynamic subtest: test_aperture_limit-smem
[151.219679] Dynamic subtest test_aperture_limit-smem: SKIP (0.008s)
[151.223899] Subtest test_aperture_limit: SKIP (0.009s)
[151.322045] [021/133] (871s left) prime_self_import (export-vs-gem_close-race)
[151.360333] Starting subtest: export-vs-gem_close-race
[156.468675] Subtest export-vs-gem_close-race: SUCCESS (5.103s)
[156.546688] [022/133] (866s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions-varying-size)
[156.671613] Starting subtest: cursorA-vs-flipA-atomic-transitions-varying-size
[167.883895] Subtest cursorA-vs-flipA-atomic-transitions-varying-size: SUCCESS (11.205s)
[168.692362] [023/133] (854s left) kms_psr (fbc-pr-cursor-render)
[168.795311] Starting subtest: fbc-pr-cursor-render
[168.799461] Subtest fbc-pr-cursor-render: SKIP (0.000s)
[168.867837] [024/133] (854s left) kms_big_fb (linear-8bpp-rotate-180)
[168.971265] Starting subtest: linear-8bpp-rotate-180
[170.208154] Subtest linear-8bpp-rotate-180: SUCCESS (1.237s)
[170.331316] [025/133] (852s left) kms_vblank (wait-forked-busy)
[170.429891] Starting subtest: wait-forked-busy
[170.431675] Starting dynamic subtest: pipe-A-eDP-1
[172.307262] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.875s)
[172.321258] Starting dynamic subtest: pipe-D-eDP-1
[174.849908] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.540s)
[174.852261] Subtest wait-forked-busy: SUCCESS (4.419s)
[175.669622] [026/133] (847s left) i915_pm_rps (reset)
[175.741157] Starting subtest: reset
[184.187801] Subtest reset: SUCCESS (8.442s)
[184.329894] [027/133] (839s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen)
[184.462415] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen
[184.466608] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[184.555108] [028/133] (838s left) perf_pmu (busy-idle-no-semaphores)
[184.595311] Starting subtest: busy-idle-no-semaphores
[184.597070] Starting dynamic subtest: rcs0
[185.256655] Dynamic subtest rcs0: SUCCESS (0.661s)
[185.267791] Starting dynamic subtest: bcs0
[185.908906] Dynamic subtest bcs0: SUCCESS (0.649s)
[185.920023] Starting dynamic subtest: vcs0
[186.561512] Dynamic subtest vcs0: SUCCESS (0.650s)
[186.572872] Starting dynamic subtest: vcs1
[187.739495] Dynamic subtest vcs1: SUCCESS (1.175s)
[187.750418] Starting dynamic subtest: vecs0
[189.790012] Dynamic subtest vecs0: SUCCESS (2.046s)
[189.800816] Starting dynamic subtest: ccs0
[191.771355] Dynamic subtest ccs0: SUCCESS (1.979s)
[191.773872] Subtest busy-idle-no-semaphores: SUCCESS (7.173s)
[191.887450] [029/133] (831s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc)
[191.979944] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc
[191.983936] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[192.082478] [030/133] (831s left) gem_eio (suspend)
[192.281142] Starting subtest: suspend
[204.530885] Subtest suspend: SUCCESS (12.245s)
[215.684632] [031/133] (818s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-onoff)
[215.783195] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-onoff
[222.825171] Subtest fbcpsr-1p-primscrn-cur-indfb-onoff: SUCCESS (7.046s)
[222.965070] [032/133] (811s left) gem_mmap_gtt (basic-read-write-distinct)
[223.023789] Subtest basic-read-write-distinct: SKIP (0.000s)
[223.081863] [033/133] (811s left) gem_softpin (allocator-evict)
[223.139999] Starting subtest: allocator-evict
[223.142282] Starting dynamic subtest: rcs0
[246.786090] Dynamic subtest rcs0: SUCCESS (23.649s)
[246.796130] Starting dynamic subtest: bcs0
[271.074062] Dynamic subtest bcs0: SUCCESS (24.284s)
[271.086777] Starting dynamic subtest: vcs0
[294.644755] Dynamic subtest vcs0: SUCCESS (23.565s)
[294.657252] Starting dynamic subtest: vcs1
[318.490704] Dynamic subtest vcs1: SUCCESS (23.839s)
[318.503050] Starting dynamic subtest: vecs0
[342.122027] Dynamic subtest vecs0: SUCCESS (23.625s)
[342.135071] Starting dynamic subtest: ccs0
[366.366392] Dynamic subtest ccs0: SUCCESS (24.236s)
[366.369156] Subtest allocator-evict: SUCCESS (143.207s)
[366.450918] [034/133] (668s left) gem_exec_whisper (basic-queues)
[366.560680] Starting subtest: basic-queues
[376.148261] Subtest basic-queues: SUCCESS (9.580s)
[376.331691] [035/133] (658s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180)
[376.448390] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180
[376.452931] Subtest y-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.001s)
[376.545927] [036/133] (658s left) gem_mmap_gtt (close-race)
[376.610936] Subtest close-race: SKIP (0.000s)
[376.673604] [037/133] (658s left) kms_big_fb (yf-tiled-16bpp-rotate-0)
[376.774601] Starting subtest: yf-tiled-16bpp-rotate-0
[376.779022] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s)
[376.868263] [038/133] (658s left) kms_frontbuffer_tracking (psr-rgb101010-draw-pwrite)
[376.986033] Starting subtest: psr-rgb101010-draw-pwrite
[384.633576] Subtest psr-rgb101010-draw-pwrite: SUCCESS (7.649s)
[384.759680] [039/133] (650s left) kms_psr (fbc-pr-primary-render)
[384.864695] Starting subtest: fbc-pr-primary-render
[384.869024] Subtest fbc-pr-primary-render: SKIP (0.000s)
[384.938201] [040/133] (650s left) prime_busy (before)
[384.994722] Starting subtest: before
[384.999400] Starting dynamic subtest: rcs0
[385.030500] Dynamic subtest rcs0: SUCCESS (0.031s)
[385.042408] Starting dynamic subtest: bcs0
[385.091738] Dynamic subtest bcs0: SUCCESS (0.060s)
[385.102961] Starting dynamic subtest: vcs0
[385.133247] Dynamic subtest vcs0: SUCCESS (0.041s)
[385.143470] Starting dynamic subtest: vcs1
[385.174558] Dynamic subtest vcs1: SUCCESS (0.041s)
[385.184801] Starting dynamic subtest: vecs0
[385.216911] Dynamic subtest vecs0: SUCCESS (0.042s)
[385.227182] Starting dynamic subtest: ccs0
[385.256885] Dynamic subtest ccs0: SUCCESS (0.039s)
[385.365289] Subtest before: SUCCESS (0.368s)
[385.444128] [041/133] (649s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-gtt)
[385.538493] Starting subtest: fbcpsr-rgb565-draw-mmap-gtt
[385.543006] Subtest fbcpsr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[385.635884] [042/133] (649s left) kms_plane_scaling (planes-upscale-factor-0-25)
[385.732997] Starting subtest: planes-upscale-factor-0-25
[385.735288] Starting dynamic subtest: pipe-A
[385.793144] Dynamic subtest pipe-A: SUCCESS (0.062s)
[385.804686] Starting dynamic subtest: pipe-B
[386.895806] Dynamic subtest pipe-B: SUCCESS (1.100s)
[386.908508] Starting dynamic subtest: pipe-C
[388.009019] Dynamic subtest pipe-C: SUCCESS (1.111s)
[388.019002] Starting dynamic subtest: pipe-D
[389.136623] Dynamic subtest pipe-D: SUCCESS (1.126s)
[389.139012] Subtest planes-upscale-factor-0-25: SUCCESS (3.406s)
[390.323424] [043/133] (644s left) kms_psr (pr-primary-mmap-cpu)
[390.424324] Starting subtest: pr-primary-mmap-cpu
[390.428809] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[390.498120] [044/133] (644s left) kms_cursor_legacy (flip-vs-cursor-varying-size)
[390.615848] Starting subtest: flip-vs-cursor-varying-size
[399.645322] Subtest flip-vs-cursor-varying-size: SUCCESS (9.025s)
[400.448165] [045/133] (634s left) kms_flip (2x-flip-vs-absolute-wf_vblank)
[400.539066] Starting subtest: 2x-flip-vs-absolute-wf_vblank
[400.550572] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.011s)
[400.635160] [046/133] (634s left) kms_hdr (invalid-metadata-sizes)
[400.730410] Starting subtest: invalid-metadata-sizes
[400.736665] Subtest invalid-metadata-sizes: SKIP (0.000s)
[400.803987] [047/133] (634s left) i915_pm_freq_api (freq-reset-multiple)
[400.862306] Starting subtest: freq-reset-multiple
[400.864632] Starting dynamic subtest: gt0
[410.655613] Dynamic subtest gt0: SUCCESS (9.788s)
[410.665663] Starting dynamic subtest: gt1
[419.138037] Dynamic subtest gt1: SUCCESS (8.479s)
[419.140854] Subtest freq-reset-multiple: SUCCESS (18.269s)
[419.232397] [048/133] (616s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-blt)
[419.338097] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-blt
[419.342392] Subtest fbc-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[419.434775] [049/133] (615s left) gem_exec_balancer (hang)
[419.687396] Starting subtest: hang
[421.430538] Subtest hang: SUCCESS (1.747s)
[421.558244] [050/133] (613s left) gem_render_copy (y-tiled-ccs-to-y-tiled-mc-ccs)
[421.627433] Starting subtest: y-tiled-ccs-to-y-tiled-mc-ccs
[421.631812] Subtest y-tiled-ccs-to-y-tiled-mc-ccs: SKIP (0.000s)
[421.825368] [051/133] (613s left) prime_mmap (test_reprime)
[421.872625] Starting subtest: test_reprime
[421.874885] Starting dynamic subtest: test_reprime-smem
[421.901771] Dynamic subtest test_reprime-smem: SUCCESS (0.032s)
[421.904147] Subtest test_reprime: SUCCESS (0.032s)
[421.997869] [052/133] (613s left) core_getversion (all-cards)
[422.035513] Starting subtest: all-cards
[422.039678] Subtest all-cards: SUCCESS (0.011s)
[422.085300] [053/133] (613s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-pwrite)
[422.185335] Starting subtest: psr-2p-primscrn-cur-indfb-draw-pwrite
[422.189788] Subtest psr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[422.284903] [054/133] (613s left) syncobj_wait (reset-multiple-signaled)
[422.337880] Starting subtest: reset-multiple-signaled
[422.340102] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[422.441439] [055/133] (613s left) gem_mmap_wc (pf-nonblock)
[422.505255] Subtest pf-nonblock: SKIP (0.000s)
[422.571123] [056/133] (613s left) gem_basic (multigpu-create-close)
[422.625176] Starting subtest: multigpu-create-close
[422.629555] Subtest multigpu-create-close: SKIP (0.000s)
[422.735689] [057/133] (613s left) syncobj_wait (invalid-reset-bad-pad)
[422.786793] Starting subtest: invalid-reset-bad-pad
[422.788595] Subtest invalid-reset-bad-pad: SUCCESS (0.000s)
[422.879839] [058/133] (612s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs)
[422.968255] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs
[422.970048] Starting dynamic subtest: pipe-A-eDP-1
[422.986406] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[422.996329] Starting dynamic subtest: pipe-B-eDP-1
[423.011741] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[423.020967] Starting dynamic subtest: pipe-C-eDP-1
[423.036273] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[423.045182] Starting dynamic subtest: pipe-D-eDP-1
[423.061149] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[423.062728] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs: SUCCESS (0.011s)
[425.227891] [059/133] (610s left) gem_userptr_blits (readonly-unsync)
[425.301928] Subtest readonly-unsync: SKIP (0.000s)
[425.416404] [060/133] (610s left) kms_flip (2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[425.519633] Starting subtest: 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[425.531909] Subtest 2x-single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.011s)
[425.620167] [061/133] (610s left) core_auth (getclient-master-drop)
[425.661081] Starting subtest: getclient-master-drop
[425.671837] Subtest getclient-master-drop: SUCCESS (0.014s)
[425.788848] [062/133] (610s left) gem_mmap_gtt (big-bo-tiledx)
[425.840434] Subtest big-bo-tiledX: SKIP (0.000s)
[425.901421] [063/133] (610s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs-cc)
[425.996670] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs-cc
[425.998930] Starting dynamic subtest: pipe-A-eDP-1
[426.007871] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[426.019974] Starting dynamic subtest: pipe-B-eDP-1
[426.028900] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[426.038589] Starting dynamic subtest: pipe-C-eDP-1
[426.046940] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[426.056382] Starting dynamic subtest: pipe-D-eDP-1
[426.064684] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[426.068757] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs-cc: SKIP (0.005s)
[428.288883] [064/133] (607s left) perf (oa-formats)
[428.434915] Starting subtest: oa-formats
[428.437033] Starting dynamic subtest: 0-rcs0
[428.448183] Dynamic subtest 0-rcs0: SUCCESS (0.015s)
[428.458318] Starting dynamic subtest: 1-vecs0
[428.470076] Dynamic subtest 1-vecs0: SUCCESS (0.021s)
[428.472240] Subtest oa-formats: SUCCESS (0.037s)
[428.521616] [065/133] (607s left) gem_mmap_gtt (medium-copy-xy)
[428.575618] Subtest medium-copy-XY: SKIP (0.000s)
[428.632546] [066/133] (607s left) kms_ccs (random-ccs-data-4-tiled-dg2-mc-ccs)
[428.724833] Starting subtest: random-ccs-data-4-tiled-dg2-mc-ccs
[428.727135] Starting dynamic subtest: pipe-A-eDP-1
[428.751884] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[428.762914] Starting dynamic subtest: pipe-B-eDP-1
[428.786371] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[428.795914] Starting dynamic subtest: pipe-C-eDP-1
[428.819204] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[428.828730] Starting dynamic subtest: pipe-D-eDP-1
[428.853503] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[428.857904] Subtest random-ccs-data-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[430.967795] [067/133] (605s left) kms_plane (pixel-format-yf-tiled-ccs-modifier-source-clamping)
[431.068072] Starting subtest: pixel-format-yf-tiled-ccs-modifier-source-clamping
[431.071929] Subtest pixel-format-yf-tiled-ccs-modifier-source-clamping: SKIP (0.000s)
[431.144261] [068/133] (605s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[431.250462] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[431.255004] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[431.349131] [069/133] (604s left) kms_async_flips (invalid-async-flip)
[431.447663] Starting subtest: invalid-async-flip
[431.826575] Starting dynamic subtest: pipe-A-eDP-1
[432.607282] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.780s)
[432.969628] Starting dynamic subtest: pipe-B-eDP-1
[433.742372] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.783s)
[434.098099] Starting dynamic subtest: pipe-C-eDP-1
[434.868064] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.778s)
[435.225577] Starting dynamic subtest: pipe-D-eDP-1
[435.996229] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.779s)
[435.998681] Subtest invalid-async-flip: SUCCESS (4.549s)
[437.145613] [070/133] (599s left) gem_exec_reloc (basic-gtt-read-noreloc)
[437.215610] Subtest basic-gtt-read-noreloc: SKIP (0.000s)
[437.288510] [071/133] (599s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling)
[437.383910] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling
[437.386167] Starting dynamic subtest: pipe-A-default-mode
[440.091673] Dynamic subtest pipe-A-default-mode: SUCCESS (2.705s)
[440.093597] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SUCCESS (2.707s)
[440.958483] [072/133] (595s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled)
[441.018862] Starting subtest: multi-wait-for-submit-submitted-signaled
[441.021040] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.000s)
[441.120214] [073/133] (595s left) gem_exec_nop (basic-parallel)
[441.199994] Starting subtest: basic-parallel
[457.140311] Subtest basic-parallel: SUCCESS (15.942s)
[457.377982] [074/133] (579s left) sysfs_timeslice_duration (duration)
[457.445396] Starting subtest: duration
[457.447751] Starting dynamic subtest: vecs0
[471.058505] Dynamic subtest vecs0: SUCCESS (13.605s)
[471.071608] Starting dynamic subtest: ccs0
[484.202653] Dynamic subtest ccs0: SUCCESS (13.138s)
[484.215818] Starting dynamic subtest: vcs0
[498.129281] Dynamic subtest vcs0: SUCCESS (13.917s)
[498.144757] Starting dynamic subtest: bcs0
[511.291398] Dynamic subtest bcs0: SUCCESS (13.155s)
[511.304894] Starting dynamic subtest: rcs0
[524.432807] Dynamic subtest rcs0: SUCCESS (13.134s)
[524.445887] Starting dynamic subtest: vcs1
[538.065247] Dynamic subtest vcs1: SUCCESS (13.623s)
[538.068759] Subtest duration: SUCCESS (80.590s)
[538.157256] [075/133] (498s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[538.282946] Starting subtest: plane-downscale-factor-0-75-with-rotation
[538.285156] Starting dynamic subtest: pipe-A
[538.511186] Dynamic subtest pipe-A: SUCCESS (0.230s)
[538.521781] Starting dynamic subtest: pipe-B
[539.869369] Dynamic subtest pipe-B: SUCCESS (1.357s)
[539.879967] Starting dynamic subtest: pipe-C
[541.197047] Dynamic subtest pipe-C: SUCCESS (1.326s)
[541.207228] Starting dynamic subtest: pipe-D
[542.543132] Dynamic subtest pipe-D: SUCCESS (1.345s)
[542.545462] Subtest plane-downscale-factor-0-75-with-rotation: SUCCESS (4.261s)
[543.722016] [076/133] (492s left) gem_exec_flush (basic-uc-pro-default)
[543.782511] Starting subtest: basic-uc-pro-default
[549.246090] Subtest basic-uc-pro-default: SUCCESS (5.461s)
[549.448844] [077/133] (487s left) i915_query (test-query-geometry-subslices)
[549.505778] Starting subtest: test-query-geometry-subslices
[549.508105] Subtest test-query-geometry-subslices: SUCCESS (0.000s)
[549.609955] [078/133] (487s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-pwrite)
[549.707211] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-pwrite
[549.711320] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[549.791992] [079/133] (486s left) kms_panel_fitting (atomic-fastset)
[549.886842] Starting subtest: atomic-fastset
[549.888786] Starting dynamic subtest: pipe-A-eDP-1
[550.024772] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.139s)
[550.035929] Starting dynamic subtest: pipe-B-eDP-1
[551.274584] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.247s)
[551.287296] Starting dynamic subtest: pipe-C-eDP-1
[552.482574] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.206s)
[552.492904] Starting dynamic subtest: pipe-D-eDP-1
[553.625030] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.141s)
[553.627321] Subtest atomic-fastset: SUCCESS (3.739s)
[554.865391] [080/133] (481s left) kms_psr (psr2-cursor-plane-onoff)
[554.956453] Starting subtest: psr2-cursor-plane-onoff
[554.958732] Starting dynamic subtest: eDP-1
[556.661337] Dynamic subtest eDP-1: SUCCESS (1.706s)
[556.663698] Subtest psr2-cursor-plane-onoff: SUCCESS (1.707s)
[557.544433] [081/133] (479s left) kms_pm_rpm (modeset-pc8-residency-stress)
[559.215321] Starting subtest: modeset-pc8-residency-stress
[559.220343] Subtest modeset-pc8-residency-stress: SKIP (0.000s)
[559.887736] [082/133] (476s left) gem_ctx_shared (create-shared-gtt)
[559.955597] Starting subtest: create-shared-gtt
[562.109785] Subtest create-shared-gtt: SUCCESS (2.152s)
[562.465439] [083/133] (474s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180-hflip)
[562.565776] Starting subtest: linear-max-hw-stride-64bpp-rotate-180-hflip
[562.570423] Subtest linear-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[562.660631] [084/133] (474s left) kms_joiner (basic-big-joiner)
[562.755118] Starting subtest: basic-big-joiner
[562.759300] Subtest basic-big-joiner: SKIP (0.000s)
[562.821233] [085/133] (474s left) kms_lease (lease-unleased-connector)
[562.905524] Starting subtest: lease-unleased-connector
[562.907723] Starting dynamic subtest: pipe-A-eDP-1
[562.912663] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.006s)
[562.923540] Starting dynamic subtest: pipe-B-eDP-1
[562.925890] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.006s)
[562.937867] Starting dynamic subtest: pipe-C-eDP-1
[562.940137] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.007s)
[562.949892] Starting dynamic subtest: pipe-D-eDP-1
[562.951777] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.009s)
[562.953615] Subtest lease-unleased-connector: SUCCESS (0.033s)
[563.058313] [086/133] (473s left) kms_dirtyfb (psr-dirtyfb-ioctl)
[563.158630] Starting subtest: psr-dirtyfb-ioctl
[563.161237] Starting dynamic subtest: A-eDP-1
[567.083275] Dynamic subtest A-eDP-1: SUCCESS (3.924s)
[567.085593] Subtest psr-dirtyfb-ioctl: SUCCESS (3.925s)
[567.957766] [087/133] (469s left) kms_psr2_sf (fbc-pr-cursor-plane-update-sf)
[568.064066] Starting subtest: fbc-pr-cursor-plane-update-sf
[568.068174] Subtest fbc-pr-cursor-plane-update-sf: SKIP (0.000s)
[568.132715] [088/133] (468s left) gem_exec_reloc (basic-gtt-wc)
[568.195639] Subtest basic-gtt-wc: SKIP (0.000s)
[568.274726] [089/133] (468s left) gem_exec_reloc (basic-wc-read)
[568.335500] Subtest basic-wc-read: SKIP (0.000s)
[568.414009] [090/133] (468s left) kms_frontbuffer_tracking (fbcpsr-slowdraw)
[568.519180] Starting subtest: fbcpsr-slowdraw
[593.716710] Subtest fbcpsr-slowdraw: SUCCESS (25.191s)
[593.844302] [091/133] (443s left) gem_ctx_engines (independent)
[593.914123] Starting subtest: independent
[593.916075] Starting dynamic subtest: rcs0
[594.047207] Dynamic subtest rcs0: SUCCESS (0.134s)
[594.057907] Starting dynamic subtest: bcs0
[594.173858] Dynamic subtest bcs0: SUCCESS (0.125s)
[594.186730] Starting dynamic subtest: vcs0
[594.327131] Dynamic subtest vcs0: SUCCESS (0.153s)
[594.337439] Starting dynamic subtest: vcs1
[594.507114] Dynamic subtest vcs1: SUCCESS (0.179s)
[594.518072] Starting dynamic subtest: vecs0
[594.690281] Dynamic subtest vecs0: SUCCESS (0.181s)
[594.705301] Starting dynamic subtest: ccs0
[594.860302] Dynamic subtest ccs0: SUCCESS (0.169s)
[594.872647] Starting dynamic subtest: all-engines
[595.578408] Dynamic subtest all-engines: SUCCESS (0.717s)
[595.580544] Subtest independent: SUCCESS (1.666s)
[596.284099] [092/133] (440s left) perf (gen12-oa-tlb-invalidate)
[596.374665] Starting subtest: gen12-oa-tlb-invalidate
[596.376880] Starting dynamic subtest: 0-rcs0
[606.413308] Dynamic subtest 0-rcs0: SUCCESS (10.032s)
[606.429756] Starting dynamic subtest: 1-vecs0
[616.463809] Dynamic subtest 1-vecs0: SUCCESS (10.045s)
[616.466390] Subtest gen12-oa-tlb-invalidate: SUCCESS (20.080s)
[616.515670] [093/133] (420s left) kms_chamelium_color (ctm-0-25)
[616.614984] Subtest ctm-0-25: SKIP (0.000s)
[616.662893] [094/133] (420s left) gem_exec_params (readonly)
[616.719384] Starting subtest: readonly
[616.724687] Subtest readonly: SUCCESS (0.003s)
[616.860094] [095/133] (420s left) kms_psr (psr-sprite-plane-onoff)
[616.962553] Starting subtest: psr-sprite-plane-onoff
[616.964930] Starting dynamic subtest: eDP-1
[618.771504] Dynamic subtest eDP-1: SUCCESS (1.808s)
[618.773886] Subtest psr-sprite-plane-onoff: SUCCESS (1.809s)
[619.590566] [096/133] (417s left) gem_exec_capture (userptr)
[619.657913] Starting subtest: userptr
[620.488524] Subtest userptr: SUCCESS (0.830s)
[620.618526] [097/133] (416s left) kms_rotation_crc (sprite-rotation-180)
[620.715729] Starting subtest: sprite-rotation-180
[627.491747] Subtest sprite-rotation-180: SUCCESS (6.776s)
[628.662215] [098/133] (408s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[628.754704] Starting subtest: nonblocking-crc-frame-sequence
[628.757277] Starting dynamic subtest: pipe-A-eDP-1
[629.504436] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.748s)
[629.515617] Starting dynamic subtest: pipe-B-eDP-1
[630.885125] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.378s)
[630.896785] Starting dynamic subtest: pipe-C-eDP-1
[632.268589] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.384s)
[632.279895] Starting dynamic subtest: pipe-D-eDP-1
[633.612114] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.340s)
[633.614287] Subtest nonblocking-crc-frame-sequence: SUCCESS (4.856s)
[634.414357] [099/133] (403s left) i915_drm_fdinfo (memory-info-purgeable)
[634.457523] Starting subtest: memory-info-purgeable
[634.459767] Starting dynamic subtest: smem0
[637.444855] Dynamic subtest smem0: SUCCESS (2.987s)
[637.447401] Subtest memory-info-purgeable: SUCCESS (2.988s)
[637.521187] [100/133] (400s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[637.638752] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[637.642145] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[637.765068] [101/133] (399s left) gem_exec_schedule (u-semaphore-noskip)
[637.839958] Starting subtest: u-semaphore-noskip
[638.249219] Subtest u-semaphore-noskip: SUCCESS (0.412s)
[638.611286] [102/133] (399s left) perf (rc6-disable)
[638.699236] Starting subtest: rc6-disable
[638.867255] Subtest rc6-disable: SUCCESS (0.167s)
[638.917074] [103/133] (398s left) syncobj_timeline (etime-multi-wait-for-submit-available-unsubmitted)
[638.964022] Starting subtest: etime-multi-wait-for-submit-available-unsubmitted
[639.072202] Subtest etime-multi-wait-for-submit-available-unsubmitted: SUCCESS (0.106s)
[639.162526] [104/133] (398s left) gem_exec_params (sol-reset-not-gen7)
[639.225647] Starting subtest: sol-reset-not-gen7
[639.231111] Subtest sol-reset-not-gen7: SUCCESS (0.003s)
[639.337466] [105/133] (398s left) gem_mmap (basic-small-bo)
[639.392922] Subtest basic-small-bo: SKIP (0.000s)
[639.458978] [106/133] (398s left) kms_dsc (dsc-with-output-formats)
[639.562364] Starting subtest: dsc-with-output-formats
[639.584102] Subtest dsc-with-output-formats: SKIP (0.000s)
[639.655572] [107/133] (398s left) tools_test (tools_test)
[639.715638] Starting subtest: tools_test
[639.766625] Subtest tools_test: SUCCESS (0.068s)
[639.840873] [108/133] (398s left) kms_chamelium_hpd (hdmi-hpd-for-each-pipe)
[640.222981] Subtest hdmi-hpd-for-each-pipe: SKIP (0.000s)
[641.027678] [109/133] (396s left) kms_cursor_crc (cursor-rapid-movement-64x21)
[641.213780] Starting subtest: cursor-rapid-movement-64x21
[641.258343] Subtest cursor-rapid-movement-64x21: SKIP (0.042s)
[641.498897] [110/133] (396s left) gem_fence_thrash (bo-copy)
[641.536526] Starting subtest: bo-copy
[641.553012] Subtest bo-copy: SKIP (0.014s)
[641.616466] [111/133] (396s left) gem_pxp (protected-encrypted-src-copy-not-readible)
[641.749709] Starting subtest: protected-encrypted-src-copy-not-readible
[641.860500] Subtest protected-encrypted-src-copy-not-readible: SUCCESS (0.113s)
[641.986424] [112/133] (396s left) kms_cursor_edge_walk (128x128-top-bottom)
[642.077115] Starting subtest: 128x128-top-bottom
[642.079439] Starting dynamic subtest: pipe-A-eDP-1
[645.499310] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.422s)
[645.510595] Starting dynamic subtest: pipe-D-eDP-1
[648.651240] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.148s)
[648.653594] Subtest 128x128-top-bottom: SUCCESS (6.573s)
[649.454589] [113/133] (388s left) kms_chamelium_edid (hdmi-edid-read)
[649.854610] Subtest hdmi-edid-read: SKIP (0.000s)
[650.659400] [114/133] (387s left) gem_lmem_swapping (heavy-multi)
[650.709062] Subtest heavy-multi: SKIP (0.000s)
[650.755674] [115/133] (387s left) kms_frontbuffer_tracking (fbcpsr-1p-rte)
[650.846692] Starting subtest: fbcpsr-1p-rte
[657.927162] Subtest fbcpsr-1p-rte: SUCCESS (7.081s)
[658.089635] [116/133] (380s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[658.196605] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip
[658.201459] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[658.327424] [117/133] (379s left) kms_content_protection (lic-type-0-hdcp14)
[658.451415] Starting subtest: lic-type-0-hdcp14
[658.455931] Subtest lic-type-0-hdcp14: SKIP (0.000s)
[658.569886] [118/133] (379s left) kms_async_flips (async-flip-dpms)
[658.660843] Starting subtest: async-flip-dpms
[659.037492] Starting dynamic subtest: pipe-A-eDP-1
[662.850639] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.811s)
[663.241404] Starting dynamic subtest: pipe-B-eDP-1
[666.028874] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.792s)
[666.422978] Starting dynamic subtest: pipe-C-eDP-1
[669.197782] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.781s)
[669.580101] Starting dynamic subtest: pipe-D-eDP-1
[672.366159] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.790s)
[672.368236] Subtest async-flip-dpms: SUCCESS (13.700s)
[673.551423] [119/133] (364s left) gem_exec_balancer (parallel-keep-in-fence)
[673.813329] Starting subtest: parallel-keep-in-fence
[675.069670] Subtest parallel-keep-in-fence: SUCCESS (1.255s)
[675.175244] [120/133] (363s left) gem_mmap_wc (write-read)
[675.227996] Subtest write-read: SKIP (0.000s)
[675.286828] [121/133] (363s left) gem_userptr_blits (userfault)
[675.349385] Starting subtest: userfault
[675.351597] Subtest userfault: SUCCESS (0.008s)
[675.479181] [122/133] (363s left) kms_universal_plane (universal-plane-sanity)
[675.575399] Starting subtest: universal-plane-sanity
[675.577609] Starting dynamic subtest: pipe-A-eDP-1
[676.174866] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.599s)
[676.186745] Starting dynamic subtest: pipe-B-eDP-1
[677.390715] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.213s)
[677.402191] Starting dynamic subtest: pipe-C-eDP-1
[678.600583] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.208s)
[678.611948] Starting dynamic subtest: pipe-D-eDP-1
[679.842885] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.240s)
[679.845032] Subtest universal-plane-sanity: SUCCESS (4.266s)
[680.695066] [123/133] (357s left) kms_cursor_legacy (cursorb-vs-flipb-atomic-transitions-varying-size)
[680.837894] Starting subtest: cursorB-vs-flipB-atomic-transitions-varying-size
[680.842338] Subtest cursorB-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s)
[680.996742] [124/133] (357s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-pwrite)
[681.090047] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-pwrite
[688.330225] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (7.238s)
[688.469518] [125/133] (350s left) kms_big_fb (4-tiled-16bpp-rotate-90)
[688.573665] Starting subtest: 4-tiled-16bpp-rotate-90
[688.593513] Subtest 4-tiled-16bpp-rotate-90: SKIP (0.019s)
[688.702157] [126/133] (350s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-sf)
[688.797182] Starting subtest: fbc-psr2-overlay-plane-move-continuous-sf
[688.799309] Starting dynamic subtest: pipe-A-eDP-1
[688.892524] Dynamic subtest pipe-A-eDP-1: SKIP (0.099s)
[688.904099] Starting dynamic subtest: pipe-B-eDP-1
[690.021728] Dynamic subtest pipe-B-eDP-1: SKIP (1.126s)
[690.026207] Subtest fbc-psr2-overlay-plane-move-continuous-sf: SKIP (1.228s)
[691.209154] [127/133] (347s left) gen9_exec_parse (bb-start-param)
[691.265170] Subtest bb-start-param: SKIP (0.000s)
[691.333563] [128/133] (347s left) gem_exec_reloc (basic-write-gtt)
[691.405754] Subtest basic-write-gtt: SKIP (0.000s)
[691.488035] [129/133] (347s left) gem_ctx_isolation (preservation-reset)
[691.659461] Starting subtest: preservation-reset
[691.661667] Starting dynamic subtest: rcs0
[691.943699] Dynamic subtest rcs0: SUCCESS (0.287s)
[691.956890] Starting dynamic subtest: bcs0
[692.271916] Dynamic subtest bcs0: SUCCESS (0.327s)
[692.285568] Starting dynamic subtest: vcs0
[692.618033] Dynamic subtest vcs0: SUCCESS (0.345s)
[692.630157] Starting dynamic subtest: vcs1
[694.489708] Dynamic subtest vcs1: SUCCESS (1.870s)
[694.503267] Starting dynamic subtest: vecs0
[696.478654] Dynamic subtest vecs0: SUCCESS (1.987s)
[696.489520] Starting dynamic subtest: ccs0
[698.479375] Dynamic subtest ccs0: SUCCESS (1.998s)
[698.481938] Subtest preservation-reset: SUCCESS (6.822s)
[698.620148] [130/133] (340s left) gem_userptr_blits (sync-unmap-after-close)
[698.694999] Starting subtest: sync-unmap-after-close
[698.709191] Subtest sync-unmap-after-close: SUCCESS (0.017s)
[698.842583] [131/133] (340s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu)
[698.939699] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu
[702.902789] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (3.965s)
[704.018056] [132/133] (334s left) drm_read (short-buffer-block)
[704.165659] Starting subtest: short-buffer-block
[704.168062] Subtest short-buffer-block: SUCCESS (0.000s)
[704.293143] [133/133] (334s left) api_intel_bb (blit-reloc-keep-cache)
[704.349124] Starting subtest: blit-reloc-keep-cache
[704.353983] Subtest blit-reloc-keep-cache: SKIP (0.001s)
[704.463114] Closing watchdogs
results: parsing output: 0/ for test: kms_color
results: parsing output: 1/ for test: gem_exec_async
results: parsing output: 2/ for test: syncobj_timeline
results: parsing output: 3/ for test: syncobj_timeline
results: parsing output: 4/ for test: gem_exec_schedule
results: parsing output: 5/ for test: syncobj_timeline
results: parsing output: 6/ for test: gem_mmap_offset
results: parsing output: 7/ for test: kms_addfb_basic
results: parsing output: 8/ for test: vgem_basic
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: kms_flip
results: parsing output: 11/ for test: kms_pm_backlight
results: parsing output: 12/ for test: kms_plane_lowres
results: parsing output: 13/ for test: kms_psr
results: parsing output: 14/ for test: kms_big_fb
results: parsing output: 15/ for test: kms_ccs
results: parsing output: 16/ for test: gem_exec_fence
results: parsing output: 17/ for test: kms_cursor_crc
results: parsing output: 18/ for test: vgem_basic
results: parsing output: 19/ for test: prime_mmap
results: parsing output: 20/ for test: prime_self_import
results: parsing output: 21/ for test: kms_cursor_legacy
results: parsing output: 22/ for test: kms_psr
results: parsing output: 23/ for test: kms_big_fb
results: parsing output: 24/ for test: kms_vblank
results: parsing output: 25/ for test: i915_pm_rps
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: perf_pmu
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: gem_eio
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: gem_mmap_gtt
results: parsing output: 32/ for test: gem_softpin
results: parsing output: 33/ for test: gem_exec_whisper
results: parsing output: 34/ for test: kms_big_fb
results: parsing output: 35/ for test: gem_mmap_gtt
results: parsing output: 36/ for test: kms_big_fb
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_psr
results: parsing output: 39/ for test: prime_busy
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: kms_plane_scaling
results: parsing output: 42/ for test: kms_psr
results: parsing output: 43/ for test: kms_cursor_legacy
results: parsing output: 44/ for test: kms_flip
results: parsing output: 45/ for test: kms_hdr
results: parsing output: 46/ for test: i915_pm_freq_api
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: gem_exec_balancer
results: parsing output: 49/ for test: gem_render_copy
results: parsing output: 50/ for test: prime_mmap
results: parsing output: 51/ for test: core_getversion
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: syncobj_wait
results: parsing output: 54/ for test: gem_mmap_wc
results: parsing output: 55/ for test: gem_basic
results: parsing output: 56/ for test: syncobj_wait
results: parsing output: 57/ for test: kms_ccs
results: parsing output: 58/ for test: gem_userptr_blits
results: parsing output: 59/ for test: kms_flip
results: parsing output: 60/ for test: core_auth
results: parsing output: 61/ for test: gem_mmap_gtt
results: parsing output: 62/ for test: kms_ccs
results: parsing output: 63/ for test: perf
results: parsing output: 64/ for test: gem_mmap_gtt
results: parsing output: 65/ for test: kms_ccs
results: parsing output: 66/ for test: kms_plane
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: kms_async_flips
results: parsing output: 69/ for test: gem_exec_reloc
results: parsing output: 70/ for test: kms_flip_scaled_crc
results: parsing output: 71/ for test: syncobj_timeline
results: parsing output: 72/ for test: gem_exec_nop
results: parsing output: 73/ for test: sysfs_timeslice_duration
results: parsing output: 74/ for test: kms_plane_scaling
results: parsing output: 75/ for test: gem_exec_flush
results: parsing output: 76/ for test: i915_query
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: kms_panel_fitting
results: parsing output: 79/ for test: kms_psr
results: parsing output: 80/ for test: kms_pm_rpm
results: parsing output: 81/ for test: gem_ctx_shared
results: parsing output: 82/ for test: kms_big_fb
results: parsing output: 83/ for test: kms_joiner
results: parsing output: 84/ for test: kms_lease
results: parsing output: 85/ for test: kms_dirtyfb
results: parsing output: 86/ for test: kms_psr2_sf
results: parsing output: 87/ for test: gem_exec_reloc
results: parsing output: 88/ for test: gem_exec_reloc
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: gem_ctx_engines
results: parsing output: 91/ for test: perf
results: parsing output: 92/ for test: kms_chamelium_color
results: parsing output: 93/ for test: gem_exec_params
results: parsing output: 94/ for test: kms_psr
results: parsing output: 95/ for test: gem_exec_capture
results: parsing output: 96/ for test: kms_rotation_crc
results: parsing output: 97/ for test: kms_pipe_crc_basic
results: parsing output: 98/ for test: i915_drm_fdinfo
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: gem_exec_schedule
results: parsing output: 101/ for test: perf
results: parsing output: 102/ for test: syncobj_timeline
results: parsing output: 103/ for test: gem_exec_params
results: parsing output: 104/ for test: gem_mmap
results: parsing output: 105/ for test: kms_dsc
results: parsing output: 106/ for test: tools_test
results: parsing output: 107/ for test: kms_chamelium_hpd
results: parsing output: 108/ for test: kms_cursor_crc
results: parsing output: 109/ for test: gem_fence_thrash
results: parsing output: 110/ for test: gem_pxp
results: parsing output: 111/ for test: kms_cursor_edge_walk
results: parsing output: 112/ for test: kms_chamelium_edid
results: parsing output: 113/ for test: gem_lmem_swapping
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: kms_big_fb
results: parsing output: 116/ for test: kms_content_protection
results: parsing output: 117/ for test: kms_async_flips
results: parsing output: 118/ for test: gem_exec_balancer
results: parsing output: 119/ for test: gem_mmap_wc
results: parsing output: 120/ for test: gem_userptr_blits
results: parsing output: 121/ for test: kms_universal_plane
results: parsing output: 122/ for test: kms_cursor_legacy
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_big_fb
results: parsing output: 125/ for test: kms_psr2_sf
results: parsing output: 126/ for test: gen9_exec_parse
results: parsing output: 127/ for test: gem_exec_reloc
results: parsing output: 128/ for test: gem_ctx_isolation
results: parsing output: 129/ for test: gem_userptr_blits
results: parsing output: 130/ for test: kms_frontbuffer_tracking
results: parsing output: 131/ for test: drm_read
results: parsing output: 132/ for test: api_intel_bb
Done.