[61.314654] Initializing watchdogs
[61.314761]   /dev/watchdog0
[61.329242] [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]
[61.333548] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[61.336447] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[61.339955] [001/133] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt)
[61.462556] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt
[61.466611] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[61.583214] [002/133] (960s left) i915_pm_rps (thresholds-idle)
[61.656367] Starting subtest: thresholds-idle
[61.661100] Subtest thresholds-idle: SKIP (0.001s)
[61.754763] [003/133] (960s left) perf_pmu (rc6-suspend)
[61.796682] Starting subtest: rc6-suspend
[84.389913] Subtest rc6-suspend: SUCCESS (7.627s)
[85.293466] [004/133] (936s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs)
[85.416941] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs
[85.418718] Starting dynamic subtest: pipe-A-eDP-1
[85.467668] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[85.475051] Starting dynamic subtest: pipe-B-eDP-1
[85.520492] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[85.529030] Starting dynamic subtest: pipe-C-eDP-1
[85.574882] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[85.583296] Starting dynamic subtest: pipe-D-eDP-1
[85.630550] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[85.634277] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs: SKIP (0.008s)
[87.965054] [005/133] (934s left) gem_caching (reads)
[88.027185] Subtest reads: SKIP (0.000s)
[88.096787] [006/133] (933s left) gem_userptr_blits (map-fixed-invalidate-overlap)
[88.167541] Starting subtest: map-fixed-invalidate-overlap
[88.171649] Subtest map-fixed-invalidate-overlap: SKIP (0.000s)
[88.286522] [007/133] (933s left) sw_sync (sync_random_merge)
[88.329765] Starting subtest: sync_random_merge
[88.373390] Subtest sync_random_merge: SUCCESS (0.045s)
[88.441486] [008/133] (933s left) gem_exec_whisper (basic-contexts-priority-all)
[88.505745] Starting subtest: basic-contexts-priority-all
[110.868037] Subtest basic-contexts-priority-all: SUCCESS (22.328s)
[111.047198] [009/133] (911s left) kms_flip (plain-flip-fb-recreate-interruptible)
[111.147674] Starting subtest: plain-flip-fb-recreate-interruptible
[111.150069] Starting dynamic subtest: A-eDP1
[120.004599] Dynamic subtest A-eDP1: SUCCESS (8.859s)
[120.013677] Starting dynamic subtest: B-eDP1
[128.830008] Dynamic subtest B-eDP1: SUCCESS (8.824s)
[128.842346] Starting dynamic subtest: C-eDP1
[137.637872] Dynamic subtest C-eDP1: SUCCESS (8.805s)
[137.653103] Starting dynamic subtest: D-eDP1
[146.471066] Dynamic subtest D-eDP1: SUCCESS (8.830s)
[146.476605] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (35.330s)
[147.657545] [010/133] (874s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted)
[147.714363] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted
[147.818036] Subtest etime-multi-wait-all-available-unsubmitted-submitted: SUCCESS (0.103s)
[147.894222] [011/133] (874s left) gem_exec_params (invalid-bsd1-flag-on-render)
[147.966435] Starting subtest: invalid-bsd1-flag-on-render
[147.968670] Subtest invalid-bsd1-flag-on-render: SUCCESS (0.000s)
[148.059928] [012/133] (874s left) gem_eio (in-flight-contexts-10ms)
[148.287616] Starting subtest: in-flight-contexts-10ms
[161.862679] Subtest in-flight-contexts-10ms: SUCCESS (13.570s)
[162.033496] [013/133] (860s left) gem_exec_schedule (manyslice)
[162.106108] Starting subtest: manyslice
[162.108165] Starting dynamic subtest: rcs0
[167.232386] Dynamic subtest rcs0: SUCCESS (5.135s)
[167.244620] Starting dynamic subtest: bcs0
[174.364131] Dynamic subtest bcs0: SUCCESS (7.129s)
[174.374057] Starting dynamic subtest: vcs0
[180.460377] Dynamic subtest vcs0: SUCCESS (6.096s)
[180.476010] Starting dynamic subtest: vcs1
[187.058548] Dynamic subtest vcs1: SUCCESS (6.599s)
[187.072037] Starting dynamic subtest: vecs0
[193.140933] Dynamic subtest vecs0: SUCCESS (6.082s)
[193.151395] Starting dynamic subtest: ccs0
[200.350470] Dynamic subtest ccs0: SUCCESS (7.209s)
[200.354431] Subtest manyslice: SUCCESS (38.255s)
[200.658085] [014/133] (821s left) gem_exec_reloc (basic-wc-gtt-noreloc)
[200.717348] Subtest basic-wc-gtt-noreloc: SKIP (0.000s)
[200.790397] [015/133] (821s left) kms_vblank (query-busy-hang)
[200.884054] Starting subtest: query-busy-hang
[200.886188] Starting dynamic subtest: pipe-A-eDP-1
[228.595141] Dynamic subtest pipe-A-eDP-1: SUCCESS (27.707s)
[228.614243] Starting dynamic subtest: pipe-D-eDP-1
[253.614059] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.011s)
[253.616200] Subtest query-busy-hang: SUCCESS (52.722s)
[254.417253] [016/133] (768s left) fbdev (nullptr)
[254.466407] Starting subtest: nullptr
[254.468791] Subtest nullptr: SUCCESS (0.000s)
[254.535620] [017/133] (767s left) kms_invalid_mode (bad-htotal)
[254.635966] Starting subtest: bad-htotal
[254.638364] Starting dynamic subtest: pipe-A-eDP-1
[254.919406] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.286s)
[254.930391] Starting dynamic subtest: pipe-B-eDP-1
[254.932779] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[254.942229] Starting dynamic subtest: pipe-C-eDP-1
[254.944266] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[254.953636] Starting dynamic subtest: pipe-D-eDP-1
[254.955962] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[254.958389] Subtest bad-htotal: SUCCESS (0.290s)
[255.746239] [018/133] (766s left) kms_dither (fb-8bpc-vs-panel-8bpc)
[255.837938] Starting subtest: fb-8bpc-vs-panel-8bpc
[255.840381] Starting dynamic subtest: pipe-A-eDP-1
[257.197235] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.359s)
[257.199201] Subtest fb-8bpc-vs-panel-8bpc: SUCCESS (1.360s)
[258.000120] [019/133] (764s left) kms_plane_scaling (planes-upscale-factor-0-25)
[258.098911] Starting subtest: planes-upscale-factor-0-25
[258.101298] Starting dynamic subtest: pipe-A
[258.159643] Dynamic subtest pipe-A: SUCCESS (0.063s)
[258.172172] Starting dynamic subtest: pipe-B
[259.325467] Dynamic subtest pipe-B: SUCCESS (1.165s)
[259.340747] Starting dynamic subtest: pipe-C
[260.439931] Dynamic subtest pipe-C: SUCCESS (1.113s)
[260.449639] Starting dynamic subtest: pipe-D
[261.576365] Dynamic subtest pipe-D: SUCCESS (1.136s)
[261.578812] Subtest planes-upscale-factor-0-25: SUCCESS (3.479s)
[262.737963] [020/133] (759s left) syncobj_timeline (multi-wait-for-submit-signaled)
[262.785620] Starting subtest: multi-wait-for-submit-signaled
[262.788003] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[262.874033] [021/133] (759s left) kms_frontbuffer_tracking (fbc-rgb565-draw-render)
[262.964225] Starting subtest: fbc-rgb565-draw-render
[267.150145] Subtest fbc-rgb565-draw-render: SUCCESS (4.188s)
[268.367401] [022/133] (754s left) prime_busy (before)
[268.439521] Starting subtest: before
[268.442024] Starting dynamic subtest: rcs0
[268.480420] Dynamic subtest rcs0: SUCCESS (0.038s)
[268.492012] Starting dynamic subtest: bcs0
[268.520058] Dynamic subtest bcs0: SUCCESS (0.038s)
[268.531269] Starting dynamic subtest: vcs0
[268.560715] Dynamic subtest vcs0: SUCCESS (0.041s)
[268.570830] Starting dynamic subtest: vcs1
[268.601411] Dynamic subtest vcs1: SUCCESS (0.042s)
[268.611717] Starting dynamic subtest: vecs0
[268.643525] Dynamic subtest vecs0: SUCCESS (0.042s)
[268.653794] Starting dynamic subtest: ccs0
[268.683467] Dynamic subtest ccs0: SUCCESS (0.040s)
[268.792529] Subtest before: SUCCESS (0.352s)
[268.863437] [023/133] (753s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt)
[268.973871] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt
[268.978418] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[269.062541] [024/133] (753s left) kms_psr (psr-sprite-blt)
[269.155710] Starting subtest: psr-sprite-blt
[269.158165] Starting dynamic subtest: eDP-1
[270.862110] Dynamic subtest eDP-1: SUCCESS (1.706s)
[270.864358] Subtest psr-sprite-blt: SUCCESS (1.707s)
[271.721084] [025/133] (751s left) kms_cursor_crc (cursor-sliding-128x42)
[271.960445] Starting subtest: cursor-sliding-128x42
[272.009726] Subtest cursor-sliding-128x42: SKIP (0.045s)
[272.262006] [026/133] (750s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[272.326321] Starting subtest: x-tiled-to-vebox-y-tiled
[272.330813] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[272.508730] [027/133] (750s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-onoff)
[272.602393] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-onoff
[272.606811] Subtest fbcpsr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[272.702672] [028/133] (750s left) kms_plane (pixel-format-4-tiled-dg2-mc-ccs-modifier)
[272.795867] Starting subtest: pixel-format-4-tiled-dg2-mc-ccs-modifier
[272.800326] Subtest pixel-format-4-tiled-dg2-mc-ccs-modifier: SKIP (0.000s)
[272.892873] [029/133] (750s left) kms_psr (fbc-psr-no-drrs)
[272.992886] Starting subtest: fbc-psr-no-drrs
[272.994853] Starting dynamic subtest: eDP-1
[272.998992] Dynamic subtest eDP-1: SKIP (0.000s)
[273.003198] Subtest fbc-psr-no-drrs: SKIP (0.001s)
[273.063714] [030/133] (749s left) kms_busy (basic-hang)
[273.157296] Starting subtest: basic-hang
[273.159604] Starting dynamic subtest: flip-pipe-A
[273.751352] Dynamic subtest flip-pipe-A: SUCCESS (0.593s)
[273.763532] Starting dynamic subtest: modeset-pipe-A
[277.132981] Dynamic subtest modeset-pipe-A: SUCCESS (3.379s)
[277.144381] Starting dynamic subtest: flip-pipe-D
[278.346242] Dynamic subtest flip-pipe-D: SUCCESS (1.211s)
[278.357230] Starting dynamic subtest: modeset-pipe-D
[281.778481] Dynamic subtest modeset-pipe-D: SUCCESS (3.432s)
[281.780695] Subtest basic-hang: SUCCESS (8.620s)
[282.575852] [031/133] (740s left) gem_mmap_wc (write-prefaulted)
[282.634743] Subtest write-prefaulted: SKIP (0.000s)
[282.690149] [032/133] (740s left) gem_flink_basic (basic)
[282.749404] Starting subtest: basic
[282.751283] Subtest basic: SUCCESS (0.000s)
[282.836975] [033/133] (740s left) kms_psr2_sf (pr-overlay-primary-update-sf-dmg-area)
[282.926820] Starting subtest: pr-overlay-primary-update-sf-dmg-area
[282.930906] Subtest pr-overlay-primary-update-sf-dmg-area: SKIP (0.000s)
[282.991884] [034/133] (740s left) gem_exec_schedule (timeslicing)
[283.058512] Starting subtest: timeslicing
[283.060814] Starting dynamic subtest: rcs0
[283.069904] Dynamic subtest rcs0: SUCCESS (0.021s)
[283.082301] Starting dynamic subtest: bcs0
[283.090092] Dynamic subtest bcs0: SUCCESS (0.020s)
[283.099939] Starting dynamic subtest: vcs0
[283.112426] Dynamic subtest vcs0: SUCCESS (0.022s)
[283.122655] Starting dynamic subtest: vcs1
[283.132669] Dynamic subtest vcs1: SUCCESS (0.020s)
[283.142489] Starting dynamic subtest: vecs0
[283.153422] Dynamic subtest vecs0: SUCCESS (0.020s)
[283.163848] Starting dynamic subtest: ccs0
[283.174613] Dynamic subtest ccs0: SUCCESS (0.020s)
[283.176952] Subtest timeslicing: SUCCESS (0.126s)
[284.885834] [035/133] (738s left) gem_softpin (evict-snoop-interruptible)
[284.956903] Starting subtest: evict-snoop-interruptible
[284.961428] Subtest evict-snoop-interruptible: SKIP (0.000s)
[285.070736] [036/133] (738s left) kms_addfb_basic (basic-y-tiled-legacy)
[285.127719] Starting subtest: basic-y-tiled-legacy
[285.132187] Subtest basic-y-tiled-legacy: SKIP (0.000s)
[285.259259] [037/133] (738s left) gem_ctx_persistence (engines-persistence)
[285.313825] Starting subtest: engines-persistence
[285.315891] Starting dynamic subtest: rcs0
[286.125633] Dynamic subtest rcs0: SUCCESS (0.813s)
[286.138396] Starting dynamic subtest: bcs0
[286.887245] Dynamic subtest bcs0: SUCCESS (0.760s)
[286.900229] Starting dynamic subtest: vcs0
[287.654608] Dynamic subtest vcs0: SUCCESS (0.765s)
[287.667670] Starting dynamic subtest: vcs1
[288.425676] Dynamic subtest vcs1: SUCCESS (0.769s)
[288.438449] Starting dynamic subtest: vecs0
[289.191496] Dynamic subtest vecs0: SUCCESS (0.764s)
[289.204458] Starting dynamic subtest: ccs0
[289.963784] Dynamic subtest ccs0: SUCCESS (0.770s)
[289.966372] Subtest engines-persistence: SUCCESS (4.651s)
[290.043435] [038/133] (733s left) gem_madvise (dontneed-before-exec)
[290.078847] Starting subtest: dontneed-before-exec
[290.092797] Subtest dontneed-before-exec: SKIP (0.012s)
[290.154068] [039/133] (733s left) kms_lease (lease-again)
[290.251341] Starting subtest: lease-again
[290.253609] Starting dynamic subtest: pipe-A-eDP-1
[290.255910] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.002s)
[290.267362] Starting dynamic subtest: pipe-B-eDP-1
[290.269269] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.002s)
[290.278989] Starting dynamic subtest: pipe-C-eDP-1
[290.280897] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.002s)
[290.290134] Starting dynamic subtest: pipe-D-eDP-1
[290.292087] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.002s)
[290.294022] Subtest lease-again: SUCCESS (0.011s)
[290.365805] [040/133] (733s left) kms_pm_rpm (modeset-non-lpsp)
[291.893783] Starting subtest: modeset-non-lpsp
[293.048053] Subtest modeset-non-lpsp: SKIP (1.154s)
[293.424075] [041/133] (730s left) kms_plane (pixel-format-yf-tiled-ccs-modifier)
[293.515537] Starting subtest: pixel-format-yf-tiled-ccs-modifier
[293.519671] Subtest pixel-format-yf-tiled-ccs-modifier: SKIP (0.000s)
[293.585533] [042/133] (729s left) i915_pm_rpm (system-suspend-execbuf)
[295.116548] Starting subtest: system-suspend-execbuf
[353.053959] Subtest system-suspend-execbuf: SUCCESS (42.873s)
[353.424389] [043/133] (670s left) gem_exec_balancer (busy)
[353.485746] Starting subtest: busy
[354.819437] Subtest busy: SUCCESS (1.336s)
[355.122317] [044/133] (668s left) gem_mmap_gtt (flink-race)
[355.185879] Subtest flink-race: SKIP (0.000s)
[355.237239] [045/133] (668s left) gem_exec_reloc (basic-write-wc-active)
[355.292062] Subtest basic-write-wc-active: SKIP (0.000s)
[355.367468] [046/133] (668s left) kms_psr (psr2-cursor-plane-move)
[355.473488] Starting subtest: psr2-cursor-plane-move
[355.475766] Starting dynamic subtest: eDP-1
[357.161743] Dynamic subtest eDP-1: SUCCESS (1.689s)
[357.164103] Subtest psr2-cursor-plane-move: SUCCESS (1.690s)
[357.964276] [047/133] (665s left) prime_vgem (fence-read-hang)
[358.112509] Subtest fence-read-hang: SKIP (0.000s)
[358.228814] [FACT prime_vgem (fence-read-hang)] new: kernel.kmod_is_loaded.vgem: true
[358.232496] [048/133] (665s left) core_hotunplug (unbind-rebind)
[358.317060] Starting subtest: unbind-rebind
[364.211830] Subtest unbind-rebind: SUCCESS (5.896s)
[364.257273] [049/133] (659s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-move)
[365.839050] Starting subtest: fbc-2p-primscrn-cur-indfb-move
[365.843642] Subtest fbc-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[365.944512] [050/133] (657s left) perf (non-system-wide-paranoid)
[366.069625] Starting subtest: non-system-wide-paranoid
[366.101554] Subtest non-system-wide-paranoid: SUCCESS (0.032s)
[366.151821] [051/133] (657s left) kms_flip (flip-vs-expired-vblank-interruptible)
[366.246738] Starting subtest: flip-vs-expired-vblank-interruptible
[366.249019] Starting dynamic subtest: A-eDP1
[374.918879] Dynamic subtest A-eDP1: SUCCESS (8.669s)
[374.935032] Starting dynamic subtest: B-eDP1
[383.549825] Dynamic subtest B-eDP1: SUCCESS (8.627s)
[383.562040] Starting dynamic subtest: C-eDP1
[392.170070] Dynamic subtest C-eDP1: SUCCESS (8.615s)
[392.187479] Starting dynamic subtest: D-eDP1
[400.801369] Dynamic subtest D-eDP1: SUCCESS (8.627s)
[400.806358] Subtest flip-vs-expired-vblank-interruptible: SUCCESS (34.550s)
[401.971752] [052/133] (621s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-sf)
[402.083076] Starting subtest: fbc-pr-overlay-plane-move-continuous-sf
[402.087353] Subtest fbc-pr-overlay-plane-move-continuous-sf: SKIP (0.000s)
[402.154055] [053/133] (621s left) syncobj_timeline (wait-all-for-submit-complex)
[402.212363] Starting subtest: wait-all-for-submit-complex
[402.428273] Subtest wait-all-for-submit-complex: SUCCESS (0.214s)
[402.501736] [054/133] (621s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs)
[402.590529] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs
[402.592906] Starting dynamic subtest: pipe-A-eDP-1
[402.613450] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[402.625111] Starting dynamic subtest: pipe-B-eDP-1
[402.644441] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[402.654103] Starting dynamic subtest: pipe-C-eDP-1
[402.672939] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[402.682836] Starting dynamic subtest: pipe-D-eDP-1
[402.702049] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[402.703941] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SUCCESS (0.007s)
[404.827603] [055/133] (619s left) gen9_exec_parse (basic-rejected)
[404.898161] Subtest basic-rejected: SKIP (0.000s)
[404.959669] [056/133] (619s left) prime_self_import (export-vs-gem_close-race)
[404.996071] Starting subtest: export-vs-gem_close-race
[410.092582] Subtest export-vs-gem_close-race: SUCCESS (5.093s)
[410.186676] [057/133] (613s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc)
[410.306397] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc
[410.308695] Starting dynamic subtest: pipe-A-eDP-1
[410.330948] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[410.348061] Starting dynamic subtest: pipe-B-eDP-1
[410.369469] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[410.385442] Starting dynamic subtest: pipe-C-eDP-1
[410.406949] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[410.422593] Starting dynamic subtest: pipe-D-eDP-1
[410.444403] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[410.449069] Subtest crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc: SKIP (0.005s)
[412.590830] [058/133] (611s left) gem_create (create-ext-placement-sanity-check)
[412.758444] Starting subtest: create-ext-placement-sanity-check
[412.764848] Subtest create-ext-placement-sanity-check: SUCCESS (0.005s)
[412.877228] [059/133] (611s left) kms_psr (fbc-pr-cursor-blt)
[412.985682] Starting subtest: fbc-pr-cursor-blt
[412.990357] Subtest fbc-pr-cursor-blt: SKIP (0.000s)
[413.064300] [060/133] (611s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-pwrite)
[413.158827] Starting subtest: psr-1p-offscreen-pri-indfb-draw-pwrite
[420.359410] Subtest psr-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (7.206s)
[420.475172] [061/133] (603s left) gem_workarounds (reset)
[420.542140] Starting subtest: reset
[420.651375] Subtest reset: SUCCESS (0.108s)
[420.795223] [062/133] (603s left) kms_plane (plane-position-hole-dpms)
[420.894646] Starting subtest: plane-position-hole-dpms
[421.419905] Starting dynamic subtest: pipe-A-plane-1
[423.842792] Dynamic subtest pipe-A-plane-1: SUCCESS (2.424s)
[423.854756] Starting dynamic subtest: pipe-A-plane-2
[426.218627] Dynamic subtest pipe-A-plane-2: SUCCESS (2.376s)
[426.230768] Starting dynamic subtest: pipe-A-plane-3
[428.617108] Dynamic subtest pipe-A-plane-3: SUCCESS (2.397s)
[428.628884] Starting dynamic subtest: pipe-A-plane-4
[431.062116] Dynamic subtest pipe-A-plane-4: SUCCESS (2.442s)
[431.072931] Starting dynamic subtest: pipe-A-plane-5
[431.086257] Dynamic subtest pipe-A-plane-5: SUCCESS (0.024s)
[432.224603] Starting dynamic subtest: pipe-B-plane-1
[434.651703] Dynamic subtest pipe-B-plane-1: SUCCESS (2.437s)
[434.663241] Starting dynamic subtest: pipe-B-plane-2
[437.015504] Dynamic subtest pipe-B-plane-2: SUCCESS (2.361s)
[437.025799] Starting dynamic subtest: pipe-B-plane-3
[439.369584] Dynamic subtest pipe-B-plane-3: SUCCESS (2.355s)
[439.380360] Starting dynamic subtest: pipe-B-plane-4
[441.734992] Dynamic subtest pipe-B-plane-4: SUCCESS (2.364s)
[441.746480] Starting dynamic subtest: pipe-B-plane-5
[441.765259] Dynamic subtest pipe-B-plane-5: SUCCESS (0.028s)
[441.767612] Subtest plane-position-hole-dpms: SUCCESS (20.874s)
[442.544604] [063/133] (581s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[442.645929] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[442.650045] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[442.746882] [064/133] (581s left) kms_plane_alpha_blend (constant-alpha-min)
[442.844455] Starting subtest: constant-alpha-min
[443.134438] Starting dynamic subtest: pipe-A-eDP-1
[443.860800] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.726s)
[443.872276] Starting dynamic subtest: pipe-D-eDP-1
[445.306683] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.445s)
[445.308981] Subtest constant-alpha-min: SUCCESS (2.463s)
[446.106781] [065/133] (578s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0)
[446.206061] Starting subtest: linear-max-hw-stride-64bpp-rotate-0
[447.320929] Subtest linear-max-hw-stride-64bpp-rotate-0: SUCCESS (1.114s)
[447.428747] [066/133] (577s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-move)
[447.536351] Starting subtest: psr-1p-primscrn-spr-indfb-move
[455.089838] Subtest psr-1p-primscrn-spr-indfb-move: SUCCESS (7.554s)
[455.235315] [067/133] (569s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc)
[455.350065] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc
[462.398795] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (7.048s)
[462.511300] [068/133] (562s left) gem_fenced_exec_thrash (too-many-fences)
[462.574282] Subtest too-many-fences: SKIP (0.000s)
[462.656346] [069/133] (562s left) gem_softpin (allocator-nopin-reserve)
[462.716216] Starting subtest: allocator-nopin-reserve
[462.811038] Subtest allocator-nopin-reserve: SUCCESS (0.094s)
[462.958754] [070/133] (561s left) kms_color_pipeline (plane-lut1d-post-ctm3x4)
[463.046473] Starting subtest: plane-lut1d-post-ctm3x4
[463.215143] Starting dynamic subtest: pipe-A-plane-0
[463.566658] Dynamic subtest pipe-A-plane-0: FAIL (0.209s)
[463.578509] Starting dynamic subtest: pipe-A-plane-1
[463.788702] Dynamic subtest pipe-A-plane-1: FAIL (0.190s)
[463.798940] Starting dynamic subtest: pipe-A-plane-2
[464.004845] Dynamic subtest pipe-A-plane-2: FAIL (0.186s)
[465.065444] Starting dynamic subtest: pipe-B-plane-0
[465.509036] Dynamic subtest pipe-B-plane-0: FAIL (0.185s)
[465.520374] Starting dynamic subtest: pipe-B-plane-1
[465.832676] Dynamic subtest pipe-B-plane-1: FAIL (0.187s)
[465.843652] Starting dynamic subtest: pipe-B-plane-2
[466.143440] Dynamic subtest pipe-B-plane-2: FAIL (0.158s)
[466.791930] Starting dynamic subtest: pipe-C-plane-0
[467.300668] Dynamic subtest pipe-C-plane-0: FAIL (0.151s)
[467.312688] Starting dynamic subtest: pipe-C-plane-1
[467.702744] Dynamic subtest pipe-C-plane-1: FAIL (0.616s)
[467.713308] Starting dynamic subtest: pipe-C-plane-2
[468.074520] Dynamic subtest pipe-C-plane-2: FAIL (0.172s)
[468.919616] Starting dynamic subtest: pipe-D-plane-0
[469.526980] Dynamic subtest pipe-D-plane-0: FAIL (0.159s)
[469.539102] Starting dynamic subtest: pipe-D-plane-1
[469.987320] Dynamic subtest pipe-D-plane-1: FAIL (0.634s)
[469.997550] Starting dynamic subtest: pipe-D-plane-2
[470.425035] Dynamic subtest pipe-D-plane-2: FAIL (0.546s)
[470.559507] Subtest plane-lut1d-post-ctm3x4: FAIL (7.514s)
[471.399015] [071/133] (553s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-pwrite)
[471.508985] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-pwrite
[475.967516] Subtest fbc-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (4.459s)
[477.118383] [072/133] (547s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-cpu)
[477.214325] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-cpu
[477.218507] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[477.340973] [073/133] (547s left) kms_pm_dc (dc5-dpms)
[478.446453] Starting subtest: dc5-dpms
[480.564066] Subtest dc5-dpms: SUCCESS (2.118s)
[480.642405] [074/133] (544s left) syncobj_wait (wait-all-interrupted)
[480.701653] Starting subtest: wait-all-interrupted
[480.803004] Subtest wait-all-interrupted: SUCCESS (0.101s)
[480.878470] [075/133] (544s left) kms_psr (fbc-psr2-sprite-blt)
[480.974550] Starting subtest: fbc-psr2-sprite-blt
[480.976821] Starting dynamic subtest: eDP-1
[480.981107] Dynamic subtest eDP-1: SKIP (0.000s)
[480.985489] Subtest fbc-psr2-sprite-blt: SKIP (0.001s)
[481.049059] [076/133] (543s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0)
[481.151041] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0
[481.155645] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[481.239347] [077/133] (543s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-plflip-blt)
[481.336244] Starting subtest: fbcpsr-2p-scndscrn-shrfb-plflip-blt
[481.340578] Subtest fbcpsr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[481.442555] [078/133] (543s left) kms_vrr (seamless-rr-switch-vrr)
[481.533615] Starting subtest: seamless-rr-switch-vrr
[481.540280] Subtest seamless-rr-switch-vrr: SKIP (0.000s)
[481.644835] [079/133] (543s left) kms_big_fb (y-tiled-64bpp-rotate-0)
[481.747333] Starting subtest: y-tiled-64bpp-rotate-0
[481.751803] Subtest y-tiled-64bpp-rotate-0: SKIP (0.000s)
[481.848732] [080/133] (543s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[481.952489] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[482.635233] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.684s)
[482.818242] [081/133] (542s left) kms_cursor_legacy (basic-busy-flip-before-cursor-varying-size)
[482.936468] Starting subtest: basic-busy-flip-before-cursor-varying-size
[482.941171] Subtest basic-busy-flip-before-cursor-varying-size: SKIP (0.000s)
[483.079817] [082/133] (542s left) i915_drm_fdinfo (memory-info-idle)
[483.117448] Starting subtest: memory-info-idle
[483.119814] Starting dynamic subtest: smem0
[483.158927] Dynamic subtest smem0: SUCCESS (0.042s)
[483.161504] Subtest memory-info-idle: SUCCESS (0.043s)
[483.234769] [083/133] (542s left) i915_fb_tiling (basic-x-tiling)
[483.287509] Subtest basic-x-tiling: SKIP (0.000s)
[483.348272] [084/133] (542s left) gem_ringfill (basic-all)
[488.831604] Starting subtest: basic-all
[490.007117] Subtest basic-all: SUCCESS (1.175s)
[490.131180] [085/133] (535s left) gem_softpin (noreloc-s3)
[490.192955] Starting subtest: noreloc-S3
[510.323269] Subtest noreloc-S3: SUCCESS (5.406s)
[510.431544] [086/133] (515s left) gem_mmap_gtt (basic-small-copy-xy)
[510.494746] Subtest basic-small-copy-XY: SKIP (0.000s)
[510.585360] [087/133] (514s left) gem_exec_params (rel-constants-invalid-ring)
[510.647459] Starting subtest: rel-constants-invalid-ring
[510.650016] Subtest rel-constants-invalid-ring: SUCCESS (0.000s)
[510.760642] [088/133] (514s left) kms_chamelium_color (ctm-blue-to-red)
[510.860655] Subtest ctm-blue-to-red: SKIP (0.000s)
[510.906454] [089/133] (514s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs-cc)
[510.994658] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs-cc
[510.996533] Starting dynamic subtest: pipe-A-eDP-1
[511.855613] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.851s)
[511.865886] Starting dynamic subtest: pipe-B-eDP-1
[513.441544] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.574s)
[513.453088] Starting dynamic subtest: pipe-C-eDP-1
[514.974038] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.528s)
[514.986833] Starting dynamic subtest: pipe-D-eDP-1
[516.488890] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.508s)
[516.490770] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.466s)
[517.631562] [090/133] (508s left) kms_chamelium_hpd (dp-hpd-storm)
[518.019711] Subtest dp-hpd-storm: SKIP (0.000s)
[518.854279] [091/133] (506s left) syncobj_timeline (multi-wait-all-available-signaled)
[518.911542] Starting subtest: multi-wait-all-available-signaled
[518.913950] Subtest multi-wait-all-available-signaled: SUCCESS (0.000s)
[519.014199] [092/133] (506s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-upscaling)
[519.106575] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-upscaling
[519.110745] Subtest flip-64bpp-yftile-to-16bpp-yftile-upscaling: SKIP (0.000s)
[519.179077] [093/133] (506s left) gem_mmap_gtt (basic-copy)
[519.239745] Subtest basic-copy: SKIP (0.000s)
[519.306893] [094/133] (506s left) gem_exec_reloc (basic-gtt-cpu)
[519.372422] Subtest basic-gtt-cpu: SKIP (0.000s)
[519.462581] [095/133] (506s left) kms_dsc (dsc-with-bpc)
[519.549750] Starting subtest: dsc-with-bpc
[519.579545] Subtest dsc-with-bpc: SKIP (0.001s)
[519.625907] [096/133] (506s left) syncobj_timeline (etime-single-wait-available-unsubmitted)
[519.683939] Starting subtest: etime-single-wait-available-unsubmitted
[519.788028] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.102s)
[519.866560] [097/133] (506s left) gem_lmem_swapping (parallel-multi)
[519.914436] Subtest parallel-multi: SKIP (0.000s)
[519.961583] [098/133] (506s left) gem_userptr_blits (sync-unmap-cycles)
[520.017301] Starting subtest: sync-unmap-cycles
[525.399373] Subtest sync-unmap-cycles: SUCCESS (5.375s)
[525.518094] [099/133] (500s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[525.627205] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[525.630554] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[525.720580] [100/133] (500s left) kms_cursor_crc (cursor-alpha-transparent)
[525.808733] Starting subtest: cursor-alpha-transparent
[525.810422] Starting dynamic subtest: pipe-A-eDP-1
[526.456093] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.646s)
[526.467106] Starting dynamic subtest: pipe-D-eDP-1
[527.769888] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.310s)
[527.772080] Subtest cursor-alpha-transparent: SUCCESS (1.959s)
[528.573136] [101/133] (497s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-blt)
[528.679040] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-blt
[535.563970] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (6.881s)
[535.717242] [102/133] (490s left) gem_tiled_blits (basic)
[535.770118] Subtest basic: SKIP (0.000s)
[535.839322] [103/133] (490s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-wc)
[535.938268] Starting subtest: fbc-rgb565-draw-mmap-wc
[540.009216] Subtest fbc-rgb565-draw-mmap-wc: SUCCESS (4.075s)
[541.176922] [104/133] (485s left) gem_exec_fence (syncobj-timeline-wait)
[541.764161] Starting subtest: syncobj-timeline-wait
[543.542568] Subtest syncobj-timeline-wait: SUCCESS (1.778s)
[545.606360] [105/133] (480s left) gem_pipe_control_store_loop (fresh-buffer)
[545.666716] Starting subtest: fresh-buffer
[547.819262] Subtest fresh-buffer: SUCCESS (2.154s)
[547.930495] [106/133] (478s left) gen7_exec_parse (basic-allocation)
[548.001784] Subtest basic-allocation: SKIP (0.000s)
[548.084339] [107/133] (478s left) gem_ctx_sseu (invalid-sseu)
[548.154917] Subtest invalid-sseu: SKIP (0.000s)
[548.235829] [108/133] (478s left) kms_frontbuffer_tracking (fbc-1p-indfb-fliptrack-mmap-gtt)
[548.346772] Starting subtest: fbc-1p-indfb-fliptrack-mmap-gtt
[548.351052] Subtest fbc-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[548.453920] [109/133] (478s left) prime_udl
[548.553356] [110/133] (478s left) api_intel_bb (lot-of-buffers)
[548.608760] Starting subtest: lot-of-buffers
[549.662330] Subtest lot-of-buffers: SUCCESS (1.055s)
[550.095898] [111/133] (476s left) sysfs_heartbeat_interval (nopreempt)
[550.148688] Starting subtest: nopreempt
[550.150999] Starting dynamic subtest: vecs0
[559.536880] Dynamic subtest vecs0: SUCCESS (9.385s)
[559.550577] Starting dynamic subtest: ccs0
[563.520057] Dynamic subtest ccs0: SUCCESS (3.979s)
[563.532538] Starting dynamic subtest: vcs0
[573.543037] Dynamic subtest vcs0: SUCCESS (10.016s)
[573.555214] Starting dynamic subtest: bcs0
[577.534296] Dynamic subtest bcs0: SUCCESS (3.989s)
[577.548169] Starting dynamic subtest: rcs0
[581.561596] Dynamic subtest rcs0: SUCCESS (4.024s)
[581.574964] Starting dynamic subtest: vcs1
[591.521703] Dynamic subtest vcs1: SUCCESS (9.952s)
[591.524374] Subtest nopreempt: SUCCESS (41.358s)
[591.602850] [112/133] (435s left) kms_addfb_basic (invalid-get-prop-any)
[591.655648] Starting subtest: invalid-get-prop-any
[591.657510] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[591.797905] [113/133] (434s left) kms_flip (2x-flip-vs-suspend)
[591.886799] Starting subtest: 2x-flip-vs-suspend
[591.895678] Subtest 2x-flip-vs-suspend: SKIP (0.011s)
[591.978614] [114/133] (434s left) kms_content_protection (suspend-resume)
[592.114055] Starting subtest: suspend-resume
[592.118314] Subtest suspend-resume: SKIP (0.000s)
[592.234075] [115/133] (434s left) gem_exec_fence (basic-await)
[592.411354] Starting subtest: basic-await
[592.413569] Starting dynamic subtest: rcs0
[592.487004] Dynamic subtest rcs0: SUCCESS (0.078s)
[592.501714] Starting dynamic subtest: bcs0
[592.562443] Dynamic subtest bcs0: SUCCESS (0.073s)
[592.575761] Starting dynamic subtest: vcs0
[592.637551] Dynamic subtest vcs0: SUCCESS (0.073s)
[592.650197] Starting dynamic subtest: vcs1
[592.712534] Dynamic subtest vcs1: SUCCESS (0.074s)
[592.725546] Starting dynamic subtest: vecs0
[592.793162] Dynamic subtest vecs0: SUCCESS (0.079s)
[592.806526] Starting dynamic subtest: ccs0
[592.873465] Dynamic subtest ccs0: SUCCESS (0.078s)
[592.875823] Subtest basic-await: SUCCESS (0.466s)
[594.613449] [116/133] (432s left) gem_lmem_swapping (parallel-random-verify-ccs)
[594.663152] Subtest parallel-random-verify-ccs: SKIP (0.000s)
[594.711375] [117/133] (432s left) gem_exec_fence (keep-in-fence)
[594.881229] Starting subtest: keep-in-fence
[594.883848] Starting dynamic subtest: rcs0
[594.954880] Dynamic subtest rcs0: SUCCESS (0.073s)
[594.971331] Starting dynamic subtest: bcs0
[595.009700] Dynamic subtest bcs0: SUCCESS (0.053s)
[595.022097] Starting dynamic subtest: vcs0
[596.521030] Dynamic subtest vcs0: SUCCESS (1.508s)
[596.534436] Starting dynamic subtest: vcs1
[598.505370] Dynamic subtest vcs1: SUCCESS (1.981s)
[598.518669] Starting dynamic subtest: vecs0
[600.552542] Dynamic subtest vecs0: SUCCESS (2.044s)
[600.565785] Starting dynamic subtest: ccs0
[600.796551] Dynamic subtest ccs0: SUCCESS (0.242s)
[600.799553] Subtest keep-in-fence: SUCCESS (5.915s)
[602.609325] [118/133] (424s left) gem_ctx_persistence (heartbeat-hang)
[602.673147] Starting subtest: heartbeat-hang
[602.677989] Subtest heartbeat-hang: SKIP (0.000s)
[602.789239] [119/133] (424s left) kms_chamelium_edid (hdmi-mode-timings)
[603.177316] Subtest hdmi-mode-timings: SKIP (0.000s)
[603.981480] [120/133] (423s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[604.085979] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip
[605.075664] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (0.989s)
[605.204615] [121/133] (421s left) kms_big_fb (linear-8bpp-rotate-90)
[605.307752] Starting subtest: linear-8bpp-rotate-90
[605.328206] Subtest linear-8bpp-rotate-90: SKIP (0.020s)
[605.457149] [122/133] (421s left) kms_async_flips (crc-atomic)
[605.547665] Starting subtest: crc-atomic
[605.927042] Starting dynamic subtest: pipe-A-eDP-1
[608.814784] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.888s)
[609.191727] Starting dynamic subtest: pipe-B-eDP-1
[612.137202] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.956s)
[612.514744] Starting dynamic subtest: pipe-C-eDP-1
[615.444267] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.941s)
[615.813707] Starting dynamic subtest: pipe-D-eDP-1
[618.684297] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.881s)
[618.686587] Subtest crc-atomic: SUCCESS (13.141s)
[619.843336] [123/133] (407s left) kms_pwrite_crc
[621.479119] [124/133] (405s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions-varying-size)
[621.600897] Starting subtest: cursorB-vs-flipA-atomic-transitions-varying-size
[621.605274] Subtest cursorB-vs-flipA-atomic-transitions-varying-size: SKIP (0.001s)
[621.747917] [125/133] (405s left) vgem_basic (dmabuf-mmap)
[621.797272] Starting subtest: dmabuf-mmap
[621.808563] Subtest dmabuf-mmap: SUCCESS (0.013s)
[621.867523] [126/133] (405s left) kms_psr (pr-no-drrs)
[621.971507] Starting subtest: pr-no-drrs
[621.975692] Subtest pr-no-drrs: SKIP (0.000s)
[622.044622] [127/133] (405s left) kms_frontbuffer_tracking (fbcpsr-1p-rte)
[622.171032] Starting subtest: fbcpsr-1p-rte
[629.239503] Subtest fbcpsr-1p-rte: SUCCESS (7.071s)
[629.388232] [128/133] (397s left) sw_sync (sync_merge)
[629.431162] Starting subtest: sync_merge
[629.433074] Subtest sync_merge: SUCCESS (0.000s)
[629.491635] [129/133] (397s left) kms_vblank (wait-busy)
[629.605573] Starting subtest: wait-busy
[629.607695] Starting dynamic subtest: pipe-A-eDP-1
[631.480088] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.874s)
[631.497977] Starting dynamic subtest: pipe-D-eDP-1
[633.997993] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.517s)
[634.000371] Subtest wait-busy: SUCCESS (4.395s)
[634.802661] [130/133] (392s left) gem_exec_suspend (basic)
[634.867251] Starting subtest: basic
[634.869653] Starting dynamic subtest: smem
[636.520977] Dynamic subtest smem: SUCCESS (1.651s)
[636.523862] Subtest basic: SUCCESS (1.653s)
[636.709057] [131/133] (390s left) kms_flip (2x-flip-vs-expired-vblank)
[636.813646] Starting subtest: 2x-flip-vs-expired-vblank
[636.822891] Subtest 2x-flip-vs-expired-vblank: SKIP (0.011s)
[636.950315] [132/133] (390s left) gem_exec_reloc (basic-wc-noreloc)
[637.026952] Subtest basic-wc-noreloc: SKIP (0.000s)
[637.115151] [133/133] (390s left) gem_userptr_blits (map-fixed-invalidate-overlap-busy)
[637.183487] Starting subtest: map-fixed-invalidate-overlap-busy
[637.187675] Subtest map-fixed-invalidate-overlap-busy: SKIP (0.000s)
[637.317979] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: i915_pm_rps
results: parsing output: 2/ for test: perf_pmu
results: parsing output: 3/ for test: kms_ccs
results: parsing output: 4/ for test: gem_caching
results: parsing output: 5/ for test: gem_userptr_blits
results: parsing output: 6/ for test: sw_sync
results: parsing output: 7/ for test: gem_exec_whisper
results: parsing output: 8/ for test: kms_flip
results: parsing output: 9/ for test: syncobj_timeline
results: parsing output: 10/ for test: gem_exec_params
results: parsing output: 11/ for test: gem_eio
results: parsing output: 12/ for test: gem_exec_schedule
results: parsing output: 13/ for test: gem_exec_reloc
results: parsing output: 14/ for test: kms_vblank
results: parsing output: 15/ for test: fbdev
results: parsing output: 16/ for test: kms_invalid_mode
results: parsing output: 17/ for test: kms_dither
results: parsing output: 18/ for test: kms_plane_scaling
results: parsing output: 19/ for test: syncobj_timeline
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: prime_busy
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: kms_psr
results: parsing output: 24/ for test: kms_cursor_crc
results: parsing output: 25/ for test: gem_render_copy
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: kms_plane
results: parsing output: 28/ for test: kms_psr
results: parsing output: 29/ for test: kms_busy
results: parsing output: 30/ for test: gem_mmap_wc
results: parsing output: 31/ for test: gem_flink_basic
results: parsing output: 32/ for test: kms_psr2_sf
results: parsing output: 33/ for test: gem_exec_schedule
results: parsing output: 34/ for test: gem_softpin
results: parsing output: 35/ for test: kms_addfb_basic
results: parsing output: 36/ for test: gem_ctx_persistence
results: parsing output: 37/ for test: gem_madvise
results: parsing output: 38/ for test: kms_lease
results: parsing output: 39/ for test: kms_pm_rpm
results: parsing output: 40/ for test: kms_plane
results: parsing output: 41/ for test: i915_pm_rpm
results: parsing output: 42/ for test: gem_exec_balancer
results: parsing output: 43/ for test: gem_mmap_gtt
results: parsing output: 44/ for test: gem_exec_reloc
results: parsing output: 45/ for test: kms_psr
results: parsing output: 46/ for test: prime_vgem
results: parsing output: 47/ for test: core_hotunplug
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: perf
results: parsing output: 50/ for test: kms_flip
results: parsing output: 51/ for test: kms_psr2_sf
results: parsing output: 52/ for test: syncobj_timeline
results: parsing output: 53/ for test: kms_ccs
results: parsing output: 54/ for test: gen9_exec_parse
results: parsing output: 55/ for test: prime_self_import
results: parsing output: 56/ for test: kms_ccs
results: parsing output: 57/ for test: gem_create
results: parsing output: 58/ for test: kms_psr
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: gem_workarounds
results: parsing output: 61/ for test: kms_plane
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_plane_alpha_blend
results: parsing output: 64/ for test: kms_big_fb
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: gem_fenced_exec_thrash
results: parsing output: 68/ for test: gem_softpin
results: parsing output: 69/ for test: kms_color_pipeline
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: kms_pm_dc
results: parsing output: 73/ for test: syncobj_wait
results: parsing output: 74/ for test: kms_psr
results: parsing output: 75/ for test: kms_big_fb
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_vrr
results: parsing output: 78/ for test: kms_big_fb
results: parsing output: 79/ for test: kms_big_fb
results: parsing output: 80/ for test: kms_cursor_legacy
results: parsing output: 81/ for test: i915_drm_fdinfo
results: parsing output: 82/ for test: i915_fb_tiling
results: parsing output: 83/ for test: gem_ringfill
results: parsing output: 84/ for test: gem_softpin
results: parsing output: 85/ for test: gem_mmap_gtt
results: parsing output: 86/ for test: gem_exec_params
results: parsing output: 87/ for test: kms_chamelium_color
results: parsing output: 88/ for test: kms_ccs
results: parsing output: 89/ for test: kms_chamelium_hpd
results: parsing output: 90/ for test: syncobj_timeline
results: parsing output: 91/ for test: kms_flip_scaled_crc
results: parsing output: 92/ for test: gem_mmap_gtt
results: parsing output: 93/ for test: gem_exec_reloc
results: parsing output: 94/ for test: kms_dsc
results: parsing output: 95/ for test: syncobj_timeline
results: parsing output: 96/ for test: gem_lmem_swapping
results: parsing output: 97/ for test: gem_userptr_blits
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: kms_cursor_crc
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: gem_tiled_blits
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: gem_exec_fence
results: parsing output: 104/ for test: gem_pipe_control_store_loop
results: parsing output: 105/ for test: gen7_exec_parse
results: parsing output: 106/ for test: gem_ctx_sseu
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: prime_udl
results: parsing output: 109/ for test: api_intel_bb
results: parsing output: 110/ for test: sysfs_heartbeat_interval
results: parsing output: 111/ for test: kms_addfb_basic
results: parsing output: 112/ for test: kms_flip
results: parsing output: 113/ for test: kms_content_protection
results: parsing output: 114/ for test: gem_exec_fence
results: parsing output: 115/ for test: gem_lmem_swapping
results: parsing output: 116/ for test: gem_exec_fence
results: parsing output: 117/ for test: gem_ctx_persistence
results: parsing output: 118/ for test: kms_chamelium_edid
results: parsing output: 119/ for test: kms_big_fb
results: parsing output: 120/ for test: kms_big_fb
results: parsing output: 121/ for test: kms_async_flips
results: parsing output: 122/ for test: kms_pwrite_crc
results: parsing output: 123/ for test: kms_cursor_legacy
results: parsing output: 124/ for test: vgem_basic
results: parsing output: 125/ for test: kms_psr
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: sw_sync
results: parsing output: 128/ for test: kms_vblank
results: parsing output: 129/ for test: gem_exec_suspend
results: parsing output: 130/ for test: kms_flip
results: parsing output: 131/ for test: gem_exec_reloc
results: parsing output: 132/ for test: gem_userptr_blits
Done.