[56.710398] Initializing watchdogs
[56.710466]   /dev/watchdog0
[56.729181] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7dd5 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Graphics]
[56.733170] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[56.735266] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[56.738194] [001/156] (960s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-pri-indfb-multidraw)
[56.846240] Starting subtest: fbcpsrhdr-2p-pri-indfb-multidraw
[56.850129] Subtest fbcpsrhdr-2p-pri-indfb-multidraw: SKIP (0.000s)
[56.928896] [002/156] (960s left) kms_frontbuffer_tracking (fbchdr-1p-shrfb-fliptrack-mmap-gtt)
[57.003747] Starting subtest: fbchdr-1p-shrfb-fliptrack-mmap-gtt
[57.008153] Subtest fbchdr-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[57.098161] [003/156] (960s left) kms_frontbuffer_tracking (hdr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[57.176078] Starting subtest: hdr-2p-primscrn-pri-indfb-draw-mmap-gtt
[57.180574] Subtest hdr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[57.269604] [004/156] (960s left) gem_mmap_gtt (basic-short)
[57.328250] Subtest basic-short: SKIP (0.000s)
[57.383851] [005/156] (960s left) kms_plane_multiple (tiling-none)
[57.451900] Starting subtest: tiling-none
[57.454436] Starting dynamic subtest: pipe-A-eDP-1
[61.269918] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.817s)
[61.278312] Starting dynamic subtest: pipe-B-eDP-1
[65.888069] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.617s)
[65.896670] Starting dynamic subtest: pipe-C-eDP-1
[70.438841] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.552s)
[70.447070] Starting dynamic subtest: pipe-D-eDP-1
[74.896496] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.457s)
[74.898684] Subtest tiling-none: SUCCESS (17.446s)
[75.702693] [006/156] (941s left) syncobj_timeline (wait-all-delayed-signal)
[75.762595] Starting subtest: wait-all-delayed-signal
[75.867306] Subtest wait-all-delayed-signal: SUCCESS (0.103s)
[75.954573] [007/156] (941s left) kms_flip (2x-nonexisting-fb-interruptible)
[76.030260] Starting subtest: 2x-nonexisting-fb-interruptible
[76.040329] Subtest 2x-nonexisting-fb-interruptible: SKIP (0.008s)
[76.135479] [008/156] (941s left) gem_ctx_persistence (engines-mixed-process)
[76.194976] Starting subtest: engines-mixed-process
[76.197354] Starting dynamic subtest: rcs0
[78.216791] Dynamic subtest rcs0: SUCCESS (2.019s)
[78.227461] Starting dynamic subtest: bcs0
[80.263179] Dynamic subtest bcs0: SUCCESS (2.045s)
[80.272660] Starting dynamic subtest: vcs0
[82.265356] Dynamic subtest vcs0: SUCCESS (2.004s)
[82.276244] Starting dynamic subtest: vcs1
[84.240076] Dynamic subtest vcs1: SUCCESS (1.974s)
[84.251632] Starting dynamic subtest: vecs0
[86.190625] Dynamic subtest vecs0: SUCCESS (1.947s)
[86.201090] Starting dynamic subtest: ccs0
[88.266739] Dynamic subtest ccs0: SUCCESS (2.078s)
[88.269342] Subtest engines-mixed-process: SUCCESS (12.072s)
[88.341850] [009/156] (929s left) gem_vm_create (invalid-create)
[88.400321] Starting subtest: invalid-create
[88.403224] Subtest invalid-create: SUCCESS (0.002s)
[88.506977] [010/156] (929s left) perf (low-oa-exponent-permissions)
[88.626766] Starting subtest: low-oa-exponent-permissions
[88.666141] Subtest low-oa-exponent-permissions: SUCCESS (0.041s)
[88.716077] [011/156] (928s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[88.800215] Starting subtest: fbchdr-2p-primscrn-pri-shrfb-draw-mmap-gtt
[88.804151] Subtest fbchdr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[88.904164] [012/156] (928s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-indfb-pgflip-blt)
[88.986576] Starting subtest: fbchdr-2p-scndscrn-indfb-pgflip-blt
[88.990699] Subtest fbchdr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[89.083295] [013/156] (928s left) kms_hdr (static-toggle-dpms)
[89.151068] Starting subtest: static-toggle-dpms
[89.153323] Starting dynamic subtest: pipe-A-eDP-1-XRGB2101010
[89.157390] Dynamic subtest pipe-A-eDP-1-XRGB2101010: SKIP (0.000s)
[89.167296] Starting dynamic subtest: pipe-A-eDP-1-XRGB16161616F
[89.171489] Dynamic subtest pipe-A-eDP-1-XRGB16161616F: SKIP (0.000s)
[89.175724] Subtest static-toggle-dpms: SKIP (0.002s)
[89.218236] [014/156] (928s left) gem_mmap_gtt (ptrace)
[89.271419] Subtest ptrace: SKIP (0.000s)
[89.325607] [015/156] (928s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[89.404472] Starting subtest: y-tiled-32bpp-rotate-180
[89.408202] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s)
[89.491348] [016/156] (928s left) gem_eio (throttle)
[89.676279] Starting subtest: throttle
[89.926439] Subtest throttle: SUCCESS (0.250s)
[90.045981] [017/156] (927s left) gem_caching (read-writes)
[90.100090] Subtest read-writes: SKIP (0.000s)
[90.158823] [018/156] (927s left) kms_flip (nonexisting-fb-interruptible)
[90.231093] Starting subtest: nonexisting-fb-interruptible
[90.233052] Starting dynamic subtest: A-eDP1
[91.388821] Dynamic subtest A-eDP1: SUCCESS (1.156s)
[91.397166] Starting dynamic subtest: B-eDP1
[92.521065] Dynamic subtest B-eDP1: SUCCESS (1.132s)
[92.531273] Starting dynamic subtest: C-eDP1
[93.643128] Dynamic subtest C-eDP1: SUCCESS (1.121s)
[93.655865] Starting dynamic subtest: D-eDP1
[94.774622] Dynamic subtest D-eDP1: SUCCESS (1.130s)
[94.776921] Subtest nonexisting-fb-interruptible: SUCCESS (4.545s)
[95.932079] [019/156] (921s left) kms_big_fb (4-tiled-addfb-size-overflow)
[96.025343] Starting subtest: 4-tiled-addfb-size-overflow
[96.027640] Subtest 4-tiled-addfb-size-overflow: SUCCESS (0.000s)
[96.125341] [020/156] (921s left) kms_pm_rpm (cursor-dpms)
[98.336273] Starting subtest: cursor-dpms
[98.341107] Subtest cursor-dpms: SKIP (0.000s)
[98.721375] [021/156] (919s left) gem_exec_flush (basic-batch-kernel-default-wb)
[98.778883] Starting subtest: basic-batch-kernel-default-wb
[105.670560] Subtest basic-batch-kernel-default-wb: SUCCESS (6.892s)
[105.856237] [022/156] (912s left) gem_ccs (block-multicopy-inplace)
[105.910585] Starting subtest: block-multicopy-inplace
[105.915368] Subtest block-multicopy-inplace: SKIP (0.000s)
[106.021318] [023/156] (912s left) kms_cursor_legacy (cursorb-vs-flipa-legacy)
[106.132939] Starting subtest: cursorB-vs-flipA-legacy
[106.137412] Subtest cursorB-vs-flipA-legacy: SKIP (0.001s)
[106.273157] [024/156] (911s left) gem_pwrite_snooped
[106.400710] [025/156] (911s left) kms_dp_link_training (non-uhbr-sst)
[106.477258] Starting subtest: non-uhbr-sst
[106.485191] Subtest non-uhbr-sst: SKIP (0.000s)
[106.543240] [026/156] (911s left) gem_exec_await (wide-contexts)
[106.751863] Starting subtest: wide-contexts
[130.118726] Subtest wide-contexts: SUCCESS (23.364s)
[130.301399] [FACT gem_exec_await (wide-contexts)] new: kernel.kmod_is_loaded.vgem: true
[130.306142] [027/156] (887s left) kms_pm_rpm (modeset-non-lpsp)
[132.379037] Starting subtest: modeset-non-lpsp
[133.522656] Subtest modeset-non-lpsp: SKIP (1.145s)
[133.929471] [028/156] (884s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[134.309422] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[135.131619] [029/156] (883s left) kms_draw_crc (draw-method-mmap-gtt)
[135.223279] Starting subtest: draw-method-mmap-gtt
[135.227572] Subtest draw-method-mmap-gtt: SKIP (0.000s)
[135.342393] [030/156] (882s left) gem_eio (in-flight-10ms)
[135.558410] Starting subtest: in-flight-10ms
[144.058820] Subtest in-flight-10ms: SUCCESS (8.500s)
[144.230695] [031/156] (874s left) syncobj_wait (invalid-reset-illegal-handle)
[144.284586] Starting subtest: invalid-reset-illegal-handle
[144.286935] Subtest invalid-reset-illegal-handle: SUCCESS (0.000s)
[144.358078] [032/156] (874s left) gem_close_race (multigpu-basic-threads)
[144.416603] Starting subtest: multigpu-basic-threads
[144.421048] Subtest multigpu-basic-threads: SKIP (0.000s)
[144.629975] [033/156] (873s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-spr-indfb-fullscreen)
[144.707753] Starting subtest: psrhdr-2p-primscrn-spr-indfb-fullscreen
[144.711874] Subtest psrhdr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[144.811450] [034/156] (873s left) perf (gen12-unprivileged-single-ctx-counters)
[144.912581] Starting subtest: gen12-unprivileged-single-ctx-counters
[144.914946] Starting dynamic subtest: rcs0
[144.983502] Dynamic subtest rcs0: SUCCESS (0.071s)
[144.985752] Subtest gen12-unprivileged-single-ctx-counters: SUCCESS (0.072s)
[145.033629] [035/156] (873s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[145.113177] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[145.117717] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[145.214402] [036/156] (873s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[145.297107] Starting subtest: hdr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[145.301234] Subtest hdr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[145.393540] [037/156] (873s left) syncobj_wait (multi-wait-for-submit-unsubmitted-signaled)
[145.442934] Starting subtest: multi-wait-for-submit-unsubmitted-signaled
[145.445330] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.000s)
[145.546764] [038/156] (873s left) gem_fenced_exec_thrash (no-spare-fences-busy)
[145.595381] Subtest no-spare-fences-busy: SKIP (0.000s)
[145.672991] [039/156] (873s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[145.747532] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc
[145.750862] Subtest fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[145.833696] [040/156] (872s left) gem_ppgtt (shrink-vs-evict-pinned)
[145.892386] Starting subtest: shrink-vs-evict-pinned
[152.274149] Subtest shrink-vs-evict-pinned: SUCCESS (6.383s)
[152.357450] [041/156] (866s left) gem_request_retire (retire-vma-not-inactive)
[152.427760] Starting subtest: retire-vma-not-inactive
[152.491716] Subtest retire-vma-not-inactive: SUCCESS (0.064s)
[152.612390] [042/156] (866s left) kms_chamelium_audio (hdmi-audio)
[152.991881] Subtest hdmi-audio: SKIP (0.000s)
[153.860285] [043/156] (865s left) kms_frontbuffer_tracking (hdr-1p-primscrn-pri-shrfb-draw-blt)
[153.946128] Starting subtest: hdr-1p-primscrn-pri-shrfb-draw-blt
[153.950400] Subtest hdr-1p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[154.040841] [044/156] (864s left) gem_mmap (basic-small-bo)
[154.103363] Subtest basic-small-bo: SKIP (0.000s)
[154.157167] [045/156] (864s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[154.246652] Starting subtest: fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-cpu
[154.251153] Subtest fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[154.325734] [046/156] (864s left) kms_chamelium_edid (hdmi-mode-timings)
[154.703159] Subtest hdmi-mode-timings: SKIP (0.000s)
[155.496850] [047/156] (863s left) gem_pxp (reject-modify-context-protection-on)
[155.622721] Starting subtest: reject-modify-context-protection-on
[155.625204] Subtest reject-modify-context-protection-on: SUCCESS (0.002s)
[155.738881] [048/156] (863s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic)
[155.829427] Starting subtest: 2x-flip-vs-cursor-atomic
[155.834051] Subtest 2x-flip-vs-cursor-atomic: SKIP (0.001s)
[155.972718] [049/156] (863s left) gem_exec_balancer (smoke)
[156.029544] Starting subtest: smoke
[178.599239] Subtest smoke: SUCCESS (22.568s)
[180.341872] [050/156] (838s left) kms_big_fb (x-tiled-16bpp-rotate-90)
[180.435065] Starting subtest: x-tiled-16bpp-rotate-90
[180.454075] Subtest x-tiled-16bpp-rotate-90: SKIP (0.019s)
[180.555080] [051/156] (838s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[180.631028] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-cpu
[187.306333] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (6.679s)
[187.422294] [052/156] (831s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-render)
[187.500755] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-render
[187.505045] Subtest psr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[187.600531] [053/156] (831s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling)
[187.669607] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling
[187.674254] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling: SKIP (0.000s)
[187.742376] [054/156] (831s left) syncobj_timeline (invalid-query-illegal-handle)
[187.797220] Starting subtest: invalid-query-illegal-handle
[187.799467] Subtest invalid-query-illegal-handle: SUCCESS (0.000s)
[187.907272] [055/156] (831s left) kms_flip (blocking-absolute-wf_vblank-interruptible)
[187.978435] Starting subtest: blocking-absolute-wf_vblank-interruptible
[187.980847] Starting dynamic subtest: A-eDP1
[196.671996] Dynamic subtest A-eDP1: SUCCESS (8.693s)
[196.681864] Starting dynamic subtest: B-eDP1
[205.404593] Dynamic subtest B-eDP1: SUCCESS (8.730s)
[205.419154] Starting dynamic subtest: C-eDP1
[214.130296] Dynamic subtest C-eDP1: SUCCESS (8.723s)
[214.142365] Starting dynamic subtest: D-eDP1
[222.856992] Dynamic subtest D-eDP1: SUCCESS (8.726s)
[222.859499] Subtest blocking-absolute-wf_vblank-interruptible: SUCCESS (34.879s)
[224.068227] [056/156] (795s left) gem_exec_schedule (submit-early-slice)
[224.132480] Starting subtest: submit-early-slice
[224.134561] Starting dynamic subtest: rcs0
[224.167176] Dynamic subtest rcs0: SUCCESS (0.044s)
[224.176881] Starting dynamic subtest: bcs0
[224.208767] Dynamic subtest bcs0: SUCCESS (0.041s)
[224.220119] Starting dynamic subtest: vcs0
[224.253229] Dynamic subtest vcs0: SUCCESS (0.044s)
[224.262269] Starting dynamic subtest: vcs1
[224.296309] Dynamic subtest vcs1: SUCCESS (0.043s)
[224.306228] Starting dynamic subtest: vecs0
[224.337586] Dynamic subtest vecs0: SUCCESS (0.040s)
[224.347477] Starting dynamic subtest: ccs0
[224.378561] Dynamic subtest ccs0: SUCCESS (0.040s)
[224.380855] Subtest submit-early-slice: SUCCESS (0.256s)
[225.312753] [057/156] (794s left) api_intel_bb (full-batch)
[225.373199] Starting subtest: full-batch
[225.379070] Subtest full-batch: SUCCESS (0.006s)
[225.521622] [058/156] (793s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[225.601203] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt
[225.605223] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[225.701345] [059/156] (793s left) kms_frontbuffer_tracking (hdr-1p-primscrn-spr-indfb-move)
[225.783266] Starting subtest: hdr-1p-primscrn-spr-indfb-move
[225.787742] Subtest hdr-1p-primscrn-spr-indfb-move: SKIP (0.000s)
[225.887542] [060/156] (793s left) gem_mmap_gtt (big-bo-tiledx)
[225.939302] Subtest big-bo-tiledX: SKIP (0.000s)
[226.003489] [061/156] (793s left) syncobj_eventfd (invalid-illegal-handle)
[226.054635] Starting subtest: invalid-illegal-handle
[226.056741] Subtest invalid-illegal-handle: SUCCESS (0.000s)
[226.168839] [062/156] (793s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-shrfb-pgflip-blt)
[226.256680] Starting subtest: psrhdr-2p-scndscrn-shrfb-pgflip-blt
[226.260322] Subtest psrhdr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[226.350656] [063/156] (793s left) kms_frontbuffer_tracking (hdr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[226.431377] Starting subtest: hdr-1p-offscreen-pri-shrfb-draw-mmap-wc
[226.434660] Subtest hdr-1p-offscreen-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[226.513330] [064/156] (793s left) gem_exec_params (invalid-batch-start-offset)
[226.563075] Starting subtest: invalid-batch-start-offset
[226.567503] Subtest invalid-batch-start-offset: SUCCESS (0.002s)
[226.687570] [065/156] (793s left) kms_psr (psr2-cursor-plane-move)
[226.764373] Starting subtest: psr2-cursor-plane-move
[226.766336] Starting dynamic subtest: eDP-1
[228.463268] Dynamic subtest eDP-1: SUCCESS (1.697s)
[228.465468] Subtest psr2-cursor-plane-move: SUCCESS (1.698s)
[229.359185] [066/156] (790s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-render)
[229.442912] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-render
[229.447481] Subtest fbc-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[229.567595] [067/156] (790s left) kms_joiner (basic-ultra-joiner)
[229.644223] Starting subtest: basic-ultra-joiner
[229.648203] Subtest basic-ultra-joiner: SKIP (0.000s)
[229.710549] [068/156] (790s left) sysfs_preempt_timeout (idempotent)
[229.777707] Starting subtest: idempotent
[229.780133] Starting dynamic subtest: vecs0
[229.782591] Dynamic subtest vecs0: SUCCESS (0.000s)
[229.794095] Starting dynamic subtest: ccs0
[229.795976] Dynamic subtest ccs0: SUCCESS (0.000s)
[229.804706] Starting dynamic subtest: vcs0
[229.806607] Dynamic subtest vcs0: SUCCESS (0.000s)
[229.817345] Starting dynamic subtest: bcs0
[229.819131] Dynamic subtest bcs0: SUCCESS (0.000s)
[229.827911] Starting dynamic subtest: rcs0
[229.829820] Dynamic subtest rcs0: SUCCESS (0.000s)
[229.839066] Starting dynamic subtest: vcs1
[229.841167] Dynamic subtest vcs1: SUCCESS (0.000s)
[229.843165] Subtest idempotent: SUCCESS (0.005s)
[229.892808] [069/156] (790s left) gem_mmap_gtt (cpuset-basic-small-copy)
[229.939642] Subtest cpuset-basic-small-copy: SKIP (0.000s)
[230.011120] [070/156] (789s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[230.096877] Starting subtest: fbchdr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[230.101303] Subtest fbchdr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[230.198990] [071/156] (789s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-indfb-fliptrack-mmap-gtt)
[230.295558] Starting subtest: fbcpsrhdr-1p-indfb-fliptrack-mmap-gtt
[230.299086] Subtest fbcpsrhdr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[230.403270] [072/156] (789s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[230.477853] Starting subtest: fbcpsrhdr-1p-primscrn-pri-shrfb-draw-mmap-wc
[230.481497] Subtest fbcpsrhdr-1p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[230.575849] [073/156] (789s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs-cc)
[230.653409] Starting subtest: crc-primary-suspend-4-tiled-mtl-rc-ccs-cc
[230.655313] Starting dynamic subtest: pipe-A-eDP-1
[246.729685] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.594s)
[246.740203] Starting dynamic subtest: pipe-B-eDP-1
[263.701142] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.371s)
[263.712733] Starting dynamic subtest: pipe-C-eDP-1
[280.665016] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.370s)
[280.676176] Starting dynamic subtest: pipe-D-eDP-1
[297.691857] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.393s)
[297.694498] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs-cc: SUCCESS (8.733s)
[298.927067] [074/156] (721s left) gem_eio (create-ext)
[299.146002] Starting subtest: create-ext
[299.471818] Subtest create-ext: SUCCESS (0.326s)
[299.590577] [075/156] (720s left) kms_psr (fbc-psr-sprite-blt)
[299.662629] Starting subtest: fbc-psr-sprite-blt
[299.665021] Starting dynamic subtest: eDP-1
[299.671589] Dynamic subtest eDP-1: SKIP (0.000s)
[299.676104] Subtest fbc-psr-sprite-blt: SKIP (0.001s)
[299.735024] [076/156] (720s left) gem_exec_balancer (hog)
[299.789832] Starting subtest: hog
[299.795339] Subtest hog: SKIP (0.000s)
[300.094214] [077/156] (720s left) kms_universal_plane (disable-primary-vs-flip)
[300.161924] Starting subtest: disable-primary-vs-flip
[300.164042] Starting dynamic subtest: pipe-A-eDP-1
[301.719724] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.554s)
[301.731029] Starting dynamic subtest: pipe-B-eDP-1
[304.000739] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.277s)
[304.011785] Starting dynamic subtest: pipe-C-eDP-1
[306.233293] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.231s)
[306.245929] Starting dynamic subtest: pipe-D-eDP-1
[308.483798] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.245s)
[308.486144] Subtest disable-primary-vs-flip: SUCCESS (8.313s)
[309.396748] [078/156] (710s left) gem_spin_batch (legacy-resubmit-new)
[309.463476] Starting subtest: legacy-resubmit-new
[309.465925] Starting dynamic subtest: default
[309.471040] Dynamic subtest default: SUCCESS (0.007s)
[309.481684] Starting dynamic subtest: render
[309.484123] Dynamic subtest render: SUCCESS (0.003s)
[309.495897] Starting dynamic subtest: bsd
[309.497731] Dynamic subtest bsd: SUCCESS (0.005s)
[309.507840] Starting dynamic subtest: bsd1
[309.510497] Dynamic subtest bsd1: SUCCESS (0.005s)
[309.520814] Starting dynamic subtest: bsd2
[309.523067] Dynamic subtest bsd2: SUCCESS (0.004s)
[309.532919] Starting dynamic subtest: blt
[309.535524] Dynamic subtest blt: SUCCESS (0.004s)
[309.545522] Starting dynamic subtest: vebox
[309.547934] Dynamic subtest vebox: SUCCESS (0.003s)
[309.550389] Subtest legacy-resubmit-new: SUCCESS (0.039s)
[311.591686] [079/156] (708s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[311.677163] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[311.681800] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[311.777995] [080/156] (708s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-move)
[311.862702] Starting subtest: psr-2p-primscrn-spr-indfb-move
[311.867554] Subtest psr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[311.952052] [081/156] (708s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers)
[312.020914] Starting subtest: plane-upscale-factor-0-25-with-modifiers
[312.023620] Starting dynamic subtest: pipe-A
[312.357455] Dynamic subtest pipe-A: SUCCESS (0.338s)
[312.369120] Starting dynamic subtest: pipe-B
[313.760165] Dynamic subtest pipe-B: SUCCESS (1.400s)
[313.770465] Starting dynamic subtest: pipe-C
[315.199723] Dynamic subtest pipe-C: SUCCESS (1.438s)
[315.209571] Starting dynamic subtest: pipe-D
[316.631658] Dynamic subtest pipe-D: SUCCESS (1.430s)
[316.634115] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (4.611s)
[317.796134] [082/156] (702s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move)
[317.877944] Starting subtest: psr-2p-primscrn-cur-indfb-move
[317.883032] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[317.980371] [083/156] (702s left) gem_exec_whisper (basic-fds-forked)
[318.052153] Starting subtest: basic-fds-forked
[342.904666] Subtest basic-fds-forked: SUCCESS (24.835s)
[343.089679] [084/156] (677s left) kms_cursor_crc (cursor-rapid-movement-128x128)
[343.279110] Starting subtest: cursor-rapid-movement-128x128
[343.284055] Starting dynamic subtest: pipe-A-eDP-1
[343.828718] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.542s)
[343.857504] Starting dynamic subtest: pipe-D-eDP-1
[345.027355] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.177s)
[345.029689] Subtest cursor-rapid-movement-128x128: SUCCESS (1.745s)
[345.869390] [085/156] (674s left) kms_frontbuffer_tracking (psrhdr-2p-rte)
[345.951910] Starting subtest: psrhdr-2p-rte
[345.956870] Subtest psrhdr-2p-rte: SKIP (0.000s)
[346.044035] [086/156] (674s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt)
[346.131129] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt
[346.135965] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[346.217760] [087/156] (674s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-gtt)
[346.300485] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-gtt
[346.305616] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[346.397789] [088/156] (674s left) kms_async_flips (test-cursor-atomic)
[346.477007] Starting subtest: test-cursor-atomic
[346.863734] Starting dynamic subtest: pipe-A-eDP-1
[347.670053] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.808s)
[348.057344] Starting dynamic subtest: pipe-B-eDP-1
[348.800903] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.755s)
[349.181483] Starting dynamic subtest: pipe-C-eDP-1
[349.937987] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.762s)
[350.299309] Starting dynamic subtest: pipe-D-eDP-1
[351.068063] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.779s)
[351.071003] Subtest test-cursor-atomic: SUCCESS (4.592s)
[352.247465] [089/156] (668s left) i915_query (engine-info-invalid)
[352.304937] Starting subtest: engine-info-invalid
[352.307526] Subtest engine-info-invalid: SUCCESS (0.000s)
[352.413552] [090/156] (668s left) gem_exec_create (madvise)
[352.466917] Starting subtest: madvise
[352.469766] Starting dynamic subtest: smem
[373.614933] Dynamic subtest smem: SUCCESS (21.136s)
[373.617937] Subtest madvise: SUCCESS (21.137s)
[374.485536] [091/156] (646s left) gem_ppgtt (flink-and-close-vma-leak)
[374.544823] Starting subtest: flink-and-close-vma-leak
[374.591800] Subtest flink-and-close-vma-leak: SUCCESS (0.047s)
[374.721225] [092/156] (646s left) gen9_exec_parse (cmd-crossing-page)
[374.785927] Subtest cmd-crossing-page: SKIP (0.000s)
[374.835208] [093/156] (646s left) kms_vrr (flip-basic)
[374.910679] Starting subtest: flip-basic
[374.918656] Subtest flip-basic: SKIP (0.000s)
[374.983600] [094/156] (645s left) gem_ctx_shared (detached-shared-gtt)
[375.037944] Starting subtest: detached-shared-gtt
[377.192435] Subtest detached-shared-gtt: SUCCESS (2.151s)
[377.473606] [095/156] (643s left) kms_properties (invalid-properties-legacy)
[377.561810] Starting subtest: invalid-properties-legacy
[377.655681] Subtest invalid-properties-legacy: SUCCESS (0.095s)
[377.734290] [096/156] (643s left) gem_mmap_gtt (basic-copy)
[377.785860] Subtest basic-copy: SKIP (0.000s)
[377.848795] [097/156] (643s left) syncobj_timeline (multi-wait-for-submit-signaled)
[377.903051] Starting subtest: multi-wait-for-submit-signaled
[377.906023] Subtest multi-wait-for-submit-signaled: SUCCESS (0.000s)
[378.000269] [098/156] (643s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[378.053528] Starting subtest: framebuffer-vs-set-tiling
[378.058529] Subtest framebuffer-vs-set-tiling: SKIP (0.000s)
[378.179743] [099/156] (642s left) kms_frontbuffer_tracking (fbc-2p-rte)
[378.269620] Starting subtest: fbc-2p-rte
[378.274919] Subtest fbc-2p-rte: SKIP (0.000s)
[378.357774] [100/156] (642s left) kms_big_fb (yf-tiled-16bpp-rotate-0)
[378.438495] Starting subtest: yf-tiled-16bpp-rotate-0
[378.442962] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s)
[378.537617] [101/156] (642s left) kms_frontbuffer_tracking (psr-rgb101010-draw-blt)
[378.622878] Starting subtest: psr-rgb101010-draw-blt
[386.002907] Subtest psr-rgb101010-draw-blt: SUCCESS (7.379s)
[386.116625] [102/156] (635s left) gem_ppgtt (blt-vs-render-ctx0)
[386.173136] Starting subtest: blt-vs-render-ctx0
[418.961875] Subtest blt-vs-render-ctx0: SUCCESS (32.769s)
[419.104817] [103/156] (602s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-mc-ccs)
[419.203538] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-mc-ccs
[419.205848] Starting dynamic subtest: pipe-A-eDP-1
[419.273720] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[419.284372] Starting dynamic subtest: pipe-B-eDP-1
[419.350794] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[419.362707] Starting dynamic subtest: pipe-C-eDP-1
[419.428726] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[419.440665] Starting dynamic subtest: pipe-D-eDP-1
[419.506812] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[419.511613] Subtest crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.008s)
[421.452981] [104/156] (599s left) kms_pipe_stress (stress-xrgb8888-yftiled)
[421.533592] Starting subtest: stress-xrgb8888-yftiled
[421.538061] Subtest stress-xrgb8888-yftiled: SKIP (0.000s)
[421.602894] [105/156] (599s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[421.689785] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip
[421.694901] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.002s)
[421.800672] [106/156] (599s left) dumb_buffer (create-valid-dumb)
[421.859967] Starting subtest: create-valid-dumb
[421.862867] Subtest create-valid-dumb: SUCCESS (0.000s)
[421.976180] [107/156] (599s left) i915_drm_fdinfo (busy-check-all)
[422.013896] Starting subtest: busy-check-all
[422.016831] Starting dynamic subtest: rcs0
[422.022308] Dynamic subtest rcs0: SKIP (0.004s)
[422.036900] Starting dynamic subtest: bcs0
[422.042243] Dynamic subtest bcs0: SKIP (0.000s)
[422.052993] Starting dynamic subtest: vcs0
[422.058118] Dynamic subtest vcs0: SKIP (0.000s)
[422.068588] Starting dynamic subtest: vcs1
[422.073721] Dynamic subtest vcs1: SKIP (0.000s)
[422.084006] Starting dynamic subtest: vecs0
[422.088976] Dynamic subtest vecs0: SKIP (0.000s)
[422.099540] Starting dynamic subtest: ccs0
[422.104694] Dynamic subtest ccs0: SKIP (0.000s)
[422.109902] Subtest busy-check-all: SKIP (0.008s)
[422.161083] [108/156] (599s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted)
[422.260376] Starting subtest: multi-wait-all-for-submit-unsubmitted
[422.367894] Subtest multi-wait-all-for-submit-unsubmitted: SUCCESS (0.106s)
[422.443488] [109/156] (599s left) kms_panel_fitting (atomic-fastset)
[422.517357] Starting subtest: atomic-fastset
[422.519663] Starting dynamic subtest: pipe-A-eDP-1
[422.671711] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.154s)
[422.683823] Starting dynamic subtest: pipe-B-eDP-1
[423.915086] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.241s)
[423.929443] Starting dynamic subtest: pipe-C-eDP-1
[425.105436] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.188s)
[425.118869] Starting dynamic subtest: pipe-D-eDP-1
[426.350843] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.244s)
[426.353443] Subtest atomic-fastset: SUCCESS (3.832s)
[427.577874] [110/156] (594s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs-cc)
[427.663860] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs-cc
[427.666373] Starting dynamic subtest: pipe-A-eDP-1
[427.689725] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[427.702013] Starting dynamic subtest: pipe-B-eDP-1
[427.726463] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[427.737934] Starting dynamic subtest: pipe-C-eDP-1
[427.761021] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[427.771126] Starting dynamic subtest: pipe-D-eDP-1
[427.794619] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[427.797006] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.006s)
[429.930798] [111/156] (591s left) gem_exec_suspend (basic-s3-devices)
[429.997528] Starting subtest: basic-S3-devices
[429.999927] Starting dynamic subtest: smem
[441.524878] Dynamic subtest smem: SUCCESS (11.518s)
[441.528161] Subtest basic-S3-devices: SUCCESS (11.521s)
[441.717096] [112/156] (580s left) api_intel_bb (blit-reloc-purge-cache)
[441.777803] Starting subtest: blit-reloc-purge-cache
[441.782684] Subtest blit-reloc-purge-cache: SKIP (0.001s)
[441.885732] [113/156] (579s left) kms_content_protection (dp-mst-type-0)
[442.004382] Starting subtest: dp-mst-type-0
[442.008937] Subtest dp-mst-type-0: SKIP (0.000s)
[442.122566] [114/156] (579s left) i915_pm_rpm (debugfs-read)
[443.658453] Starting subtest: debugfs-read
[444.817118] Subtest debugfs-read: SUCCESS (1.157s)
[445.191106] [115/156] (576s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb565-draw-mmap-gtt)
[445.284943] Starting subtest: fbcpsrhdr-rgb565-draw-mmap-gtt
[445.289752] Subtest fbcpsrhdr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[445.388203] [116/156] (576s left) kms_scaling_modes (scaling-mode-none)
[445.462608] Starting subtest: scaling-mode-none
[445.465086] Starting dynamic subtest: pipe-A-eDP-1
[445.558319] Dynamic subtest pipe-A-eDP-1: SKIP (0.095s)
[445.572122] Starting dynamic subtest: pipe-B-eDP-1
[445.594259] Dynamic subtest pipe-B-eDP-1: SKIP (0.034s)
[445.605159] Starting dynamic subtest: pipe-C-eDP-1
[445.628946] Dynamic subtest pipe-C-eDP-1: SKIP (0.034s)
[445.640666] Starting dynamic subtest: pipe-D-eDP-1
[445.662968] Dynamic subtest pipe-D-eDP-1: SKIP (0.033s)
[445.667904] Subtest scaling-mode-none: SKIP (0.201s)
[445.777780] [117/156] (576s left) kms_cursor_crc (cursor-sliding-256x85)
[445.995859] Starting subtest: cursor-sliding-256x85
[446.044800] Subtest cursor-sliding-256x85: SKIP (0.043s)
[446.211675] [118/156] (575s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-yf-tiled)
[446.273869] Starting subtest: y-tiled-mc-ccs-to-vebox-yf-tiled
[446.279057] Subtest y-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s)
[446.461687] [119/156] (575s left) kms_frontbuffer_tracking (fbchdr-tiling-y)
[446.545386] Starting subtest: fbchdr-tiling-y
[446.550312] Subtest fbchdr-tiling-y: SKIP (0.000s)
[446.628786] [120/156] (575s left) gem_exec_reloc (basic-cpu-read)
[446.687969] Subtest basic-cpu-read: SKIP (0.000s)
[446.759906] [121/156] (575s left) kms_addfb_basic (bo-too-small)
[446.838339] Starting subtest: bo-too-small
[446.840964] Subtest bo-too-small: SUCCESS (0.000s)
[446.936603] [122/156] (575s left) gem_mmap_gtt (basic-write)
[446.992832] Subtest basic-write: SKIP (0.000s)
[447.057508] [123/156] (575s left) kms_ccs (ccs-on-another-bo-yf-tiled-ccs)
[447.137303] Starting subtest: ccs-on-another-bo-yf-tiled-ccs
[447.139670] Starting dynamic subtest: pipe-A-eDP-1
[447.164928] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[447.177007] Starting dynamic subtest: pipe-B-eDP-1
[447.202918] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[447.213876] Starting dynamic subtest: pipe-C-eDP-1
[447.239822] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[447.250740] Starting dynamic subtest: pipe-D-eDP-1
[447.276952] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[447.281849] Subtest ccs-on-another-bo-yf-tiled-ccs: SKIP (0.004s)
[449.671131] [124/156] (572s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[449.760131] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc
[449.765389] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[449.856780] [125/156] (572s left) kms_psr2_sf (psr2-overlay-plane-update-continuous-sf)
[449.934263] Starting subtest: psr2-overlay-plane-update-continuous-sf
[449.936456] Starting dynamic subtest: pipe-A-eDP-1
[451.044864] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.115s)
[451.056532] Starting dynamic subtest: pipe-B-eDP-1
[452.822797] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.777s)
[452.825364] Subtest psr2-overlay-plane-update-continuous-sf: SUCCESS (2.895s)
[453.625678] [126/156] (568s left) perf_pmu (init-wait)
[453.667064] Starting subtest: init-wait
[453.669969] Starting dynamic subtest: rcs0
[453.672924] Dynamic subtest rcs0: SUCCESS (0.002s)
[453.685884] Starting dynamic subtest: bcs0
[453.688595] Dynamic subtest bcs0: SUCCESS (0.001s)
[453.699518] Starting dynamic subtest: vcs0
[453.701762] Dynamic subtest vcs0: SUCCESS (0.000s)
[453.712324] Starting dynamic subtest: vcs1
[453.715010] Dynamic subtest vcs1: SUCCESS (0.001s)
[453.725903] Starting dynamic subtest: vecs0
[453.728451] Dynamic subtest vecs0: SUCCESS (0.000s)
[453.738893] Starting dynamic subtest: ccs0
[453.740966] Dynamic subtest ccs0: SUCCESS (0.000s)
[453.743314] Subtest init-wait: SUCCESS (0.009s)
[453.784588] [127/156] (568s left) i915_fb_tiling (basic-x-tiling)
[453.838861] Subtest basic-x-tiling: SKIP (0.000s)
[453.892939] [128/156] (568s left) sw_sync (sync_busy_fork_unixsocket)
[453.924104] Starting subtest: sync_busy_fork_unixsocket
[453.931790] Subtest sync_busy_fork_unixsocket: SUCCESS (0.008s)
[453.997980] [129/156] (568s left) syncobj_timeline (etime-single-wait-for-submit-unsubmitted)
[454.046406] Starting subtest: etime-single-wait-for-submit-unsubmitted
[454.151943] Subtest etime-single-wait-for-submit-unsubmitted: SUCCESS (0.106s)
[454.229385] [130/156] (568s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-pgflip-blt)
[454.303067] Starting subtest: psr-1p-primscrn-indfb-pgflip-blt
[461.730000] Subtest psr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.437s)
[461.856506] [131/156] (560s left) gem_exec_whisper (basic-queues-forked)
[461.929588] Starting subtest: basic-queues-forked
[486.471973] Subtest basic-queues-forked: SUCCESS (24.545s)
[486.653867] [132/156] (535s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[486.741906] Starting subtest: addfb25-y-tiled-legacy
[486.744547] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[486.830731] [133/156] (535s left) gem_exec_params (rsvd2-dirt)
[486.893116] Starting subtest: rsvd2-dirt
[486.898622] Subtest rsvd2-dirt: SKIP (0.000s)
[486.993321] [134/156] (535s left) kms_cursor_crc (cursor-offscreen-max-size)
[487.280541] Starting subtest: cursor-offscreen-max-size
[487.288644] Subtest cursor-offscreen-max-size: SKIP (0.000s)
[487.390240] [135/156] (535s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[487.952099] Starting subtest: syncobj-timeline-multiple-ext-nodes
[487.954855] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.004s)
[489.579583] [136/156] (533s left) gem_exec_reloc (basic-cpu-wc)
[489.638917] Subtest basic-cpu-wc: SKIP (0.000s)
[489.717116] [137/156] (533s left) kms_flip (2x-flip-vs-suspend)
[489.795667] Starting subtest: 2x-flip-vs-suspend
[489.801107] Subtest 2x-flip-vs-suspend: SKIP (0.002s)
[489.901401] [138/156] (532s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-indfb-plflip-blt)
[489.977156] Starting subtest: fbchdr-1p-primscrn-indfb-plflip-blt
[489.982444] Subtest fbchdr-1p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[490.059939] [139/156] (532s left) gem_exec_schedule (pi-ringfull)
[490.238389] Starting subtest: pi-ringfull
[490.240508] Starting dynamic subtest: rcs0
[490.264641] Dynamic subtest rcs0: SUCCESS (0.029s)
[490.281945] Starting dynamic subtest: bcs0
[490.291928] Dynamic subtest bcs0: SUCCESS (0.027s)
[490.307708] Starting dynamic subtest: vcs0
[490.319100] Dynamic subtest vcs0: SUCCESS (0.026s)
[490.335019] Starting dynamic subtest: vcs1
[490.346698] Dynamic subtest vcs1: SUCCESS (0.027s)
[490.362647] Starting dynamic subtest: vecs0
[490.373712] Dynamic subtest vecs0: SUCCESS (0.026s)
[490.389719] Starting dynamic subtest: ccs0
[490.400976] Dynamic subtest ccs0: SUCCESS (0.027s)
[490.403813] Subtest pi-ringfull: SUCCESS (0.166s)
[490.622496] [140/156] (532s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[490.710091] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[491.522864] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SUCCESS (0.814s)
[491.685051] [141/156] (531s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-cc-modifier-source-clamping)
[491.753337] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-cc-modifier-source-clamping
[491.780552] Starting dynamic subtest: pipe-A-plane-0
[492.069052] Dynamic subtest pipe-A-plane-0: SUCCESS (0.289s)
[492.081418] Starting dynamic subtest: pipe-A-plane-3
[492.302044] Dynamic subtest pipe-A-plane-3: SUCCESS (0.233s)
[493.429047] Starting dynamic subtest: pipe-B-plane-0
[493.742302] Dynamic subtest pipe-B-plane-0: SUCCESS (0.322s)
[493.755773] Starting dynamic subtest: pipe-B-plane-3
[493.976833] Dynamic subtest pipe-B-plane-3: SUCCESS (0.232s)
[494.290233] Subtest pixel-format-4-tiled-mtl-rc-ccs-cc-modifier-source-clamping: SUCCESS (2.536s)
[495.092888] [142/156] (527s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-shrfb-draw-blt)
[495.170977] Starting subtest: psrhdr-1p-primscrn-pri-shrfb-draw-blt
[495.176125] Subtest psrhdr-1p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[495.262558] [143/156] (527s left) kms_psr (fbc-pr-sprite-mmap-cpu)
[495.337048] Starting subtest: fbc-pr-sprite-mmap-cpu
[495.342915] Subtest fbc-pr-sprite-mmap-cpu: SKIP (0.000s)
[495.409039] [144/156] (527s left) kms_color_pipeline (plane-lut1d)
[495.478637] Starting subtest: plane-lut1d
[495.624536] Starting dynamic subtest: pipe-A-plane-0
[495.790851] Dynamic subtest pipe-A-plane-0: SUCCESS (0.166s)
[495.803161] Starting dynamic subtest: pipe-A-plane-1
[495.935104] Dynamic subtest pipe-A-plane-1: SUCCESS (0.144s)
[495.946898] Starting dynamic subtest: pipe-A-plane-2
[496.090022] Dynamic subtest pipe-A-plane-2: SUCCESS (0.155s)
[497.305757] Starting dynamic subtest: pipe-B-plane-0
[497.474676] Dynamic subtest pipe-B-plane-0: SUCCESS (0.178s)
[497.486066] Starting dynamic subtest: pipe-B-plane-1
[497.628878] Dynamic subtest pipe-B-plane-1: SUCCESS (0.155s)
[497.641016] Starting dynamic subtest: pipe-B-plane-2
[497.771994] Dynamic subtest pipe-B-plane-2: SUCCESS (0.144s)
[499.031140] Starting dynamic subtest: pipe-C-plane-0
[499.165815] Dynamic subtest pipe-C-plane-0: SUCCESS (0.144s)
[499.177498] Starting dynamic subtest: pipe-C-plane-1
[499.310680] Dynamic subtest pipe-C-plane-1: SUCCESS (0.144s)
[499.322059] Starting dynamic subtest: pipe-C-plane-2
[499.478491] Dynamic subtest pipe-C-plane-2: SUCCESS (0.166s)
[500.668806] Starting dynamic subtest: pipe-D-plane-0
[500.790969] Dynamic subtest pipe-D-plane-0: SUCCESS (0.133s)
[500.806019] Starting dynamic subtest: pipe-D-plane-1
[500.959058] Dynamic subtest pipe-D-plane-1: SUCCESS (0.166s)
[500.971948] Starting dynamic subtest: pipe-D-plane-2
[501.113107] Dynamic subtest pipe-D-plane-2: SUCCESS (0.155s)
[501.406137] Subtest plane-lut1d: SUCCESS (5.927s)
[502.242715] [145/156] (520s left) kms_plane_scaling (plane-scaler-unity-scaling-with-modifiers)
[502.315119] Starting subtest: plane-scaler-unity-scaling-with-modifiers
[502.317799] Starting dynamic subtest: pipe-A
[502.652974] Dynamic subtest pipe-A: SUCCESS (0.339s)
[502.664109] Starting dynamic subtest: pipe-B
[504.034409] Dynamic subtest pipe-B: SUCCESS (1.380s)
[504.046670] Starting dynamic subtest: pipe-C
[505.469932] Dynamic subtest pipe-C: SUCCESS (1.435s)
[505.481917] Starting dynamic subtest: pipe-D
[506.897946] Dynamic subtest pipe-D: SUCCESS (1.426s)
[506.900745] Subtest plane-scaler-unity-scaling-with-modifiers: SUCCESS (4.584s)
[508.070406] [146/156] (515s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-spr-indfb-onoff)
[508.152733] Starting subtest: hdr-2p-scndscrn-spr-indfb-onoff
[508.157990] Subtest hdr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[508.240961] [147/156] (515s left) kms_frontbuffer_tracking (psrhdr-1p-rte)
[508.319913] Starting subtest: psrhdr-1p-rte
[508.324767] Subtest psrhdr-1p-rte: SKIP (0.000s)
[508.411491] [148/156] (514s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-render)
[508.487814] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-render
[512.618106] Subtest fbc-1p-offscreen-pri-indfb-draw-render: SUCCESS (4.136s)
[513.770977] [149/156] (509s left) prime_busy (before)
[513.829266] Starting subtest: before
[513.834692] Starting dynamic subtest: rcs0
[513.870930] Dynamic subtest rcs0: SUCCESS (0.039s)
[513.882414] Starting dynamic subtest: bcs0
[513.918987] Dynamic subtest bcs0: SUCCESS (0.047s)
[513.931178] Starting dynamic subtest: vcs0
[513.960567] Dynamic subtest vcs0: SUCCESS (0.041s)
[513.972200] Starting dynamic subtest: vcs1
[514.004035] Dynamic subtest vcs1: SUCCESS (0.041s)
[514.015155] Starting dynamic subtest: vecs0
[514.043861] Dynamic subtest vecs0: SUCCESS (0.040s)
[514.055103] Starting dynamic subtest: ccs0
[514.083769] Dynamic subtest ccs0: SUCCESS (0.039s)
[514.192168] Subtest before: SUCCESS (0.362s)
[514.281121] [150/156] (509s left) gem_mmap_wc (write-gtt-read-wc)
[514.327011] Subtest write-gtt-read-wc: SKIP (0.000s)
[514.384105] [151/156] (509s left) gem_exec_flush (basic-uc-pro-default)
[514.434159] Starting subtest: basic-uc-pro-default
[519.892663] Subtest basic-uc-pro-default: SUCCESS (5.454s)
[520.079501] [152/156] (503s left) kms_psr (psr-cursor-render)
[520.161730] Starting subtest: psr-cursor-render
[520.164407] Starting dynamic subtest: eDP-1
[522.124010] Dynamic subtest eDP-1: SUCCESS (1.962s)
[522.126986] Subtest psr-cursor-render: SUCCESS (1.963s)
[522.984639] [153/156] (500s left) kms_psr2_sf (fbc-pr-cursor-plane-update-sf)
[523.063981] Starting subtest: fbc-pr-cursor-plane-update-sf
[523.068755] Subtest fbc-pr-cursor-plane-update-sf: SKIP (0.000s)
[523.131616] [154/156] (500s left) kms_psr2_sf (pr-overlay-plane-move-continuous-sf)
[523.219873] Starting subtest: pr-overlay-plane-move-continuous-sf
[523.225900] Subtest pr-overlay-plane-move-continuous-sf: SKIP (0.000s)
[523.297417] [155/156] (500s left) kms_lease (multimaster-lease)
[523.390115] Starting subtest: multimaster-lease
[523.392703] Subtest multimaster-lease: SUCCESS (0.003s)
[523.514612] [156/156] (500s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-pwrite)
[523.605638] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-pwrite
[530.505037] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-pwrite: SUCCESS (6.906s)
[530.653828] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: gem_mmap_gtt
results: parsing output: 4/ for test: kms_plane_multiple
results: parsing output: 5/ for test: syncobj_timeline
results: parsing output: 6/ for test: kms_flip
results: parsing output: 7/ for test: gem_ctx_persistence
results: parsing output: 8/ for test: gem_vm_create
results: parsing output: 9/ for test: perf
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: kms_hdr
results: parsing output: 13/ for test: gem_mmap_gtt
results: parsing output: 14/ for test: kms_big_fb
results: parsing output: 15/ for test: gem_eio
results: parsing output: 16/ for test: gem_caching
results: parsing output: 17/ for test: kms_flip
results: parsing output: 18/ for test: kms_big_fb
results: parsing output: 19/ for test: kms_pm_rpm
results: parsing output: 20/ for test: gem_exec_flush
results: parsing output: 21/ for test: gem_ccs
results: parsing output: 22/ for test: kms_cursor_legacy
results: parsing output: 23/ for test: gem_pwrite_snooped
results: parsing output: 24/ for test: kms_dp_link_training
results: parsing output: 25/ for test: gem_exec_await
results: parsing output: 26/ for test: kms_pm_rpm
results: parsing output: 27/ for test: kms_chamelium_hpd
results: parsing output: 28/ for test: kms_draw_crc
results: parsing output: 29/ for test: gem_eio
results: parsing output: 30/ for test: syncobj_wait
results: parsing output: 31/ for test: gem_close_race
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: perf
results: parsing output: 34/ for test: kms_big_fb
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: syncobj_wait
results: parsing output: 37/ for test: gem_fenced_exec_thrash
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: gem_ppgtt
results: parsing output: 40/ for test: gem_request_retire
results: parsing output: 41/ for test: kms_chamelium_audio
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: gem_mmap
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: kms_chamelium_edid
results: parsing output: 46/ for test: gem_pxp
results: parsing output: 47/ for test: kms_cursor_legacy
results: parsing output: 48/ for test: gem_exec_balancer
results: parsing output: 49/ for test: kms_big_fb
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_flip_scaled_crc
results: parsing output: 53/ for test: syncobj_timeline
results: parsing output: 54/ for test: kms_flip
results: parsing output: 55/ for test: gem_exec_schedule
results: parsing output: 56/ for test: api_intel_bb
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: gem_mmap_gtt
results: parsing output: 60/ for test: syncobj_eventfd
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: gem_exec_params
results: parsing output: 64/ for test: kms_psr
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_joiner
results: parsing output: 67/ for test: sysfs_preempt_timeout
results: parsing output: 68/ for test: gem_mmap_gtt
results: parsing output: 69/ for test: kms_frontbuffer_tracking
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_ccs
results: parsing output: 73/ for test: gem_eio
results: parsing output: 74/ for test: kms_psr
results: parsing output: 75/ for test: gem_exec_balancer
results: parsing output: 76/ for test: kms_universal_plane
results: parsing output: 77/ for test: gem_spin_batch
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: kms_plane_scaling
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: gem_exec_whisper
results: parsing output: 83/ for test: kms_cursor_crc
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_async_flips
results: parsing output: 88/ for test: i915_query
results: parsing output: 89/ for test: gem_exec_create
results: parsing output: 90/ for test: gem_ppgtt
results: parsing output: 91/ for test: gen9_exec_parse
results: parsing output: 92/ for test: kms_vrr
results: parsing output: 93/ for test: gem_ctx_shared
results: parsing output: 94/ for test: kms_properties
results: parsing output: 95/ for test: gem_mmap_gtt
results: parsing output: 96/ for test: syncobj_timeline
results: parsing output: 97/ for test: kms_addfb_basic
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: kms_big_fb
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: gem_ppgtt
results: parsing output: 102/ for test: kms_ccs
results: parsing output: 103/ for test: kms_pipe_stress
results: parsing output: 104/ for test: kms_big_fb
results: parsing output: 105/ for test: dumb_buffer
results: parsing output: 106/ for test: i915_drm_fdinfo
results: parsing output: 107/ for test: syncobj_wait
results: parsing output: 108/ for test: kms_panel_fitting
results: parsing output: 109/ for test: kms_ccs
results: parsing output: 110/ for test: gem_exec_suspend
results: parsing output: 111/ for test: api_intel_bb
results: parsing output: 112/ for test: kms_content_protection
results: parsing output: 113/ for test: i915_pm_rpm
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: kms_scaling_modes
results: parsing output: 116/ for test: kms_cursor_crc
results: parsing output: 117/ for test: gem_render_copy
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: gem_exec_reloc
results: parsing output: 120/ for test: kms_addfb_basic
results: parsing output: 121/ for test: gem_mmap_gtt
results: parsing output: 122/ for test: kms_ccs
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_psr2_sf
results: parsing output: 125/ for test: perf_pmu
results: parsing output: 126/ for test: i915_fb_tiling
results: parsing output: 127/ for test: sw_sync
results: parsing output: 128/ for test: syncobj_timeline
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: gem_exec_whisper
results: parsing output: 131/ for test: kms_addfb_basic
results: parsing output: 132/ for test: gem_exec_params
results: parsing output: 133/ for test: kms_cursor_crc
results: parsing output: 134/ for test: gem_exec_fence
results: parsing output: 135/ for test: gem_exec_reloc
results: parsing output: 136/ for test: kms_flip
results: parsing output: 137/ for test: kms_frontbuffer_tracking
results: parsing output: 138/ for test: gem_exec_schedule
results: parsing output: 139/ for test: kms_big_fb
results: parsing output: 140/ for test: kms_plane
results: parsing output: 141/ for test: kms_frontbuffer_tracking
results: parsing output: 142/ for test: kms_psr
results: parsing output: 143/ for test: kms_color_pipeline
results: parsing output: 144/ for test: kms_plane_scaling
results: parsing output: 145/ for test: kms_frontbuffer_tracking
results: parsing output: 146/ for test: kms_frontbuffer_tracking
results: parsing output: 147/ for test: kms_frontbuffer_tracking
results: parsing output: 148/ for test: prime_busy
results: parsing output: 149/ for test: gem_mmap_wc
results: parsing output: 150/ for test: gem_exec_flush
results: parsing output: 151/ for test: kms_psr
results: parsing output: 152/ for test: kms_psr2_sf
results: parsing output: 153/ for test: kms_psr2_sf
results: parsing output: 154/ for test: kms_lease
results: parsing output: 155/ for test: kms_frontbuffer_tracking
Done.