[59.066642] Initializing watchdogs
[59.066688]   /dev/watchdog0
[59.080798] [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]
[59.085438] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.087739] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.091338] [001/133] (960s left) kms_flip (flip-vs-panning-interruptible)
[59.222848] Starting subtest: flip-vs-panning-interruptible
[59.225139] Starting dynamic subtest: A-eDP1
[68.002781] Dynamic subtest A-eDP1: SUCCESS (8.736s)
[68.018584] Starting dynamic subtest: B-eDP1
[76.694488] Dynamic subtest B-eDP1: SUCCESS (8.677s)
[76.703560] Starting dynamic subtest: C-eDP1
[85.416768] Dynamic subtest C-eDP1: SUCCESS (8.714s)
[85.426296] Starting dynamic subtest: D-eDP1
[94.147369] Dynamic subtest D-eDP1: SUCCESS (8.724s)
[94.152062] Subtest flip-vs-panning-interruptible: SUCCESS (34.862s)
[95.632446] [002/133] (923s left) kms_cursor_crc (cursor-offscreen-256x256)
[95.857774] Starting subtest: cursor-offscreen-256x256
[95.873049] Starting dynamic subtest: pipe-A-eDP-1
[97.829599] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.955s)
[97.863275] Starting dynamic subtest: pipe-D-eDP-1
[100.466413] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.608s)
[100.468781] Subtest cursor-offscreen-256x256: SUCCESS (4.607s)
[101.298407] [003/133] (918s left) i915_hangman (engine-error-state-capture)
[101.385286] Starting subtest: engine-error-state-capture
[101.387591] Starting dynamic subtest: rcs0
[104.883386] Dynamic subtest rcs0: SUCCESS (3.496s)
[104.893948] Starting dynamic subtest: bcs0
[110.900365] Dynamic subtest bcs0: SUCCESS (6.013s)
[110.910750] Starting dynamic subtest: vcs0
[116.850342] Dynamic subtest vcs0: SUCCESS (5.947s)
[116.860316] Starting dynamic subtest: vcs1
[122.803727] Dynamic subtest vcs1: SUCCESS (5.950s)
[122.814667] Starting dynamic subtest: vecs0
[127.795425] Dynamic subtest vecs0: SUCCESS (4.989s)
[127.805865] Starting dynamic subtest: ccs0
[132.851420] Dynamic subtest ccs0: SUCCESS (5.053s)
[132.854213] Subtest engine-error-state-capture: SUCCESS (31.460s)
[132.944558] [004/133] (886s left) gem_userptr_blits (mmap-offset-banned)
[133.019760] Starting subtest: mmap-offset-banned
[133.022224] Starting dynamic subtest: wb
[133.024483] Dynamic subtest wb: SUCCESS (0.000s)
[133.034027] Starting dynamic subtest: wc
[133.036172] Dynamic subtest wc: SUCCESS (0.000s)
[133.043071] Starting dynamic subtest: uc
[133.045186] Dynamic subtest uc: SUCCESS (0.000s)
[133.047298] Subtest mmap-offset-banned: SUCCESS (0.002s)
[133.161945] [005/133] (886s left) kms_big_fb (linear-32bpp-rotate-180)
[133.273329] Starting subtest: linear-32bpp-rotate-180
[134.819146] Subtest linear-32bpp-rotate-180: SUCCESS (1.546s)
[134.940203] [006/133] (884s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc)
[135.030574] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc
[138.597340] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (3.569s)
[139.820763] [007/133] (880s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[139.923256] Starting subtest: psr-farfromfence-mmap-gtt
[139.927657] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[140.018052] [008/133] (879s left) kms_rotation_crc (primary-4-tiled-reflect-x-0)
[140.117076] Starting subtest: primary-4-tiled-reflect-x-0
[147.088669] Subtest primary-4-tiled-reflect-x-0: SUCCESS (6.973s)
[148.271823] [009/133] (871s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render)
[148.366222] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render
[148.370227] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[148.463821] [010/133] (871s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[148.855556] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[149.677568] [011/133] (870s left) kms_addfb_basic (unused-modifier)
[149.744626] Starting subtest: unused-modifier
[149.746974] Subtest unused-modifier: SUCCESS (0.000s)
[149.882310] [012/133] (870s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode)
[150.271233] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s)
[151.125898] [013/133] (868s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-fullscreen)
[151.222647] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-fullscreen
[151.227069] Subtest fbcpsr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[151.317979] [014/133] (868s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-sf)
[151.415961] Starting subtest: fbc-pr-cursor-plane-move-continuous-sf
[151.420071] Subtest fbc-pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[151.481756] [015/133] (868s left) kms_cursor_crc (cursor-random-128x128)
[151.687891] Starting subtest: cursor-random-128x128
[151.692804] Starting dynamic subtest: pipe-A-eDP-1
[155.029615] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.337s)
[155.058786] Starting dynamic subtest: pipe-D-eDP-1
[159.018116] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.966s)
[159.020396] Subtest cursor-random-128x128: SUCCESS (7.330s)
[159.909912] [016/133] (860s left) kms_psr (fbc-psr2-sprite-mmap-gtt)
[160.002809] Starting subtest: fbc-psr2-sprite-mmap-gtt
[160.005077] Starting dynamic subtest: eDP-1
[160.009243] Dynamic subtest eDP-1: SKIP (0.000s)
[160.013526] Subtest fbc-psr2-sprite-mmap-gtt: SKIP (0.001s)
[160.074429] [017/133] (860s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[160.167393] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[160.171579] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[160.263738] [018/133] (860s left) gem_exec_fence (syncobj-timeline-unused-fence)
[160.831904] Starting subtest: syncobj-timeline-unused-fence
[160.838129] Subtest syncobj-timeline-unused-fence: SUCCESS (0.007s)
[161.955296] [FACT gem_exec_fence (syncobj-timeline-unused-fence)] new: kernel.kmod_is_loaded.vgem: true
[161.959155] [019/133] (858s left) gem_pxp (create-protected-buffer)
[162.086728] Starting subtest: create-protected-buffer
[162.088969] Subtest create-protected-buffer: SUCCESS (0.000s)
[162.191458] [020/133] (858s left) syncobj_timeline (etime-single-wait-for-submit-unsubmitted)
[162.248626] Starting subtest: etime-single-wait-for-submit-unsubmitted
[162.353484] Subtest etime-single-wait-for-submit-unsubmitted: SUCCESS (0.105s)
[162.428902] [021/133] (857s left) kms_flip (nonblocking-read)
[162.522187] Starting subtest: nonblocking-read
[162.524377] Subtest nonblocking-read: SUCCESS (0.000s)
[162.620659] [022/133] (857s left) kms_big_fb (4-tiled-32bpp-rotate-180)
[162.718914] Starting subtest: 4-tiled-32bpp-rotate-180
[164.186215] Subtest 4-tiled-32bpp-rotate-180: SUCCESS (1.468s)
[164.320532] [023/133] (856s left) i915_query (engine-info)
[164.375711] Starting subtest: engine-info
[164.377767] Subtest engine-info: SUCCESS (0.004s)
[164.483206] [024/133] (856s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu)
[164.570265] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu
[168.583728] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (4.013s)
[169.694757] [025/133] (850s left) kms_psr (psr2-sprite-blt)
[169.795884] Starting subtest: psr2-sprite-blt
[169.798210] Starting dynamic subtest: eDP-1
[171.483196] Dynamic subtest eDP-1: SUCCESS (1.693s)
[171.485382] Subtest psr2-sprite-blt: SUCCESS (1.694s)
[172.350458] [026/133] (848s left) kms_big_fb (x-tiled-addfb-size-overflow)
[172.457779] Starting subtest: x-tiled-addfb-size-overflow
[172.460067] Subtest x-tiled-addfb-size-overflow: SUCCESS (0.000s)
[172.561479] [027/133] (848s left) gem_eio (in-flight-immediate)
[172.801923] Starting subtest: in-flight-immediate
[182.058053] Subtest in-flight-immediate: SUCCESS (9.256s)
[182.175189] [028/133] (838s left) kms_chamelium_audio (hdmi-audio-edid)
[182.560064] Subtest hdmi-audio-edid: SKIP (0.000s)
[183.355529] [029/133] (837s left) kms_vblank (query-forked-busy-hang)
[183.445898] Starting subtest: query-forked-busy-hang
[183.448193] Starting dynamic subtest: pipe-A-eDP-1
[185.322378] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.877s)
[185.335406] Starting dynamic subtest: pipe-D-eDP-1
[187.958238] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.632s)
[187.960712] Subtest query-forked-busy-hang: SUCCESS (4.515s)
[188.738847] [030/133] (832s left) gem_sync (basic-store-each)
[188.825891] Starting subtest: basic-store-each
[191.348190] Subtest basic-store-each: SUCCESS (2.533s)
[191.535117] [031/133] (829s left) gem_shrink (reclaim)
[191.594684] Starting subtest: reclaim
[194.099981] Subtest reclaim: SUCCESS (2.449s)
[194.166679] [032/133] (826s left) gem_exec_schedule (preempt-other)
[194.246330] Starting subtest: preempt-other
[194.248381] Starting dynamic subtest: rcs0
[194.370354] Dynamic subtest rcs0: SUCCESS (0.129s)
[194.381446] Starting dynamic subtest: bcs0
[194.490440] Dynamic subtest bcs0: SUCCESS (0.119s)
[194.502387] Starting dynamic subtest: vcs0
[194.608061] Dynamic subtest vcs0: SUCCESS (0.117s)
[194.621095] Starting dynamic subtest: vcs1
[194.722209] Dynamic subtest vcs1: SUCCESS (0.115s)
[194.736861] Starting dynamic subtest: vecs0
[194.838903] Dynamic subtest vecs0: SUCCESS (0.116s)
[194.850384] Starting dynamic subtest: ccs0
[194.959237] Dynamic subtest ccs0: SUCCESS (0.118s)
[194.961915] Subtest preempt-other: SUCCESS (0.719s)
[196.026265] [033/133] (824s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[196.126752] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[196.128994] Starting dynamic subtest: pipe-A-eDP-1
[196.137770] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[196.146601] Starting dynamic subtest: pipe-B-eDP-1
[196.155171] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[196.163484] Starting dynamic subtest: pipe-C-eDP-1
[196.171718] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[196.179398] Starting dynamic subtest: pipe-D-eDP-1
[196.187658] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[196.191801] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[198.309896] [034/133] (822s left) gem_lmem_swapping (heavy-verify-multi-ccs)
[198.351047] Subtest heavy-verify-multi-ccs: SKIP (0.000s)
[198.394788] [035/133] (822s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[198.508168] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[198.512441] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.001s)
[198.654930] [036/133] (822s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[198.766277] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc
[198.770277] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[198.860175] [037/133] (822s left) kms_selftest (drm_plane_helper)
[198.912638] Starting subtest: drm_plane_helper
[198.923053] Starting dynamic subtest: drm_test_check_plane_state
[199.026966] Dynamic subtest drm_test_check_plane_state: SUCCESS (0.103s)
[199.035436] Starting dynamic subtest: drm_test_check_invalid_plane_state
[199.113091] Dynamic subtest drm_test_check_invalid_plane_state: SUCCESS (0.086s)
[199.115428] Subtest drm_plane_helper: SUCCESS (0.201s)
[199.278203] [038/133] (821s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-upscaling)
[199.363532] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-upscaling
[199.366999] Subtest flip-32bpp-yftile-to-64bpp-yftile-upscaling: SKIP (0.000s)
[199.451062] [039/133] (821s left) kms_flip (plain-flip-fb-recreate-interruptible)
[199.553986] Starting subtest: plain-flip-fb-recreate-interruptible
[199.555968] Starting dynamic subtest: A-eDP1
[208.416168] Dynamic subtest A-eDP1: SUCCESS (8.861s)
[208.427822] Starting dynamic subtest: B-eDP1
[217.255121] Dynamic subtest B-eDP1: SUCCESS (8.835s)
[217.268153] Starting dynamic subtest: C-eDP1
[226.066208] Dynamic subtest C-eDP1: SUCCESS (8.807s)
[226.076718] Starting dynamic subtest: D-eDP1
[234.897113] Dynamic subtest D-eDP1: SUCCESS (8.828s)
[234.902041] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (35.347s)
[236.087372] [040/133] (785s left) gem_ctx_shared (create-shared-gtt)
[236.160808] Starting subtest: create-shared-gtt
[238.367112] Subtest create-shared-gtt: SUCCESS (2.151s)
[238.659332] [041/133] (782s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[238.768643] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[238.772907] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[238.867400] [042/133] (782s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[238.974072] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt
[238.978058] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[239.095869] [043/133] (782s left) gem_softpin (evict-active-interruptible)
[239.162983] Starting subtest: evict-active-interruptible
[239.169107] Subtest evict-active-interruptible: SUCCESS (0.006s)
[239.300416] [044/133] (782s left) gem_mmap_wc (close)
[239.352052] Subtest close: SKIP (0.000s)
[239.422099] [045/133] (781s left) gem_exec_capture (capture-recoverable)
[239.472442] Starting subtest: capture-recoverable
[239.474757] Subtest capture-recoverable: SUCCESS (0.002s)
[239.575138] [046/133] (781s left) perf (rc6-disable)
[239.693722] Starting subtest: rc6-disable
[239.870876] Subtest rc6-disable: SUCCESS (0.178s)
[239.920959] [047/133] (781s left) kms_invalid_mode (bad-hsync-end)
[240.026097] Starting subtest: bad-hsync-end
[240.028056] Starting dynamic subtest: pipe-A-eDP-1
[240.311731] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[240.320227] Starting dynamic subtest: pipe-B-eDP-1
[240.322434] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[240.330447] Starting dynamic subtest: pipe-C-eDP-1
[240.332724] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[240.340854] Starting dynamic subtest: pipe-D-eDP-1
[240.342837] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[240.344822] Subtest bad-hsync-end: SUCCESS (0.291s)
[241.109660] [048/133] (780s left) kms_big_fb (x-tiled-16bpp-rotate-180)
[241.206028] Starting subtest: x-tiled-16bpp-rotate-180
[242.561456] Subtest x-tiled-16bpp-rotate-180: SUCCESS (1.357s)
[242.687285] [049/133] (778s left) gem_render_copy (yf-tiled-to-vebox-linear)
[242.737086] Starting subtest: yf-tiled-to-vebox-linear
[242.740803] Subtest yf-tiled-to-vebox-linear: SKIP (0.000s)
[242.922719] [050/133] (778s left) kms_dsc (dsc-basic)
[243.019344] Starting subtest: dsc-basic
[243.032309] Subtest dsc-basic: SKIP (0.000s)
[243.103345] [051/133] (778s left) vgem_basic (dmabuf-fence)
[243.154698] Starting subtest: dmabuf-fence
[243.156624] Subtest dmabuf-fence: SUCCESS (0.000s)
[243.218758] [052/133] (778s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[243.304607] Starting subtest: bo-too-small-due-to-tiling
[243.308765] Subtest bo-too-small-due-to-tiling: SKIP (0.000s)
[243.393912] [053/133] (778s left) syncobj_timeline (multi-wait-submitted-signaled)
[243.454286] Starting subtest: multi-wait-submitted-signaled
[243.456611] Subtest multi-wait-submitted-signaled: SUCCESS (0.001s)
[243.552878] [054/133] (778s left) kms_cursor_crc (cursor-sliding-max-size)
[243.876207] Starting subtest: cursor-sliding-max-size
[243.881454] Subtest cursor-sliding-max-size: SKIP (0.000s)
[244.000654] [055/133] (777s left) kms_color (invalid-ctm-matrix-sizes)
[244.088479] Starting subtest: invalid-ctm-matrix-sizes
[244.090454] Starting dynamic subtest: pipe-A
[244.092272] Dynamic subtest pipe-A: SUCCESS (0.002s)
[244.104511] Starting dynamic subtest: pipe-B
[244.106495] Dynamic subtest pipe-B: SUCCESS (0.003s)
[244.116812] Starting dynamic subtest: pipe-C
[244.119204] Dynamic subtest pipe-C: SUCCESS (0.006s)
[244.126361] Starting dynamic subtest: pipe-D
[244.128048] Dynamic subtest pipe-D: SUCCESS (0.004s)
[244.130104] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.017s)
[244.179086] [056/133] (777s left) kms_cursor_legacy (cursora-vs-flipa-varying-size)
[244.288803] Starting subtest: cursorA-vs-flipA-varying-size
[255.452473] Subtest cursorA-vs-flipA-varying-size: SUCCESS (11.164s)
[256.247204] [057/133] (765s left) gem_render_copy (mixed-tiled-to-y-tiled-ccs)
[256.322890] Starting subtest: mixed-tiled-to-y-tiled-ccs
[256.327685] Subtest mixed-tiled-to-y-tiled-ccs: SKIP (0.000s)
[256.508828] [058/133] (765s left) kms_atomic (test-only)
[256.596197] Starting subtest: test-only
[256.646669] Starting dynamic subtest: pipe-A-eDP-1
[259.131584] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.484s)
[259.133490] Subtest test-only: SUCCESS (2.535s)
[259.929076] [059/133] (762s left) gem_exec_flush (basic-wb-ro-before-default)
[259.992810] Starting subtest: basic-wb-ro-before-default
[265.476929] Subtest basic-wb-ro-before-default: SUCCESS (5.456s)
[265.639415] [060/133] (756s left) syncobj_timeline (invalid-transfer-bad-pad)
[265.700617] Starting subtest: invalid-transfer-bad-pad
[265.702988] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s)
[265.808315] [061/133] (756s left) device_reset (cold-reset-bound)
[265.860347] Starting subtest: cold-reset-bound
[265.865045] Subtest cold-reset-bound: SKIP (0.000s)
[265.934666] [062/133] (756s left) gem_exec_fence (syncobj-channel)
[266.390070] Starting subtest: syncobj-channel
[267.413457] Subtest syncobj-channel: SUCCESS (1.020s)
[268.012115] [063/133] (754s left) prime_mmap (test_correct_cpu_write)
[268.069222] Starting subtest: test_correct_cpu_write
[268.071482] Starting dynamic subtest: test_correct_cpu_write-smem
[268.073653] Dynamic subtest test_correct_cpu_write-smem: SUCCESS (0.000s)
[268.075802] Subtest test_correct_cpu_write: SUCCESS (0.001s)
[268.181439] [064/133] (754s left) gem_create (create-size-update)
[268.230994] Starting subtest: create-size-update
[268.233209] Subtest create-size-update: SUCCESS (0.000s)
[268.458636] [065/133] (753s left) kms_psr (fbc-pr-sprite-plane-onoff)
[268.548929] Starting subtest: fbc-pr-sprite-plane-onoff
[268.553186] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s)
[268.621079] [066/133] (753s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[268.720524] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[268.725054] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[268.816940] [067/133] (753s left) prime_vgem (coherency-blt)
[268.893913] Starting subtest: coherency-blt
[270.012316] Subtest coherency-blt: SUCCESS (1.117s)
[270.133355] [068/133] (752s left) gem_mmap_offset (bad-flags)
[270.192101] Starting subtest: bad-flags
[270.194304] Subtest bad-flags: SUCCESS (0.000s)
[270.303211] [069/133] (752s left) gem_busy (semaphore)
[270.487322] Subtest semaphore: SKIP (0.000s)
[270.710177] [070/133] (751s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-onoff)
[270.811452] Starting subtest: psr-2p-scndscrn-spr-indfb-onoff
[270.815796] Subtest psr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[270.905883] [071/133] (751s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-sf)
[271.006625] Starting subtest: pr-cursor-plane-move-continuous-exceed-sf
[271.010975] Subtest pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[271.073656] [072/133] (751s left) kms_content_protection (content-type-change)
[271.213107] Starting subtest: content-type-change
[271.217631] Subtest content-type-change: SKIP (0.000s)
[271.326201] [073/133] (751s left) kms_legacy_colorkey (basic)
[271.417253] Starting subtest: basic
[271.419152] Starting dynamic subtest: pipe-A
[271.460280] Dynamic subtest pipe-A: SUCCESS (0.045s)
[271.471683] Starting dynamic subtest: pipe-B
[271.473941] Dynamic subtest pipe-B: SUCCESS (0.001s)
[271.481895] Starting dynamic subtest: pipe-C
[271.484234] Dynamic subtest pipe-C: SUCCESS (0.000s)
[271.492031] Starting dynamic subtest: pipe-D
[271.493929] Dynamic subtest pipe-D: SUCCESS (0.000s)
[271.495849] Subtest basic: SUCCESS (0.051s)
[271.532828] [074/133] (751s left) kms_cursor_legacy (long-nonblocking-modeset-vs-cursor-atomic)
[271.651392] Starting subtest: long-nonblocking-modeset-vs-cursor-atomic
[289.443795] Subtest long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (17.792s)
[290.228467] [075/133] (732s left) api_intel_bb (blit-reloc-purge-cache)
[290.285064] Starting subtest: blit-reloc-purge-cache
[290.289514] Subtest blit-reloc-purge-cache: SKIP (0.001s)
[290.406403] [076/133] (732s left) vgem_basic (dmabuf-mmap)
[290.452674] Starting subtest: dmabuf-mmap
[290.471069] Subtest dmabuf-mmap: SUCCESS (0.021s)
[290.535264] [077/133] (732s left) kms_addfb_basic (basic-x-tiled-legacy)
[290.586027] Starting subtest: basic-x-tiled-legacy
[290.590261] Subtest basic-x-tiled-legacy: SKIP (0.000s)
[290.753649] [078/133] (732s left) kms_psr (fbc-pr-primary-blt)
[290.849672] Starting subtest: fbc-pr-primary-blt
[290.853941] Subtest fbc-pr-primary-blt: SKIP (0.000s)
[290.920752] [079/133] (731s left) syncobj_wait (multi-wait-submitted-signaled)
[290.976419] Starting subtest: multi-wait-submitted-signaled
[290.978367] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[291.070755] [080/133] (731s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping)
[291.152934] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping
[291.157601] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping: SKIP (0.000s)
[291.222904] [081/133] (731s left) gem_exec_store (dword)
[291.285276] Starting subtest: dword
[291.287104] Starting dynamic subtest: rcs0
[291.344756] Dynamic subtest rcs0: SUCCESS (0.059s)
[291.355401] Starting dynamic subtest: bcs0
[291.386116] Dynamic subtest bcs0: SUCCESS (0.040s)
[291.394922] Starting dynamic subtest: vcs0
[291.428452] Dynamic subtest vcs0: SUCCESS (0.040s)
[291.439274] Starting dynamic subtest: vcs1
[291.469725] Dynamic subtest vcs1: SUCCESS (0.040s)
[291.480513] Starting dynamic subtest: vecs0
[291.510782] Dynamic subtest vecs0: SUCCESS (0.039s)
[291.521882] Starting dynamic subtest: ccs0
[291.552939] Dynamic subtest ccs0: SUCCESS (0.040s)
[291.554929] Subtest dword: SUCCESS (0.269s)
[291.737636] [082/133] (731s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-gtt)
[291.830631] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-gtt
[291.834937] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[291.942912] [083/133] (731s left) kms_plane_cursor (primary)
[292.030071] Starting subtest: primary
[292.034061] Starting dynamic subtest: pipe-A-eDP-1-size-64
[294.582551] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.554s)
[294.606085] Starting dynamic subtest: pipe-A-eDP-1-size-128
[297.184975] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.583s)
[297.209125] Starting dynamic subtest: pipe-A-eDP-1-size-256
[299.817206] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.616s)
[300.134048] Starting dynamic subtest: pipe-B-eDP-1-size-64
[303.390630] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.266s)
[303.417095] Starting dynamic subtest: pipe-B-eDP-1-size-128
[305.958020] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.549s)
[305.982289] Starting dynamic subtest: pipe-B-eDP-1-size-256
[308.514396] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.538s)
[308.829522] Starting dynamic subtest: pipe-C-eDP-1-size-64
[311.766321] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.946s)
[311.792650] Starting dynamic subtest: pipe-C-eDP-1-size-128
[313.977109] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.192s)
[314.004467] Starting dynamic subtest: pipe-C-eDP-1-size-256
[316.222548] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.225s)
[316.539216] Starting dynamic subtest: pipe-D-eDP-1-size-64
[319.436221] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.908s)
[319.462217] Starting dynamic subtest: pipe-D-eDP-1-size-128
[321.669524] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.214s)
[321.695036] Starting dynamic subtest: pipe-D-eDP-1-size-256
[323.914295] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.225s)
[324.226820] Subtest primary: SUCCESS (32.198s)
[325.071859] [084/133] (697s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[325.168114] Starting subtest: read-crc-frame-sequence
[325.170335] Starting dynamic subtest: pipe-A-eDP-1
[325.884438] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.716s)
[325.893809] Starting dynamic subtest: pipe-B-eDP-1
[327.250106] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.366s)
[327.259659] Starting dynamic subtest: pipe-C-eDP-1
[328.627834] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.373s)
[328.637109] Starting dynamic subtest: pipe-D-eDP-1
[329.945675] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.319s)
[329.948034] Subtest read-crc-frame-sequence: SUCCESS (4.780s)
[330.784414] [085/133] (692s left) kms_flip (flip-vs-modeset-vs-hang)
[330.895631] Starting subtest: flip-vs-modeset-vs-hang
[330.897998] Starting dynamic subtest: A-eDP1
[382.391249] Dynamic subtest A-eDP1: SUCCESS (51.484s)
[382.401421] Starting dynamic subtest: D-eDP1
[432.376906] Dynamic subtest D-eDP1: SUCCESS (49.975s)
[432.379229] Subtest flip-vs-modeset-vs-hang: SUCCESS (101.466s)
[432.739209] [086/133] (590s left) gen7_exec_parse (bitmasks)
[432.805301] Subtest bitmasks: SKIP (0.000s)
[432.867541] [087/133] (590s left) perf (short-reads)
[433.002298] Starting subtest: short-reads
[433.012135] Subtest short-reads: SUCCESS (0.014s)
[433.061159] [088/133] (590s left) gem_softpin (noreloc)
[433.138056] Starting subtest: noreloc
[438.608198] Subtest noreloc: SUCCESS (5.417s)
[438.676107] [089/133] (584s left) i915_pm_rps (engine-order)
[438.750979] Starting subtest: engine-order
[443.823322] Subtest engine-order: SUCCESS (5.070s)
[443.954330] [090/133] (579s left) gem_exec_schedule (promotion)
[444.024222] Starting subtest: promotion
[444.026144] Starting dynamic subtest: rcs0
[444.205442] Dynamic subtest rcs0: SUCCESS (0.185s)
[444.217915] Starting dynamic subtest: vcs0
[444.325657] Dynamic subtest vcs0: SUCCESS (0.120s)
[444.338197] Starting dynamic subtest: vcs1
[444.456385] Dynamic subtest vcs1: SUCCESS (0.131s)
[444.471785] Starting dynamic subtest: vecs0
[444.587213] Dynamic subtest vecs0: SUCCESS (0.130s)
[444.599468] Starting dynamic subtest: ccs0
[444.733498] Dynamic subtest ccs0: SUCCESS (0.146s)
[444.736407] Subtest promotion: SUCCESS (0.715s)
[446.023568] [091/133] (577s left) gem_exec_balancer (hog)
[446.078394] Starting subtest: hog
[446.082802] Subtest hog: SKIP (0.000s)
[446.389305] [092/133] (576s left) syncobj_wait (multi-wait-for-submit-submitted-signaled)
[446.447591] Starting subtest: multi-wait-for-submit-submitted-signaled
[446.449864] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.001s)
[446.545063] [093/133] (576s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[446.641991] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-wc
[446.646080] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[446.730684] [094/133] (576s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[446.836265] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-cpu
[453.976070] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.143s)
[454.078125] [095/133] (569s left) sysfs_heartbeat_interval (mixed)
[454.134059] Starting subtest: mixed
[454.136430] Starting dynamic subtest: vecs0
[459.333955] Dynamic subtest vecs0: SUCCESS (5.199s)
[459.345183] Starting dynamic subtest: ccs0
[464.558586] Dynamic subtest ccs0: SUCCESS (5.222s)
[464.570028] Starting dynamic subtest: vcs0
[469.805291] Dynamic subtest vcs0: SUCCESS (5.244s)
[469.815803] Starting dynamic subtest: bcs0
[475.041107] Dynamic subtest bcs0: SUCCESS (5.233s)
[475.052360] Starting dynamic subtest: rcs0
[480.236658] Dynamic subtest rcs0: SUCCESS (5.193s)
[480.248182] Starting dynamic subtest: vcs1
[485.450385] Dynamic subtest vcs1: SUCCESS (5.212s)
[485.452823] Subtest mixed: SUCCESS (31.316s)
[485.537384] [096/133] (538s left) kms_plane_scaling (plane-downscale-factor-0-75-with-modifiers)
[485.635887] Starting subtest: plane-downscale-factor-0-75-with-modifiers
[485.638226] Starting dynamic subtest: pipe-A
[486.014802] Dynamic subtest pipe-A: SUCCESS (0.375s)
[486.030155] Starting dynamic subtest: pipe-B
[487.390709] Dynamic subtest pipe-B: SUCCESS (1.378s)
[487.400123] Starting dynamic subtest: pipe-C
[488.815146] Dynamic subtest pipe-C: SUCCESS (1.424s)
[488.823840] Starting dynamic subtest: pipe-D
[490.252044] Dynamic subtest pipe-D: SUCCESS (1.436s)
[490.254195] Subtest plane-downscale-factor-0-75-with-modifiers: SUCCESS (4.618s)
[491.423508] [097/133] (532s left) gem_ctx_shared (disjoint-timelines)
[491.496634] Starting subtest: disjoint-timelines
[491.525850] Subtest disjoint-timelines: SUCCESS (0.029s)
[491.766712] [098/133] (531s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-plflip-blt)
[491.871892] Starting subtest: fbc-1p-primscrn-indfb-plflip-blt
[496.432318] Subtest fbc-1p-primscrn-indfb-plflip-blt: SUCCESS (4.563s)
[497.643465] [099/133] (526s left) prime_mmap_coherency (write)
[497.693223] Starting subtest: write
[503.124038] Subtest write: SUCCESS (5.377s)
[503.212182] [100/133] (520s left) gem_ctx_persistence (engines-queued)
[503.266073] Starting subtest: engines-queued
[503.268234] Starting dynamic subtest: rcs0
[503.356695] Dynamic subtest rcs0: SUCCESS (0.089s)
[503.369065] Starting dynamic subtest: bcs0
[503.397480] Dynamic subtest bcs0: SUCCESS (0.040s)
[503.406734] Starting dynamic subtest: vcs0
[504.885110] Dynamic subtest vcs0: SUCCESS (1.485s)
[504.899012] Starting dynamic subtest: vcs1
[506.866620] Dynamic subtest vcs1: SUCCESS (1.977s)
[506.882798] Starting dynamic subtest: vecs0
[508.852245] Dynamic subtest vecs0: SUCCESS (1.982s)
[508.863865] Starting dynamic subtest: ccs0
[509.016667] Dynamic subtest ccs0: SUCCESS (0.163s)
[509.019181] Subtest engines-queued: SUCCESS (5.751s)
[509.155198] [101/133] (514s left) gem_media_fill (media-fill)
[509.210227] Subtest media-fill: SKIP (0.000s)
[509.329852] [102/133] (514s left) kms_ccs (crc-primary-basic-y-tiled-ccs)
[509.428745] Starting subtest: crc-primary-basic-y-tiled-ccs
[509.430992] Starting dynamic subtest: pipe-A-eDP-1
[509.453158] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[509.463033] Starting dynamic subtest: pipe-B-eDP-1
[509.483799] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[509.492516] Starting dynamic subtest: pipe-C-eDP-1
[509.513791] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[509.522280] Starting dynamic subtest: pipe-D-eDP-1
[509.543616] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[509.547904] Subtest crc-primary-basic-y-tiled-ccs: SKIP (0.006s)
[511.709881] [103/133] (512s left) kms_ccs (crc-sprite-planes-basic-yf-tiled-ccs)
[511.807516] Starting subtest: crc-sprite-planes-basic-yf-tiled-ccs
[511.809607] Starting dynamic subtest: pipe-A-eDP-1
[511.866056] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[511.878216] Starting dynamic subtest: pipe-B-eDP-1
[511.935188] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[511.945644] Starting dynamic subtest: pipe-C-eDP-1
[512.002790] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[512.012992] Starting dynamic subtest: pipe-D-eDP-1
[512.068963] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[512.073308] Subtest crc-sprite-planes-basic-yf-tiled-ccs: SKIP (0.009s)
[514.064661] [104/133] (509s left) syncobj_eventfd (invalid-bad-flags)
[514.125729] Starting subtest: invalid-bad-flags
[514.128113] Subtest invalid-bad-flags: SUCCESS (0.000s)
[514.235167] [105/133] (509s left) syncobj_timeline (signal)
[514.279272] Starting subtest: signal
[514.281565] Subtest signal: SUCCESS (0.000s)
[514.366445] [106/133] (509s left) i915_query (query-topology-known-pci-ids)
[514.422930] Starting subtest: query-topology-known-pci-ids
[514.427346] Subtest query-topology-known-pci-ids: SKIP (0.000s)
[514.507636] [107/133] (509s left) kms_psr (psr2-cursor-blt)
[514.598717] Starting subtest: psr2-cursor-blt
[514.600990] Starting dynamic subtest: eDP-1
[516.340276] Dynamic subtest eDP-1: SUCCESS (1.739s)
[516.342612] Subtest psr2-cursor-blt: SUCCESS (1.740s)
[517.132101] [108/133] (506s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs-cc)
[517.225200] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs-cc
[517.227535] Starting dynamic subtest: pipe-A-eDP-1
[517.376747] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.141s)
[517.390592] Starting dynamic subtest: pipe-B-eDP-1
[517.409905] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.009s)
[517.418828] Starting dynamic subtest: pipe-C-eDP-1
[517.437067] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.012s)
[517.445224] Starting dynamic subtest: pipe-D-eDP-1
[517.463617] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.011s)
[517.465495] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.178s)
[519.689123] [109/133] (504s left) gen9_exec_parse (shadow-peek)
[519.757518] Subtest shadow-peek: SKIP (0.000s)
[519.816767] [110/133] (504s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[519.905645] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[527.236772] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.333s)
[527.349452] [111/133] (496s left) kms_cursor_legacy (torture-move)
[527.464897] Starting subtest: torture-move
[527.467263] Starting dynamic subtest: pipe-A
[533.837068] Dynamic subtest pipe-A: SUCCESS (6.367s)
[533.852611] Starting dynamic subtest: pipe-B
[542.214334] Dynamic subtest pipe-B: SUCCESS (8.375s)
[542.225890] Starting dynamic subtest: pipe-C
[549.269429] Dynamic subtest pipe-C: SUCCESS (7.054s)
[549.285529] Starting dynamic subtest: pipe-D
[557.689610] Dynamic subtest pipe-D: SUCCESS (8.417s)
[557.702655] Starting dynamic subtest: all-pipes
[564.281812] Dynamic subtest all-pipes: SUCCESS (6.592s)
[564.284489] Subtest torture-move: SUCCESS (36.816s)
[564.462590] [112/133] (459s left) kms_vrr (flipline)
[564.564315] Starting subtest: flipline
[564.570670] Subtest flipline: SKIP (0.000s)
[564.642873] [113/133] (459s left) gem_eio (in-flight-10ms)
[564.866468] Starting subtest: in-flight-10ms
[573.747654] Subtest in-flight-10ms: SUCCESS (8.881s)
[573.871040] [114/133] (450s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-upscaling)
[573.959488] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-upscaling
[573.963690] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-upscaling: SKIP (0.000s)
[574.030304] [115/133] (450s left) kms_flip (2x-flip-vs-wf_vblank-interruptible)
[574.122772] Starting subtest: 2x-flip-vs-wf_vblank-interruptible
[574.135381] Subtest 2x-flip-vs-wf_vblank-interruptible: SKIP (0.011s)
[574.227023] [116/133] (450s left) kms_pm_rpm (system-suspend-modeset)
[576.062857] Starting subtest: system-suspend-modeset
[595.814427] Subtest system-suspend-modeset: SUCCESS (4.731s)
[596.210201] [117/133] (428s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render)
[596.323023] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render
[596.327197] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[596.432087] [118/133] (428s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[596.528036] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip
[596.532579] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[596.632538] [119/133] (427s left) gem_exec_reloc (basic-cpu-read-noreloc)
[596.694889] Subtest basic-cpu-read-noreloc: SKIP (0.000s)
[596.768912] [120/133] (427s left) api_intel_bb (offset-control)
[596.817644] Starting subtest: offset-control
[596.823340] Subtest offset-control: SUCCESS (0.007s)
[596.954453] [121/133] (427s left) kms_plane_scaling (planes-downscale-factor-0-5)
[597.047778] Starting subtest: planes-downscale-factor-0-5
[597.050144] Starting dynamic subtest: pipe-A
[597.072236] Dynamic subtest pipe-A: SKIP (0.019s)
[597.089335] Starting dynamic subtest: pipe-B
[597.107127] Dynamic subtest pipe-B: SKIP (0.034s)
[597.117173] Starting dynamic subtest: pipe-C
[597.142169] Dynamic subtest pipe-C: SKIP (0.035s)
[597.151541] Starting dynamic subtest: pipe-D
[597.176226] Dynamic subtest pipe-D: SKIP (0.033s)
[597.179751] Subtest planes-downscale-factor-0-5: SKIP (0.125s)
[597.272158] [122/133] (427s left) gem_readwrite (write-bad-handle)
[597.318494] Subtest write-bad-handle: SKIP (0.000s)
[597.380215] [123/133] (427s left) kms_pm_rpm (dpms-mode-unset-non-lpsp)
[599.013269] Starting subtest: dpms-mode-unset-non-lpsp
[600.192143] Subtest dpms-mode-unset-non-lpsp: SKIP (1.156s)
[600.591957] [124/133] (424s left) gem_exec_create (madvise)
[600.659962] Starting subtest: madvise
[600.662381] Starting dynamic subtest: smem
[620.916752] Dynamic subtest smem: SUCCESS (20.127s)
[620.919479] Subtest madvise: SUCCESS (20.128s)
[621.834727] [125/133] (403s left) gem_softpin (full)
[621.903836] Starting subtest: full
[621.915490] Subtest full: SUCCESS (0.012s)
[622.072545] [126/133] (402s left) syncobj_basic (bad-handle-to-fd)
[622.139278] Starting subtest: bad-handle-to-fd
[622.141547] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[622.249254] [127/133] (402s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[622.342373] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu
[622.346385] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[622.432458] [128/133] (402s left) kms_flip (flip-vs-expired-vblank)
[622.527357] Starting subtest: flip-vs-expired-vblank
[622.529246] Starting dynamic subtest: A-eDP1
[631.249192] Dynamic subtest A-eDP1: SUCCESS (8.685s)
[631.262269] Starting dynamic subtest: B-eDP1
[639.891177] Dynamic subtest B-eDP1: SUCCESS (8.636s)
[639.904271] Starting dynamic subtest: C-eDP1
[648.537776] Dynamic subtest C-eDP1: SUCCESS (8.628s)
[648.550004] Starting dynamic subtest: D-eDP1
[657.176537] Dynamic subtest D-eDP1: SUCCESS (8.633s)
[657.178816] Subtest flip-vs-expired-vblank: SUCCESS (34.596s)
[658.301123] [129/133] (366s left) gem_exec_parallel (fds)
[658.358421] Starting subtest: fds
[658.360777] Starting dynamic subtest: rcs0
[660.809306] Dynamic subtest rcs0: SUCCESS (2.449s)
[660.824428] Starting dynamic subtest: bcs0
[664.316667] Dynamic subtest bcs0: SUCCESS (3.501s)
[664.326962] Starting dynamic subtest: vcs0
[668.130051] Dynamic subtest vcs0: SUCCESS (3.809s)
[668.145446] Starting dynamic subtest: vcs1
[672.109984] Dynamic subtest vcs1: SUCCESS (3.975s)
[672.120138] Starting dynamic subtest: vecs0
[676.126294] Dynamic subtest vecs0: SUCCESS (4.012s)
[676.139264] Starting dynamic subtest: ccs0
[679.394676] Dynamic subtest ccs0: SUCCESS (3.264s)
[679.397758] Subtest fds: SUCCESS (21.026s)
[679.589003] [130/133] (345s left) kms_atomic_transition (plane-all-modeset-transition-internal-panels)
[679.689069] Starting subtest: plane-all-modeset-transition-internal-panels
[679.691228] Starting dynamic subtest: pipe-A-eDP-1
[680.568590] Dynamic subtest pipe-A-eDP-1: FAIL (0.300s)
[680.579876] Starting dynamic subtest: pipe-B-eDP-1
[681.059335] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.067s)
[681.344183] Subtest plane-all-modeset-transition-internal-panels: FAIL (1.655s)
[682.174293] [131/133] (342s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-render)
[682.272311] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-render
[689.215645] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-render: SUCCESS (6.942s)
[689.381265] [132/133] (335s left) kms_rotation_crc (primary-y-tiled-reflect-x-90)
[689.469184] Starting subtest: primary-y-tiled-reflect-x-90
[689.473542] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s)
[689.542084] [133/133] (335s left) perf_pmu (init-busy)
[689.587795] Starting subtest: init-busy
[689.590194] Starting dynamic subtest: rcs0
[689.592752] Dynamic subtest rcs0: SUCCESS (0.001s)
[689.603100] Starting dynamic subtest: bcs0
[689.605454] Dynamic subtest bcs0: SUCCESS (0.000s)
[689.614663] Starting dynamic subtest: vcs0
[689.616630] Dynamic subtest vcs0: SUCCESS (0.001s)
[689.626112] Starting dynamic subtest: vcs1
[689.628043] Dynamic subtest vcs1: SUCCESS (0.001s)
[689.636848] Starting dynamic subtest: vecs0
[689.639156] Dynamic subtest vecs0: SUCCESS (0.000s)
[689.648857] Starting dynamic subtest: ccs0
[689.651154] Dynamic subtest ccs0: SUCCESS (0.000s)
[689.653155] Subtest init-busy: SUCCESS (0.007s)
[689.695020] Closing watchdogs
results: parsing output: 0/ for test: kms_flip
results: parsing output: 1/ for test: kms_cursor_crc
results: parsing output: 2/ for test: i915_hangman
results: parsing output: 3/ for test: gem_userptr_blits
results: parsing output: 4/ for test: kms_big_fb
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: kms_rotation_crc
results: parsing output: 8/ for test: kms_frontbuffer_tracking
results: parsing output: 9/ for test: kms_chamelium_edid
results: parsing output: 10/ for test: kms_addfb_basic
results: parsing output: 11/ for test: kms_chamelium_hpd
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: kms_psr2_sf
results: parsing output: 14/ for test: kms_cursor_crc
results: parsing output: 15/ for test: kms_psr
results: parsing output: 16/ for test: kms_big_fb
results: parsing output: 17/ for test: gem_exec_fence
results: parsing output: 18/ for test: gem_pxp
results: parsing output: 19/ for test: syncobj_timeline
results: parsing output: 20/ for test: kms_flip
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: i915_query
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: kms_psr
results: parsing output: 25/ for test: kms_big_fb
results: parsing output: 26/ for test: gem_eio
results: parsing output: 27/ for test: kms_chamelium_audio
results: parsing output: 28/ for test: kms_vblank
results: parsing output: 29/ for test: gem_sync
results: parsing output: 30/ for test: gem_shrink
results: parsing output: 31/ for test: gem_exec_schedule
results: parsing output: 32/ for test: kms_ccs
results: parsing output: 33/ for test: gem_lmem_swapping
results: parsing output: 34/ for test: kms_cursor_legacy
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: kms_selftest
results: parsing output: 37/ for test: kms_flip_scaled_crc
results: parsing output: 38/ for test: kms_flip
results: parsing output: 39/ for test: gem_ctx_shared
results: parsing output: 40/ for test: kms_big_fb
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: gem_softpin
results: parsing output: 43/ for test: gem_mmap_wc
results: parsing output: 44/ for test: gem_exec_capture
results: parsing output: 45/ for test: perf
results: parsing output: 46/ for test: kms_invalid_mode
results: parsing output: 47/ for test: kms_big_fb
results: parsing output: 48/ for test: gem_render_copy
results: parsing output: 49/ for test: kms_dsc
results: parsing output: 50/ for test: vgem_basic
results: parsing output: 51/ for test: kms_addfb_basic
results: parsing output: 52/ for test: syncobj_timeline
results: parsing output: 53/ for test: kms_cursor_crc
results: parsing output: 54/ for test: kms_color
results: parsing output: 55/ for test: kms_cursor_legacy
results: parsing output: 56/ for test: gem_render_copy
results: parsing output: 57/ for test: kms_atomic
results: parsing output: 58/ for test: gem_exec_flush
results: parsing output: 59/ for test: syncobj_timeline
results: parsing output: 60/ for test: device_reset
results: parsing output: 61/ for test: gem_exec_fence
results: parsing output: 62/ for test: prime_mmap
results: parsing output: 63/ for test: gem_create
results: parsing output: 64/ for test: kms_psr
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: prime_vgem
results: parsing output: 67/ for test: gem_mmap_offset
results: parsing output: 68/ for test: gem_busy
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: kms_psr2_sf
results: parsing output: 71/ for test: kms_content_protection
results: parsing output: 72/ for test: kms_legacy_colorkey
results: parsing output: 73/ for test: kms_cursor_legacy
results: parsing output: 74/ for test: api_intel_bb
results: parsing output: 75/ for test: vgem_basic
results: parsing output: 76/ for test: kms_addfb_basic
results: parsing output: 77/ for test: kms_psr
results: parsing output: 78/ for test: syncobj_wait
results: parsing output: 79/ for test: kms_plane
results: parsing output: 80/ for test: gem_exec_store
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_plane_cursor
results: parsing output: 83/ for test: kms_pipe_crc_basic
results: parsing output: 84/ for test: kms_flip
results: parsing output: 85/ for test: gen7_exec_parse
results: parsing output: 86/ for test: perf
results: parsing output: 87/ for test: gem_softpin
results: parsing output: 88/ for test: i915_pm_rps
results: parsing output: 89/ for test: gem_exec_schedule
results: parsing output: 90/ for test: gem_exec_balancer
results: parsing output: 91/ for test: syncobj_wait
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: sysfs_heartbeat_interval
results: parsing output: 95/ for test: kms_plane_scaling
results: parsing output: 96/ for test: gem_ctx_shared
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: prime_mmap_coherency
results: parsing output: 99/ for test: gem_ctx_persistence
results: parsing output: 100/ for test: gem_media_fill
results: parsing output: 101/ for test: kms_ccs
results: parsing output: 102/ for test: kms_ccs
results: parsing output: 103/ for test: syncobj_eventfd
results: parsing output: 104/ for test: syncobj_timeline
results: parsing output: 105/ for test: i915_query
results: parsing output: 106/ for test: kms_psr
results: parsing output: 107/ for test: kms_ccs
results: parsing output: 108/ for test: gen9_exec_parse
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: kms_cursor_legacy
results: parsing output: 111/ for test: kms_vrr
results: parsing output: 112/ for test: gem_eio
results: parsing output: 113/ for test: kms_flip_scaled_crc
results: parsing output: 114/ for test: kms_flip
results: parsing output: 115/ for test: kms_pm_rpm
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: kms_big_fb
results: parsing output: 118/ for test: gem_exec_reloc
results: parsing output: 119/ for test: api_intel_bb
results: parsing output: 120/ for test: kms_plane_scaling
results: parsing output: 121/ for test: gem_readwrite
results: parsing output: 122/ for test: kms_pm_rpm
results: parsing output: 123/ for test: gem_exec_create
results: parsing output: 124/ for test: gem_softpin
results: parsing output: 125/ for test: syncobj_basic
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: kms_flip
results: parsing output: 128/ for test: gem_exec_parallel
results: parsing output: 129/ for test: kms_atomic_transition
results: parsing output: 130/ for test: kms_frontbuffer_tracking
results: parsing output: 131/ for test: kms_rotation_crc
results: parsing output: 132/ for test: perf_pmu
Done.