[58.612374] Initializing watchdogs
[58.612422]   /dev/watchdog0
[58.626343] [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]
[58.630955] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.633125] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.635234] [001/131] (960s left) kms_atomic_transition (plane-all-transition)
[58.739289] Starting subtest: plane-all-transition
[58.740261] Starting dynamic subtest: pipe-A-eDP-1
[61.283143] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.532s)
[61.585778] Starting dynamic subtest: pipe-B-eDP-1
[64.796612] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.206s)
[65.092231] Subtest plane-all-transition: SUCCESS (6.329s)
[65.932874] [002/131] (953s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted)
[66.001691] Starting subtest: multi-wait-available-unsubmitted-submitted
[66.003144] Subtest multi-wait-available-unsubmitted-submitted: SUCCESS (0.000s)
[66.133616] [003/131] (953s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[66.230728] Starting subtest: fbc-rgb565-draw-mmap-gtt
[66.232597] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[66.387400] [004/131] (952s left) gen9_exec_parse (bb-start-param)
[66.452026] Subtest bb-start-param: SKIP (0.000s)
[66.512888] [005/131] (952s left) syncobj_wait (invalid-signal-one-illegal-handle)
[66.574559] Starting subtest: invalid-signal-one-illegal-handle
[66.575794] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[66.699192] [006/131] (952s left) kms_psr (fbc-pr-cursor-plane-onoff)
[66.815063] Starting subtest: fbc-pr-cursor-plane-onoff
[66.816743] Subtest fbc-pr-cursor-plane-onoff: SKIP (0.000s)
[66.902700] [007/131] (952s left) syncobj_timeline (etime-single-wait-all-available-unsubmitted)
[67.125713] Starting subtest: etime-single-wait-all-available-unsubmitted
[67.227045] Subtest etime-single-wait-all-available-unsubmitted: SUCCESS (0.100s)
[67.331845] [008/131] (952s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs)
[67.455741] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs
[67.456939] Starting dynamic subtest: pipe-A-eDP-1
[67.485402] Dynamic subtest pipe-A-eDP-1: SKIP (0.004s)
[67.491546] Starting dynamic subtest: pipe-B-eDP-1
[67.517131] Dynamic subtest pipe-B-eDP-1: SKIP (0.003s)
[67.522678] Starting dynamic subtest: pipe-C-eDP-1
[67.545614] Dynamic subtest pipe-C-eDP-1: SKIP (0.003s)
[67.551303] Starting dynamic subtest: pipe-D-eDP-1
[67.574867] Dynamic subtest pipe-D-eDP-1: SKIP (0.004s)
[67.576652] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs: SKIP (0.020s)
[69.699835] [009/131] (949s left) syncobj_wait (reset-unsignaled)
[69.743978] Starting subtest: reset-unsignaled
[69.744976] Subtest reset-unsignaled: SUCCESS (0.000s)
[69.852057] [010/131] (949s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling)
[69.930017] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling
[69.931184] Starting dynamic subtest: pipe-A-default-mode
[70.224909] Dynamic subtest pipe-A-default-mode: SKIP (0.292s)
[70.226809] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling: SKIP (0.293s)
[71.042916] [011/131] (948s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[71.093699] Subtest no-spare-fences-interruptible: SKIP (0.000s)
[71.158384] [012/131] (948s left) perf (i915-ref-count)
[71.240724] Starting subtest: i915-ref-count
[71.302252] Subtest i915-ref-count: SUCCESS (0.061s)
[71.350616] [013/131] (948s left) gem_exec_reloc (basic-wc-gtt-active)
[71.408443] Subtest basic-wc-gtt-active: SKIP (0.000s)
[71.478675] [014/131] (948s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[71.847816] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[72.627791] [015/131] (946s left) kms_addfb_basic (bad-pitch-0)
[72.679032] Starting subtest: bad-pitch-0
[72.679943] Subtest bad-pitch-0: SUCCESS (0.000s)
[72.817349] [016/131] (946s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[72.878681] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[72.880858] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[73.107388] [017/131] (946s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-fully-sf)
[78.166516] Starting subtest: psr2-overlay-plane-move-continuous-exceed-fully-sf
[78.167424] Starting dynamic subtest: pipe-A-eDP-1
[95.339632] Dynamic subtest pipe-A-eDP-1: SUCCESS (17.165s)
[95.346496] Starting dynamic subtest: pipe-B-eDP-1
[112.480047] Dynamic subtest pipe-B-eDP-1: SUCCESS (17.136s)
[112.480909] Subtest psr2-overlay-plane-move-continuous-exceed-fully-sf: SUCCESS (34.305s)
[113.299890] [018/131] (906s left) gem_exec_schedule (semaphore-noskip)
[113.366244] Starting subtest: semaphore-noskip
[113.787531] Subtest semaphore-noskip: SUCCESS (0.419s)
[114.150144] [019/131] (905s left) gem_mmap_gtt (ptrace)
[114.203517] Subtest ptrace: SKIP (0.000s)
[114.262393] [020/131] (905s left) kms_addfb_basic (bad-pitch-256)
[114.319684] Starting subtest: bad-pitch-256
[114.320553] Subtest bad-pitch-256: SUCCESS (0.000s)
[114.486317] [021/131] (905s left) kms_cursor_crc (cursor-offscreen-128x128)
[114.667741] Starting subtest: cursor-offscreen-128x128
[114.671287] Starting dynamic subtest: pipe-A-eDP-1
[116.613251] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.942s)
[116.641530] Starting dynamic subtest: pipe-D-eDP-1
[119.197915] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.565s)
[119.198972] Subtest cursor-offscreen-128x128: SUCCESS (4.530s)
[120.063184] [022/131] (899s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-cpu)
[120.165927] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-cpu
[120.167808] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[120.291925] [023/131] (899s left) gem_exec_gttfill (engines)
[120.353309] Starting subtest: engines
[120.354286] Starting dynamic subtest: rcs0
[143.134951] Dynamic subtest rcs0: SUCCESS (22.778s)
[143.142839] Starting dynamic subtest: bcs0
[166.392978] Dynamic subtest bcs0: SUCCESS (23.255s)
[166.402421] Starting dynamic subtest: vcs0
[189.726505] Dynamic subtest vcs0: SUCCESS (23.329s)
[189.735871] Starting dynamic subtest: vcs1
[213.014439] Dynamic subtest vcs1: SUCCESS (23.287s)
[213.022497] Starting dynamic subtest: vecs0
[236.350881] Dynamic subtest vecs0: SUCCESS (23.333s)
[236.361417] Starting dynamic subtest: ccs0
[259.592935] Dynamic subtest ccs0: SUCCESS (23.237s)
[259.597046] Subtest engines: SUCCESS (139.234s)
[259.796866] [024/131] (760s left) gem_mmap_wc (set-cache-level)
[259.888679] Subtest set-cache-level: SKIP (0.000s)
[259.951507] [025/131] (759s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[260.049185] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[260.050333] Starting dynamic subtest: pipe-A-eDP-1
[260.068960] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.020s)
[260.076528] Starting dynamic subtest: pipe-B-eDP-1
[260.089555] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.020s)
[260.096331] Starting dynamic subtest: pipe-C-eDP-1
[260.110191] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.020s)
[260.117434] Starting dynamic subtest: pipe-D-eDP-1
[260.131287] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.020s)
[260.132126] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SUCCESS (0.083s)
[262.325464] [026/131] (757s left) kms_pipe_b_c_ivb (pipe-b-double-modeset-then-modeset-pipe-c)
[262.389384] Subtest pipe-B-double-modeset-then-modeset-pipe-C: SKIP (0.000s)
[262.453474] [027/131] (757s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[262.562403] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[263.367205] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SUCCESS (0.805s)
[263.539670] [028/131] (756s left) syncobj_timeline (multi-wait-available-signaled)
[263.594855] Starting subtest: multi-wait-available-signaled
[263.595957] Subtest multi-wait-available-signaled: SUCCESS (0.000s)
[263.723976] [029/131] (756s left) perf_pmu (busy)
[263.769256] Starting subtest: busy
[263.770094] Starting dynamic subtest: rcs0
[264.388476] Dynamic subtest rcs0: SUCCESS (0.618s)
[264.398603] Starting dynamic subtest: bcs0
[264.956458] Dynamic subtest bcs0: SUCCESS (0.566s)
[264.966845] Starting dynamic subtest: vcs0
[266.904303] Dynamic subtest vcs0: SUCCESS (1.943s)
[266.913961] Starting dynamic subtest: vcs1
[268.888077] Dynamic subtest vcs1: SUCCESS (1.982s)
[268.897659] Starting dynamic subtest: vecs0
[270.936308] Dynamic subtest vecs0: SUCCESS (2.046s)
[270.945604] Starting dynamic subtest: ccs0
[271.510344] Dynamic subtest ccs0: SUCCESS (0.574s)
[271.511638] Subtest busy: SUCCESS (7.741s)
[271.646509] [030/131] (748s left) gem_exec_async (forked-writes)
[271.698733] Starting subtest: forked-writes
[271.699721] Starting dynamic subtest: rcs0
[271.731338] Dynamic subtest rcs0: SUCCESS (0.032s)
[271.740479] Starting dynamic subtest: bcs0
[271.753481] Dynamic subtest bcs0: SUCCESS (0.022s)
[271.760332] Starting dynamic subtest: vcs0
[271.777686] Dynamic subtest vcs0: SUCCESS (0.024s)
[271.785716] Starting dynamic subtest: vcs1
[271.803260] Dynamic subtest vcs1: SUCCESS (0.025s)
[271.810580] Starting dynamic subtest: vecs0
[271.829852] Dynamic subtest vecs0: SUCCESS (0.026s)
[271.837992] Starting dynamic subtest: ccs0
[271.852400] Dynamic subtest ccs0: SUCCESS (0.022s)
[271.853225] Subtest forked-writes: SUCCESS (0.154s)
[272.913817] [031/131] (747s left) gem_eio (in-flight-contexts-1us)
[273.140978] Starting subtest: in-flight-contexts-1us
[286.949717] Subtest in-flight-contexts-1us: SUCCESS (13.809s)
[287.140544] [032/131] (732s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-rc-ccs)
[287.231311] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-rc-ccs
[287.232192] Starting dynamic subtest: pipe-A-eDP-1
[287.240977] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[287.248074] Starting dynamic subtest: pipe-B-eDP-1
[287.256836] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[287.263818] Starting dynamic subtest: pipe-C-eDP-1
[287.272244] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[287.278869] Starting dynamic subtest: pipe-D-eDP-1
[287.287694] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[287.289372] Subtest crc-primary-rotation-180-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[289.398501] [033/131] (730s left) kms_psr (fbc-psr-primary-mmap-cpu)
[289.492584] Starting subtest: fbc-psr-primary-mmap-cpu
[289.493538] Starting dynamic subtest: eDP-1
[289.495398] Dynamic subtest eDP-1: SKIP (0.000s)
[289.497131] Subtest fbc-psr-primary-mmap-cpu: SKIP (0.001s)
[289.582533] [034/131] (730s left) kms_big_fb (y-tiled-16bpp-rotate-90)
[289.681058] Starting subtest: y-tiled-16bpp-rotate-90
[289.682987] Subtest y-tiled-16bpp-rotate-90: SKIP (0.000s)
[289.813383] [035/131] (730s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-blt)
[289.900289] Starting subtest: psr-2p-primscrn-cur-indfb-draw-blt
[289.902033] Subtest psr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[290.022748] [036/131] (730s left) kms_hdr (static-swap)
[290.111081] Starting subtest: static-swap
[290.113725] Subtest static-swap: SKIP (0.000s)
[290.201778] [037/131] (730s left) gem_spin_batch (resubmit)
[290.262706] Starting subtest: resubmit
[290.263659] Starting dynamic subtest: rcs0
[290.268997] Dynamic subtest rcs0: SUCCESS (0.006s)
[290.276188] Starting dynamic subtest: bcs0
[290.277064] Dynamic subtest bcs0: SUCCESS (0.002s)
[290.283903] Starting dynamic subtest: vcs0
[290.284778] Dynamic subtest vcs0: SUCCESS (0.003s)
[290.291492] Starting dynamic subtest: vcs1
[290.292394] Dynamic subtest vcs1: SUCCESS (0.002s)
[290.299040] Starting dynamic subtest: vecs0
[290.299893] Dynamic subtest vecs0: SUCCESS (0.002s)
[290.306773] Starting dynamic subtest: ccs0
[290.307702] Dynamic subtest ccs0: SUCCESS (0.002s)
[290.308608] Subtest resubmit: SUCCESS (0.021s)
[290.535830] [038/131] (729s left) gem_ccs (ctrl-surf-copy)
[290.590985] Starting subtest: ctrl-surf-copy
[290.593053] Subtest ctrl-surf-copy: SKIP (0.000s)
[290.710816] [039/131] (729s left) syncobj_eventfd (timeline-wait-signaled)
[290.768498] Starting subtest: timeline-wait-signaled
[290.769514] Subtest timeline-wait-signaled: SUCCESS (0.000s)
[290.900979] [040/131] (729s left) gem_exec_balancer (parallel-out-fence)
[291.170048] Starting subtest: parallel-out-fence
[292.326972] Subtest parallel-out-fence: SUCCESS (1.156s)
[292.433821] [041/131] (727s left) syncobj_wait (single-wait-all-submitted)
[292.486061] Starting subtest: single-wait-all-submitted
[292.596233] Subtest single-wait-all-submitted: SUCCESS (0.107s)
[292.688162] [042/131] (727s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-msflip-blt)
[292.794686] Starting subtest: fbcpsr-1p-primscrn-shrfb-msflip-blt
[300.139121] Subtest fbcpsr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.345s)
[300.304729] [043/131] (720s left) kms_flip (flip-vs-panning)
[300.390693] Starting subtest: flip-vs-panning
[300.392873] Starting dynamic subtest: A-eDP1
[309.117925] Dynamic subtest A-eDP1: SUCCESS (8.724s)
[309.126784] Starting dynamic subtest: B-eDP1
[317.852040] Dynamic subtest B-eDP1: SUCCESS (8.731s)
[317.860944] Starting dynamic subtest: C-eDP1
[326.565408] Dynamic subtest C-eDP1: SUCCESS (8.714s)
[326.573520] Starting dynamic subtest: D-eDP1
[335.298310] Dynamic subtest D-eDP1: SUCCESS (8.732s)
[335.302884] Subtest flip-vs-panning: SUCCESS (34.911s)
[336.485779] [044/131] (684s left) kms_vblank (ts-continuation-suspend)
[336.576523] Starting subtest: ts-continuation-suspend
[336.577458] Starting dynamic subtest: pipe-A-eDP-1
[352.881986] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.716s)
[352.892601] Starting dynamic subtest: pipe-D-eDP-1
[370.864005] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.575s)
[370.864845] Subtest ts-continuation-suspend: SUCCESS (8.296s)
[377.711939] [045/131] (648s left) gem_lmem_swapping (verify-ccs)
[377.756855] Subtest verify-ccs: SKIP (0.000s)
[377.816214] [046/131] (648s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-blt)
[377.913181] Starting subtest: fbcpsr-rgb565-draw-blt
[385.014429] Subtest fbcpsr-rgb565-draw-blt: SUCCESS (6.962s)
[385.169146] [047/131] (641s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled)
[385.226703] Starting subtest: yf-tiled-ccs-to-yf-tiled
[385.228601] Subtest yf-tiled-ccs-to-yf-tiled: SKIP (0.000s)
[385.428492] [048/131] (641s left) kms_chamelium_frames (hdmi-crc-fast)
[385.808909] Subtest hdmi-crc-fast: SKIP (0.000s)
[386.579598] [049/131] (640s left) kms_chamelium_edid (dp-edid-change-during-suspend)
[386.958843] Subtest dp-edid-change-during-suspend: SKIP (0.000s)
[387.723327] [050/131] (638s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180)
[387.820174] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180
[387.822196] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[387.936491] [051/131] (638s left) gem_workarounds (suspend-resume-context)
[388.010983] Starting subtest: suspend-resume-context
[404.560453] Subtest suspend-resume-context: SUCCESS (1.573s)
[410.753620] [052/131] (622s left) perf (invalid-remove-userspace-config)
[410.881143] Starting subtest: invalid-remove-userspace-config
[410.890802] Subtest invalid-remove-userspace-config: SUCCESS (0.009s)
[410.923508] [053/131] (621s left) gem_exec_fence (basic-wait-all)
[410.987178] Starting subtest: basic-wait-all
[411.073292] Subtest basic-wait-all: SUCCESS (0.084s)
[412.968546] [FACT gem_exec_fence (basic-wait-all)] new: kernel.kmod_is_loaded.vgem: true
[412.970679] [054/131] (619s left) gem_mmap_gtt (basic-write)
[413.028468] Subtest basic-write: SKIP (0.000s)
[413.095092] [055/131] (619s left) gem_exec_flush (basic-wb-pro-default)
[413.170346] Starting subtest: basic-wb-pro-default
[418.710645] Subtest basic-wb-pro-default: SUCCESS (5.463s)
[418.912715] [056/131] (614s left) gem_userptr_blits (invalid-mmap-offset-unsync)
[418.976719] Subtest invalid-mmap-offset-unsync: SKIP (0.000s)
[419.135983] [057/131] (613s left) kms_frontbuffer_tracking (fbc-2p-pri-indfb-multidraw)
[419.240183] Starting subtest: fbc-2p-pri-indfb-multidraw
[419.241847] Subtest fbc-2p-pri-indfb-multidraw: SKIP (0.000s)
[419.377077] [058/131] (613s left) gem_pxp (create-protected-buffer)
[419.499949] Starting subtest: create-protected-buffer
[419.501174] Subtest create-protected-buffer: SUCCESS (0.000s)
[419.643684] [059/131] (613s left) perf (polling)
[419.735798] Starting subtest: polling
[419.736940] Starting dynamic subtest: 0-rcs0
[429.757450] Dynamic subtest 0-rcs0: SUCCESS (9.970s)
[429.766442] Starting dynamic subtest: 1-vcs1
[439.769113] Dynamic subtest 1-vcs1: SUCCESS (9.993s)
[439.770201] Subtest polling: SUCCESS (19.966s)
[439.811810] [060/131] (593s left) kms_atomic (plane-invalid-params)
[439.916279] Starting subtest: plane-invalid-params
[439.917423] Starting dynamic subtest: pipe-A-eDP-1
[440.316801] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.398s)
[440.317776] Subtest plane-invalid-params: SUCCESS (0.400s)
[441.208281] [061/131] (591s left) kms_prop_blob (basic)
[441.265877] Starting subtest: basic
[441.266827] Subtest basic: SUCCESS (0.000s)
[441.387833] [062/131] (591s left) kms_flip (nonexisting-fb-interruptible)
[441.488007] Starting subtest: nonexisting-fb-interruptible
[441.490256] Starting dynamic subtest: A-eDP1
[442.709800] Dynamic subtest A-eDP1: SUCCESS (1.218s)
[442.721518] Starting dynamic subtest: B-eDP1
[443.905779] Dynamic subtest B-eDP1: SUCCESS (1.193s)
[443.915709] Starting dynamic subtest: C-eDP1
[445.033737] Dynamic subtest C-eDP1: SUCCESS (1.126s)
[445.044043] Starting dynamic subtest: D-eDP1
[446.167135] Dynamic subtest D-eDP1: SUCCESS (1.132s)
[446.169623] Subtest nonexisting-fb-interruptible: SUCCESS (4.680s)
[447.361004] [063/131] (585s left) kms_prop_blob (invalid-get-prop-any)
[447.422600] Starting subtest: invalid-get-prop-any
[447.423678] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[447.536779] [064/131] (585s left) kms_vblank (query-forked-busy)
[447.622889] Starting subtest: query-forked-busy
[447.623736] Starting dynamic subtest: pipe-A-eDP-1
[449.505922] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.883s)
[449.517190] Starting dynamic subtest: pipe-D-eDP-1
[452.097355] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.588s)
[452.098280] Subtest query-forked-busy: SUCCESS (4.474s)
[452.926670] [065/131] (580s left) kms_frontbuffer_tracking (fbc-1p-pri-indfb-multidraw)
[453.029574] Starting subtest: fbc-1p-pri-indfb-multidraw
[466.140168] Subtest fbc-1p-pri-indfb-multidraw: SUCCESS (13.110s)
[467.546521] [066/131] (565s left) kms_plane_scaling (invalid-num-scalers)
[467.637748] Starting subtest: invalid-num-scalers
[467.638677] Starting dynamic subtest: pipe-A-eDP-1-invalid-num-scalers
[467.654260] Dynamic subtest pipe-A-eDP-1-invalid-num-scalers: SUCCESS (0.016s)
[467.663598] Starting dynamic subtest: pipe-B-eDP-1-invalid-num-scalers
[467.683371] Dynamic subtest pipe-B-eDP-1-invalid-num-scalers: SUCCESS (0.028s)
[467.692600] Starting dynamic subtest: pipe-C-eDP-1-invalid-num-scalers
[467.713401] Dynamic subtest pipe-C-eDP-1-invalid-num-scalers: SUCCESS (0.028s)
[467.723619] Starting dynamic subtest: pipe-D-eDP-1-invalid-num-scalers
[467.751740] Dynamic subtest pipe-D-eDP-1-invalid-num-scalers: SUCCESS (0.037s)
[467.752628] Subtest invalid-num-scalers: SUCCESS (0.114s)
[467.885578] [067/131] (565s left) i915_pm_rps (fence-order)
[467.941695] Starting subtest: fence-order
[471.404961] Subtest fence-order: SUCCESS (3.460s)
[471.568971] [068/131] (561s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-pwrite)
[471.677268] Starting subtest: fbc-rgb101010-draw-pwrite
[477.009671] Subtest fbc-rgb101010-draw-pwrite: SUCCESS (5.330s)
[478.156208] [069/131] (555s left) gem_mmap_gtt (fault-concurrent)
[478.216540] Subtest fault-concurrent: SKIP (0.000s)
[478.292134] [070/131] (555s left) gem_ctx_isolation (dirty-switch)
[478.349594] Starting subtest: dirty-switch
[478.350693] Starting dynamic subtest: rcs0
[478.543545] Dynamic subtest rcs0: SUCCESS (0.194s)
[478.553083] Starting dynamic subtest: bcs0
[478.765326] Dynamic subtest bcs0: SUCCESS (0.221s)
[478.775925] Starting dynamic subtest: vcs0
[478.975533] Dynamic subtest vcs0: SUCCESS (0.209s)
[478.985275] Starting dynamic subtest: vcs1
[481.068715] Dynamic subtest vcs1: SUCCESS (2.092s)
[481.079168] Starting dynamic subtest: vecs0
[483.069392] Dynamic subtest vecs0: SUCCESS (1.999s)
[483.079737] Starting dynamic subtest: ccs0
[485.133138] Dynamic subtest ccs0: SUCCESS (2.062s)
[485.134317] Subtest dirty-switch: SUCCESS (6.782s)
[485.415548] [071/131] (548s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen)
[485.514879] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen
[485.516623] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[485.631711] [072/131] (547s left) gem_exec_reloc (basic-write-gtt-active)
[485.691448] Subtest basic-write-gtt-active: SKIP (0.000s)
[485.765280] [073/131] (547s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[485.857180] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[485.859021] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[485.968794] [074/131] (547s left) kms_frontbuffer_tracking (psr-indfb-scaledprimary)
[486.050437] Starting subtest: psr-indfb-scaledprimary
[491.789806] Subtest psr-indfb-scaledprimary: SUCCESS (5.737s)
[491.964495] [075/131] (541s left) kms_big_fb (x-tiled-8bpp-rotate-0)
[492.070709] Starting subtest: x-tiled-8bpp-rotate-0
[493.227908] Subtest x-tiled-8bpp-rotate-0: SUCCESS (1.157s)
[493.357299] [076/131] (540s left) sysfs_heartbeat_interval (invalid)
[493.415273] Starting subtest: invalid
[493.416256] Starting dynamic subtest: vecs0
[493.417237] Dynamic subtest vecs0: SUCCESS (0.000s)
[493.425886] Starting dynamic subtest: ccs0
[493.426765] Dynamic subtest ccs0: SUCCESS (0.000s)
[493.434596] Starting dynamic subtest: vcs0
[493.435431] Dynamic subtest vcs0: SUCCESS (0.000s)
[493.443396] Starting dynamic subtest: bcs0
[493.444381] Dynamic subtest bcs0: SUCCESS (0.000s)
[493.454244] Starting dynamic subtest: rcs0
[493.455139] Dynamic subtest rcs0: SUCCESS (0.000s)
[493.462860] Starting dynamic subtest: vcs1
[493.463742] Dynamic subtest vcs1: SUCCESS (0.000s)
[493.464618] Subtest invalid: SUCCESS (0.005s)
[493.541921] [077/131] (540s left) perf_pmu (render-node-busy)
[493.612298] Starting subtest: render-node-busy
[493.613672] Starting dynamic subtest: rcs0
[494.215897] Dynamic subtest rcs0: SUCCESS (0.603s)
[494.228253] Starting dynamic subtest: bcs0
[494.777618] Dynamic subtest bcs0: SUCCESS (0.560s)
[494.788829] Starting dynamic subtest: vcs0
[496.855863] Dynamic subtest vcs0: SUCCESS (2.072s)
[496.867017] Starting dynamic subtest: vcs1
[498.902931] Dynamic subtest vcs1: SUCCESS (2.044s)
[498.913579] Starting dynamic subtest: vecs0
[500.886223] Dynamic subtest vecs0: SUCCESS (1.980s)
[500.897284] Starting dynamic subtest: ccs0
[501.460463] Dynamic subtest ccs0: SUCCESS (0.574s)
[501.461659] Subtest render-node-busy: SUCCESS (7.846s)
[501.554274] [078/131] (532s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-onoff)
[501.661017] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-onoff
[508.555274] Subtest fbcpsr-1p-primscrn-cur-indfb-onoff: SUCCESS (6.892s)
[508.709149] [079/131] (525s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-msflip-blt)
[508.802545] Starting subtest: fbcpsr-2p-scndscrn-indfb-msflip-blt
[508.804136] Subtest fbcpsr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[508.941282] [080/131] (524s left) gem_exec_fence (syncobj-export)
[509.372894] Starting subtest: syncobj-export
[509.376436] Subtest syncobj-export: SUCCESS (0.004s)
[510.951465] [081/131] (522s left) i915_module_load (resize-bar)
[510.979749] Starting subtest: resize-bar
[510.985155] Subtest resize-bar: SKIP (0.006s)
[511.025255] [082/131] (522s left) template (b)
[511.082542] Starting subtest: B
[511.083552] Subtest B: SUCCESS (0.000s)
[511.224246] [083/131] (522s left) gem_userptr_blits (map-fixed-invalidate-busy)
[511.295816] Starting subtest: map-fixed-invalidate-busy
[511.297644] Subtest map-fixed-invalidate-busy: SKIP (0.000s)
[511.477425] [084/131] (522s left) kms_flip (2x-flip-vs-expired-vblank)
[511.571065] Starting subtest: 2x-flip-vs-expired-vblank
[511.581491] Subtest 2x-flip-vs-expired-vblank: SKIP (0.011s)
[511.734904] [085/131] (522s left) api_intel_bb (crc32)
[511.794170] Starting subtest: crc32
[511.795201] Starting dynamic subtest: rcs0-smem0
[512.133976] Dynamic subtest rcs0-smem0: SUCCESS (0.336s)
[512.145177] Starting dynamic subtest: bcs0-smem0
[512.494206] Dynamic subtest bcs0-smem0: SUCCESS (0.357s)
[512.505365] Starting dynamic subtest: vcs0-smem0
[512.845856] Dynamic subtest vcs0-smem0: SUCCESS (0.349s)
[512.856223] Starting dynamic subtest: vcs1-smem0
[513.206256] Dynamic subtest vcs1-smem0: SUCCESS (0.357s)
[513.218231] Starting dynamic subtest: vecs0-smem0
[513.577288] Dynamic subtest vecs0-smem0: SUCCESS (0.368s)
[513.588745] Starting dynamic subtest: ccs0-smem0
[513.924093] Dynamic subtest ccs0-smem0: SUCCESS (0.343s)
[513.925586] Subtest crc32: SUCCESS (2.130s)
[514.088110] [086/131] (519s left) vgem_basic (dmabuf-export)
[514.131807] Starting subtest: dmabuf-export
[514.170777] Subtest dmabuf-export: SUCCESS (0.040s)
[514.310580] [087/131] (519s left) kms_psr (psr2-sprite-blt)
[514.398745] Starting subtest: psr2-sprite-blt
[514.399665] Starting dynamic subtest: eDP-1
[516.173834] Dynamic subtest eDP-1: SUCCESS (1.775s)
[516.174814] Subtest psr2-sprite-blt: SUCCESS (1.776s)
[517.053020] [088/131] (516s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-wc)
[517.155679] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-wc
[517.157997] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[517.289865] [089/131] (516s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[517.390598] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-gtt
[517.392254] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[517.500163] [090/131] (516s left) kms_cursor_legacy (modeset-atomic-cursor-hotspot)
[517.621307] Starting subtest: modeset-atomic-cursor-hotspot
[517.622984] Subtest modeset-atomic-cursor-hotspot: SKIP (0.000s)
[517.783505] [091/131] (516s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-pwrite)
[517.884977] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-pwrite
[522.742797] Subtest fbc-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (4.859s)
[523.963279] [092/131] (510s left) core_getstats (basic)
[524.019739] Starting subtest: basic
[524.020707] Subtest basic: SUCCESS (0.000s)
[524.138738] [093/131] (510s left) kms_cursor_crc (cursor-random-max-size)
[524.427125] Starting subtest: cursor-random-max-size
[524.429582] Subtest cursor-random-max-size: SKIP (0.000s)
[524.583235] [094/131] (509s left) kms_async_flips (basic-modeset-with-all-modifiers-formats)
[524.673852] Starting subtest: basic-modeset-with-all-modifiers-formats
[525.045000] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB8888
[525.820217] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB8888: SUCCESS (0.775s)
[525.828454] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB2101010
[525.842017] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB2101010: SUCCESS (0.021s)
[525.849776] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB16161616F
[525.864295] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB16161616F: SUCCESS (0.022s)
[525.872260] Starting dynamic subtest: pipe-A-eDP-1-4-RGB565
[526.008725] Dynamic subtest pipe-A-eDP-1-4-RGB565: SUCCESS (0.144s)
[526.017014] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB8888
[526.031177] Dynamic subtest pipe-A-eDP-1-4-XRGB8888: SUCCESS (0.022s)
[526.039095] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB2101010
[526.053286] Dynamic subtest pipe-A-eDP-1-4-XRGB2101010: SUCCESS (0.021s)
[526.061363] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB16161616F
[526.075451] Dynamic subtest pipe-A-eDP-1-4-XRGB16161616F: SUCCESS (0.021s)
[526.084418] Starting dynamic subtest: pipe-A-eDP-1-4-YUYV
[526.097732] Dynamic subtest pipe-A-eDP-1-4-YUYV: SUCCESS (0.021s)
[526.105552] Starting dynamic subtest: pipe-A-eDP-1-4-Y210
[526.120007] Dynamic subtest pipe-A-eDP-1-4-Y210: SUCCESS (0.021s)
[526.127815] Starting dynamic subtest: pipe-A-eDP-1-4-XYUV8888
[526.142185] Dynamic subtest pipe-A-eDP-1-4-XYUV8888: SUCCESS (0.021s)
[526.149729] Starting dynamic subtest: pipe-A-eDP-1-4-XV30
[526.164399] Dynamic subtest pipe-A-eDP-1-4-XV30: SUCCESS (0.021s)
[526.173296] Starting dynamic subtest: pipe-A-eDP-1-4-XV36
[526.186499] Dynamic subtest pipe-A-eDP-1-4-XV36: SUCCESS (0.021s)
[526.195497] Starting dynamic subtest: pipe-A-eDP-1-x-RGB565
[526.331111] Dynamic subtest pipe-A-eDP-1-x-RGB565: SUCCESS (0.144s)
[526.339943] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB8888
[526.353193] Dynamic subtest pipe-A-eDP-1-x-XRGB8888: SUCCESS (0.021s)
[526.361176] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB2101010
[526.375384] Dynamic subtest pipe-A-eDP-1-x-XRGB2101010: SUCCESS (0.021s)
[526.383077] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB16161616F
[526.397685] Dynamic subtest pipe-A-eDP-1-x-XRGB16161616F: SUCCESS (0.022s)
[526.405468] Starting dynamic subtest: pipe-A-eDP-1-x-YUYV
[526.419889] Dynamic subtest pipe-A-eDP-1-x-YUYV: SUCCESS (0.021s)
[526.427520] Starting dynamic subtest: pipe-A-eDP-1-x-Y210
[526.442048] Dynamic subtest pipe-A-eDP-1-x-Y210: SUCCESS (0.021s)
[526.449594] Starting dynamic subtest: pipe-A-eDP-1-x-XYUV8888
[526.464258] Dynamic subtest pipe-A-eDP-1-x-XYUV8888: SUCCESS (0.022s)
[526.472084] Starting dynamic subtest: pipe-A-eDP-1-x-XV30
[526.486557] Dynamic subtest pipe-A-eDP-1-x-XV30: SUCCESS (0.022s)
[526.494372] Starting dynamic subtest: pipe-A-eDP-1-x-XV36
[526.508763] Dynamic subtest pipe-A-eDP-1-x-XV36: SUCCESS (0.022s)
[526.517685] Starting dynamic subtest: pipe-A-eDP-1-linear-RGB565
[526.664915] Dynamic subtest pipe-A-eDP-1-linear-RGB565: SUCCESS (0.155s)
[526.675765] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB8888
[526.687072] Dynamic subtest pipe-A-eDP-1-linear-XRGB8888: SUCCESS (0.020s)
[526.697100] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB2101010
[526.709153] Dynamic subtest pipe-A-eDP-1-linear-XRGB2101010: SUCCESS (0.021s)
[526.717087] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB16161616F
[526.731296] Dynamic subtest pipe-A-eDP-1-linear-XRGB16161616F: SUCCESS (0.021s)
[526.739263] Starting dynamic subtest: pipe-A-eDP-1-linear-YUYV
[526.753569] Dynamic subtest pipe-A-eDP-1-linear-YUYV: SUCCESS (0.022s)
[526.761358] Starting dynamic subtest: pipe-A-eDP-1-linear-Y210
[526.775812] Dynamic subtest pipe-A-eDP-1-linear-Y210: SUCCESS (0.021s)
[526.784019] Starting dynamic subtest: pipe-A-eDP-1-linear-XYUV8888
[526.798189] Dynamic subtest pipe-A-eDP-1-linear-XYUV8888: SUCCESS (0.022s)
[526.808473] Starting dynamic subtest: pipe-A-eDP-1-linear-XV30
[526.820289] Dynamic subtest pipe-A-eDP-1-linear-XV30: SUCCESS (0.022s)
[526.828121] Starting dynamic subtest: pipe-A-eDP-1-linear-XV36
[526.842559] Dynamic subtest pipe-A-eDP-1-linear-XV36: SUCCESS (0.021s)
[527.223417] Subtest basic-modeset-with-all-modifiers-formats: SUCCESS (2.550s)
[528.018827] [095/131] (506s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-blt)
[528.113028] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-blt
[534.964902] Subtest psr-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (6.849s)
[535.119206] [096/131] (499s left) kms_pm_rpm (dpms-lpsp)
[537.052806] Starting subtest: dpms-lpsp
[537.371776] Subtest dpms-lpsp: SUCCESS (0.322s)
[537.487795] [097/131] (496s left) gem_exec_whisper (basic-contexts-forked)
[537.550829] Starting subtest: basic-contexts-forked
[560.255390] Subtest basic-contexts-forked: SUCCESS (22.699s)
[560.495075] [098/131] (473s left) kms_psr (fbc-pr-sprite-plane-move)
[560.586429] Starting subtest: fbc-pr-sprite-plane-move
[560.588183] Subtest fbc-pr-sprite-plane-move: SKIP (0.000s)
[560.680549] [099/131] (473s left) i915_drm_fdinfo (busy-hang)
[560.721218] Starting subtest: busy-hang
[560.722731] Starting dynamic subtest: rcs0
[560.763731] Dynamic subtest rcs0: SKIP (0.042s)
[560.773848] Starting dynamic subtest: bcs0
[560.775637] Dynamic subtest bcs0: SKIP (0.001s)
[560.783482] Starting dynamic subtest: vcs0
[560.785250] Dynamic subtest vcs0: SKIP (0.000s)
[560.793236] Starting dynamic subtest: vcs1
[560.795661] Dynamic subtest vcs1: SKIP (0.000s)
[560.803777] Starting dynamic subtest: vecs0
[560.805633] Dynamic subtest vecs0: SKIP (0.000s)
[560.813511] Starting dynamic subtest: ccs0
[560.815225] Dynamic subtest ccs0: SKIP (0.000s)
[560.817131] Subtest busy-hang: SKIP (0.049s)
[560.857757] [100/131] (473s left) prime_self_import (basic-with_one_bo_two_files)
[560.886897] Starting subtest: basic-with_one_bo_two_files
[560.909520] Subtest basic-with_one_bo_two_files: SUCCESS (0.023s)
[561.048715] [101/131] (473s left) kms_ccs (bad-rotation-90-4-tiled-lnl-ccs)
[561.143737] Starting subtest: bad-rotation-90-4-tiled-lnl-ccs
[561.145437] Subtest bad-rotation-90-4-tiled-lnl-ccs: SKIP (0.000s)
[562.271068] [102/131] (472s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs-cc)
[562.354704] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs-cc
[562.355799] Starting dynamic subtest: pipe-A-eDP-1
[562.363932] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[562.372626] Starting dynamic subtest: pipe-B-eDP-1
[562.380453] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[562.388933] Starting dynamic subtest: pipe-C-eDP-1
[562.396605] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[562.404776] Starting dynamic subtest: pipe-D-eDP-1
[562.412382] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[562.413191] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.008s)
[564.557664] [103/131] (470s left) kms_cursor_crc (cursor-sliding-128x128)
[564.744375] Starting subtest: cursor-sliding-128x128
[564.748770] Starting dynamic subtest: pipe-A-eDP-1
[567.943779] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.194s)
[567.970926] Starting dynamic subtest: pipe-D-eDP-1
[571.799001] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.833s)
[571.799959] Subtest cursor-sliding-128x128: SUCCESS (7.052s)
[572.617176] [104/131] (462s left) kms_addfb_basic (invalid-get-prop)
[572.676096] Starting subtest: invalid-get-prop
[572.677050] Subtest invalid-get-prop: SUCCESS (0.000s)
[572.848299] [105/131] (461s left) gem_readwrite (read-write)
[572.904616] Subtest read-write: SKIP (0.000s)
[572.975109] [106/131] (461s left) gem_eio (create)
[573.194586] Starting subtest: create
[573.529140] Subtest create: SUCCESS (0.333s)
[573.712644] [107/131] (461s left) gem_exercise_blt (fast-copy-emit)
[573.767322] Starting subtest: fast-copy-emit
[573.768361] Starting dynamic subtest: linear-smem-smem-emit
[573.788801] Dynamic subtest linear-smem-smem-emit: SUCCESS (0.021s)
[573.798947] Starting dynamic subtest: xmajor-smem-smem-emit
[573.805921] Dynamic subtest xmajor-smem-smem-emit: SUCCESS (0.016s)
[573.814009] Starting dynamic subtest: tile4-smem-smem-emit
[573.823772] Dynamic subtest tile4-smem-smem-emit: SUCCESS (0.017s)
[573.831846] Starting dynamic subtest: tile64-smem-smem-emit
[573.840528] Dynamic subtest tile64-smem-smem-emit: SUCCESS (0.016s)
[573.841382] Subtest fast-copy-emit: SUCCESS (0.074s)
[573.987319] [108/131] (460s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[574.074746] Starting subtest: plane-upscale-20x20-with-rotation
[574.075733] Starting dynamic subtest: pipe-A
[574.300591] Dynamic subtest pipe-A: SUCCESS (0.227s)
[574.310206] Starting dynamic subtest: pipe-B
[575.580374] Dynamic subtest pipe-B: SUCCESS (1.278s)
[575.588688] Starting dynamic subtest: pipe-C
[576.920643] Dynamic subtest pipe-C: SUCCESS (1.339s)
[576.935613] Starting dynamic subtest: pipe-D
[578.255872] Dynamic subtest pipe-D: SUCCESS (1.334s)
[578.256759] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.182s)
[579.465037] [109/131] (455s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[579.531509] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[579.532404] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[579.662410] [110/131] (455s left) gem_exec_schedule (implicit-boths)
[579.731300] Starting subtest: implicit-boths
[579.732369] Starting dynamic subtest: rcs0
[579.837048] Dynamic subtest rcs0: SUCCESS (0.106s)
[579.848406] Starting dynamic subtest: vcs0
[579.920359] Dynamic subtest vcs0: SUCCESS (0.082s)
[579.931325] Starting dynamic subtest: vcs1
[580.002312] Dynamic subtest vcs1: SUCCESS (0.081s)
[580.013812] Starting dynamic subtest: vecs0
[580.080653] Dynamic subtest vecs0: SUCCESS (0.077s)
[580.091148] Starting dynamic subtest: ccs0
[580.170374] Dynamic subtest ccs0: SUCCESS (0.088s)
[580.172324] Subtest implicit-boths: SUCCESS (0.440s)
[581.016409] [111/131] (453s left) kms_psr (psr2-cursor-plane-onoff)
[581.107722] Starting subtest: psr2-cursor-plane-onoff
[581.108608] Starting dynamic subtest: eDP-1
[582.825834] Dynamic subtest eDP-1: SUCCESS (1.717s)
[582.826693] Subtest psr2-cursor-plane-onoff: SUCCESS (1.718s)
[583.639687] [112/131] (451s left) prime_vgem (wait)
[583.707618] Starting subtest: wait
[583.708537] Starting dynamic subtest: rcs0
[583.799091] Dynamic subtest rcs0: SUCCESS (0.090s)
[583.809030] Starting dynamic subtest: bcs0
[583.890390] Dynamic subtest bcs0: SUCCESS (0.091s)
[583.898865] Starting dynamic subtest: vcs0
[583.932821] Dynamic subtest vcs0: SUCCESS (0.042s)
[583.941404] Starting dynamic subtest: vcs1
[583.977860] Dynamic subtest vcs1: SUCCESS (0.044s)
[583.986418] Starting dynamic subtest: vecs0
[584.023220] Dynamic subtest vecs0: SUCCESS (0.044s)
[584.031949] Starting dynamic subtest: ccs0
[584.069432] Dynamic subtest ccs0: SUCCESS (0.045s)
[584.070335] Subtest wait: SUCCESS (0.362s)
[584.227596] [113/131] (450s left) kms_dp_linktrain_fallback (dsc-fallback)
[584.315717] Starting subtest: dsc-fallback
[584.318444] Subtest dsc-fallback: SKIP (0.000s)
[584.405939] [114/131] (450s left) gem_exec_reloc (basic-cpu-gtt-noreloc)
[584.462282] Subtest basic-cpu-gtt-noreloc: SKIP (0.000s)
[584.546771] [115/131] (450s left) gem_create (create-clear)
[584.594479] Starting subtest: create-clear
[584.595798] Starting dynamic subtest: smem0
[617.356185] Dynamic subtest smem0: SUCCESS (32.752s)
[617.357202] Subtest create-clear: SUCCESS (32.753s)
[617.568040] [116/131] (417s left) kms_frontbuffer_tracking (fbc-suspend)
[617.674071] Starting subtest: fbc-suspend
[656.057486] Subtest fbc-suspend: SUCCESS (8.210s)
[660.276604] [117/131] (377s left) kms_cursor_legacy (cursorb-vs-flipa-toggle)
[660.394224] Starting subtest: cursorB-vs-flipA-toggle
[660.395978] Subtest cursorB-vs-flipA-toggle: SKIP (0.001s)
[660.557633] [118/131] (377s left) kms_color (legacy-gamma-reset)
[660.646980] Starting subtest: legacy-gamma-reset
[660.647923] Starting dynamic subtest: pipe-A-eDP-1
[661.039619] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.382s)
[661.048647] Starting dynamic subtest: pipe-B-eDP-1
[661.052192] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.011s)
[661.061121] Starting dynamic subtest: pipe-C-eDP-1
[661.065456] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.012s)
[661.076766] Starting dynamic subtest: pipe-D-eDP-1
[661.079428] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.012s)
[661.080342] Subtest legacy-gamma-reset: SUCCESS (0.421s)
[661.908679] [119/131] (376s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-blt)
[662.003424] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-blt
[662.005106] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[662.127768] [120/131] (376s left) gem_ctx_persistence (legacy-engines-mixed)
[662.187193] Starting subtest: legacy-engines-mixed
[662.188240] Starting dynamic subtest: render
[662.297050] Dynamic subtest render: SUCCESS (0.106s)
[662.311512] Starting dynamic subtest: bsd1
[662.364708] Dynamic subtest bsd1: SUCCESS (0.063s)
[662.377258] Starting dynamic subtest: bsd2
[662.448185] Dynamic subtest bsd2: SUCCESS (0.078s)
[662.461327] Starting dynamic subtest: blt
[662.524095] Dynamic subtest blt: SUCCESS (0.071s)
[662.536875] Starting dynamic subtest: vebox
[662.587752] Dynamic subtest vebox: SUCCESS (0.060s)
[662.589181] Subtest legacy-engines-mixed: SUCCESS (0.391s)
[662.688918] [121/131] (375s left) kms_plane_multiple (tiling-none)
[662.782601] Starting subtest: tiling-none
[662.783462] Starting dynamic subtest: pipe-A-eDP-1
[666.496748] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.643s)
[666.506563] Starting dynamic subtest: pipe-B-eDP-1
[670.859935] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.312s)
[670.868945] Starting dynamic subtest: pipe-C-eDP-1
[675.199250] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.309s)
[675.208255] Starting dynamic subtest: pipe-D-eDP-1
[679.548735] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.332s)
[679.549647] Subtest tiling-none: SUCCESS (16.601s)
[680.384056] [122/131] (357s left) kms_flip (2x-flip-vs-suspend-interruptible)
[680.479069] Starting subtest: 2x-flip-vs-suspend-interruptible
[680.490310] Subtest 2x-flip-vs-suspend-interruptible: SKIP (0.010s)
[680.586316] [123/131] (357s left) i915_pm_rps (thresholds-idle)
[680.643446] Starting subtest: thresholds-idle
[680.645260] Subtest thresholds-idle: SKIP (0.001s)
[680.788510] [124/131] (357s left) kms_rotation_crc (multiplane-rotation-cropping-bottom)
[680.874832] Starting subtest: multiplane-rotation-cropping-bottom
[698.228637] Subtest multiplane-rotation-cropping-bottom: SUCCESS (17.338s)
[698.388239] [125/131] (339s left) kms_big_fb (linear-64bpp-rotate-90)
[698.490372] Starting subtest: linear-64bpp-rotate-90
[698.511371] Subtest linear-64bpp-rotate-90: SKIP (0.020s)
[698.666441] [126/131] (339s left) kms_lease (lease-unleased-crtc)
[698.760617] Starting subtest: lease-unleased-crtc
[698.761562] Starting dynamic subtest: pipe-A-eDP-1
[699.047454] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.286s)
[699.063833] Starting dynamic subtest: pipe-B-eDP-1
[699.834410] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.784s)
[699.845399] Starting dynamic subtest: pipe-C-eDP-1
[699.846349] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.004s)
[699.854825] Starting dynamic subtest: pipe-D-eDP-1
[699.855748] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.004s)
[699.856613] Subtest lease-unleased-crtc: SUCCESS (1.086s)
[700.227418] [127/131] (338s left) kms_flip (flip-vs-panning-interruptible)
[700.315173] Starting subtest: flip-vs-panning-interruptible
[700.316453] Starting dynamic subtest: A-eDP1
[709.029036] Dynamic subtest A-eDP1: SUCCESS (8.710s)
[709.039468] Starting dynamic subtest: B-eDP1
[717.761670] Dynamic subtest B-eDP1: SUCCESS (8.728s)
[717.772887] Starting dynamic subtest: C-eDP1
[726.490244] Dynamic subtest C-eDP1: SUCCESS (8.722s)
[726.507578] Starting dynamic subtest: D-eDP1
[735.229008] Dynamic subtest D-eDP1: SUCCESS (8.732s)
[735.232285] Subtest flip-vs-panning-interruptible: SUCCESS (34.906s)
[736.416394] [128/131] (302s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[736.517292] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[737.165657] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.648s)
[737.378313] [129/131] (301s left) api_intel_allocator (open-vm)
[737.431060] Starting subtest: open-vm
[737.432681] Subtest open-vm: SUCCESS (0.003s)
[737.581648] [130/131] (300s left) kms_pipe_crc_basic (hang-read-crc)
[737.668451] Starting subtest: hang-read-crc
[737.669330] Starting dynamic subtest: pipe-A-eDP-1
[739.766238] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.096s)
[739.775000] Starting dynamic subtest: pipe-B-eDP-1
[742.429630] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.660s)
[742.438277] Starting dynamic subtest: pipe-C-eDP-1
[745.084842] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.654s)
[745.095063] Starting dynamic subtest: pipe-D-eDP-1
[747.729807] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.642s)
[747.730691] Subtest hang-read-crc: SUCCESS (10.058s)
[748.588715] [131/131] (289s left) syncobj_timeline (wait-any-interrupted)
[748.651428] Starting subtest: wait-any-interrupted
[748.754391] Subtest wait-any-interrupted: SUCCESS (0.102s)
[748.846507] Closing watchdogs
results: parsing output: 0/ for test: kms_atomic_transition
results: parsing output: 1/ for test: syncobj_timeline
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: gen9_exec_parse
results: parsing output: 4/ for test: syncobj_wait
results: parsing output: 5/ for test: kms_psr
results: parsing output: 6/ for test: syncobj_timeline
results: parsing output: 7/ for test: kms_ccs
results: parsing output: 8/ for test: syncobj_wait
results: parsing output: 9/ for test: kms_flip_scaled_crc
results: parsing output: 10/ for test: gem_fenced_exec_thrash
results: parsing output: 11/ for test: perf
results: parsing output: 12/ for test: gem_exec_reloc
results: parsing output: 13/ for test: kms_chamelium_hpd
results: parsing output: 14/ for test: kms_addfb_basic
results: parsing output: 15/ for test: gem_render_copy
results: parsing output: 16/ for test: kms_psr2_sf
results: parsing output: 17/ for test: gem_exec_schedule
results: parsing output: 18/ for test: gem_mmap_gtt
results: parsing output: 19/ for test: kms_addfb_basic
results: parsing output: 20/ for test: kms_cursor_crc
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: gem_exec_gttfill
results: parsing output: 23/ for test: gem_mmap_wc
results: parsing output: 24/ for test: kms_ccs
results: parsing output: 25/ for test: kms_pipe_b_c_ivb
results: parsing output: 26/ for test: kms_big_fb
results: parsing output: 27/ for test: syncobj_timeline
results: parsing output: 28/ for test: perf_pmu
results: parsing output: 29/ for test: gem_exec_async
results: parsing output: 30/ for test: gem_eio
results: parsing output: 31/ for test: kms_ccs
results: parsing output: 32/ for test: kms_psr
results: parsing output: 33/ for test: kms_big_fb
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: kms_hdr
results: parsing output: 36/ for test: gem_spin_batch
results: parsing output: 37/ for test: gem_ccs
results: parsing output: 38/ for test: syncobj_eventfd
results: parsing output: 39/ for test: gem_exec_balancer
results: parsing output: 40/ for test: syncobj_wait
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_flip
results: parsing output: 43/ for test: kms_vblank
results: parsing output: 44/ for test: gem_lmem_swapping
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: gem_render_copy
results: parsing output: 47/ for test: kms_chamelium_frames
results: parsing output: 48/ for test: kms_chamelium_edid
results: parsing output: 49/ for test: kms_big_fb
results: parsing output: 50/ for test: gem_workarounds
results: parsing output: 51/ for test: perf
results: parsing output: 52/ for test: gem_exec_fence
results: parsing output: 53/ for test: gem_mmap_gtt
results: parsing output: 54/ for test: gem_exec_flush
results: parsing output: 55/ for test: gem_userptr_blits
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: gem_pxp
results: parsing output: 58/ for test: perf
results: parsing output: 59/ for test: kms_atomic
results: parsing output: 60/ for test: kms_prop_blob
results: parsing output: 61/ for test: kms_flip
results: parsing output: 62/ for test: kms_prop_blob
results: parsing output: 63/ for test: kms_vblank
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: kms_plane_scaling
results: parsing output: 66/ for test: i915_pm_rps
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: gem_mmap_gtt
results: parsing output: 69/ for test: gem_ctx_isolation
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: gem_exec_reloc
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_big_fb
results: parsing output: 75/ for test: sysfs_heartbeat_interval
results: parsing output: 76/ for test: perf_pmu
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: gem_exec_fence
results: parsing output: 80/ for test: i915_module_load
results: parsing output: 81/ for test: template
results: parsing output: 82/ for test: gem_userptr_blits
results: parsing output: 83/ for test: kms_flip
results: parsing output: 84/ for test: api_intel_bb
results: parsing output: 85/ for test: vgem_basic
results: parsing output: 86/ for test: kms_psr
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: kms_cursor_legacy
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: core_getstats
results: parsing output: 92/ for test: kms_cursor_crc
results: parsing output: 93/ for test: kms_async_flips
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_pm_rpm
results: parsing output: 96/ for test: gem_exec_whisper
results: parsing output: 97/ for test: kms_psr
results: parsing output: 98/ for test: i915_drm_fdinfo
results: parsing output: 99/ for test: prime_self_import
results: parsing output: 100/ for test: kms_ccs
results: parsing output: 101/ for test: kms_ccs
results: parsing output: 102/ for test: kms_cursor_crc
results: parsing output: 103/ for test: kms_addfb_basic
results: parsing output: 104/ for test: gem_readwrite
results: parsing output: 105/ for test: gem_eio
results: parsing output: 106/ for test: gem_exercise_blt
results: parsing output: 107/ for test: kms_plane_scaling
results: parsing output: 108/ for test: syncobj_wait
results: parsing output: 109/ for test: gem_exec_schedule
results: parsing output: 110/ for test: kms_psr
results: parsing output: 111/ for test: prime_vgem
results: parsing output: 112/ for test: kms_dp_linktrain_fallback
results: parsing output: 113/ for test: gem_exec_reloc
results: parsing output: 114/ for test: gem_create
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: kms_cursor_legacy
results: parsing output: 117/ for test: kms_color
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: gem_ctx_persistence
results: parsing output: 120/ for test: kms_plane_multiple
results: parsing output: 121/ for test: kms_flip
results: parsing output: 122/ for test: i915_pm_rps
results: parsing output: 123/ for test: kms_rotation_crc
results: parsing output: 124/ for test: kms_big_fb
results: parsing output: 125/ for test: kms_lease
results: parsing output: 126/ for test: kms_flip
results: parsing output: 127/ for test: kms_big_fb
results: parsing output: 128/ for test: api_intel_allocator
results: parsing output: 129/ for test: kms_pipe_crc_basic
results: parsing output: 130/ for test: syncobj_timeline
Done.