[59.423086] Initializing watchdogs
[59.423238]   /dev/watchdog0
[59.441532] [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.445771] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.448077] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.451178] [001/133] (960s left) syncobj_basic (bad-pad-handle-to-fd)
[59.534268] Starting subtest: bad-pad-handle-to-fd
[59.536470] Subtest bad-pad-handle-to-fd: SUCCESS (0.000s)
[59.647244] [002/133] (960s left) gem_mmap_gtt (pf-nonblock)
[59.714969] Subtest pf-nonblock: SKIP (0.000s)
[59.771833] [003/133] (960s left) kms_plane (pixel-format-yf-tiled-ccs-modifier)
[59.874067] Starting subtest: pixel-format-yf-tiled-ccs-modifier
[59.878297] Subtest pixel-format-yf-tiled-ccs-modifier: SKIP (0.000s)
[59.953237] [004/133] (960s left) gem_spin_batch (user-each)
[60.027803] Starting subtest: user-each
[63.298043] Subtest user-each: SUCCESS (3.261s)
[63.979427] [005/133] (956s left) i915_drm_fdinfo (most-busy-check-all)
[64.023496] Starting subtest: most-busy-check-all
[64.025725] Starting dynamic subtest: rcs0
[64.030371] Dynamic subtest rcs0: SKIP (0.004s)
[64.039805] Starting dynamic subtest: bcs0
[64.044431] Dynamic subtest bcs0: SKIP (0.000s)
[64.051388] Starting dynamic subtest: vcs0
[64.055778] Dynamic subtest vcs0: SKIP (0.000s)
[64.062487] Starting dynamic subtest: vcs1
[64.066632] Dynamic subtest vcs1: SKIP (0.000s)
[64.072999] Starting dynamic subtest: vecs0
[64.077076] Dynamic subtest vecs0: SKIP (0.000s)
[64.083652] Starting dynamic subtest: ccs0
[64.088209] Dynamic subtest ccs0: SKIP (0.000s)
[64.092706] Subtest most-busy-check-all: SKIP (0.007s)
[64.126467] [006/133] (956s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode)
[64.538080] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s)
[65.377542] [007/133] (954s left) kms_cursor_legacy (flip-vs-cursor-busy-crc-legacy)
[65.489276] Starting subtest: flip-vs-cursor-busy-crc-legacy
[66.339866] Subtest flip-vs-cursor-busy-crc-legacy: SUCCESS (0.849s)
[67.167675] [008/133] (953s left) gen7_exec_parse (batch-without-end)
[67.298463] Subtest batch-without-end: SKIP (0.000s)
[67.548448] [009/133] (952s left) gem_exec_suspend (basic)
[67.680518] Starting subtest: basic
[67.682966] Starting dynamic subtest: smem
[69.909506] Dynamic subtest smem: SUCCESS (2.227s)
[69.911996] Subtest basic: SUCCESS (2.228s)
[70.088039] [010/133] (950s left) gem_render_copy_redux (flink-interruptible)
[70.150576] Starting subtest: flink-interruptible
[71.257914] Subtest flink-interruptible: SUCCESS (1.108s)
[71.367764] [011/133] (949s left) kms_cursor_crc (cursor-random-64x64)
[71.528427] Starting subtest: cursor-random-64x64
[71.532101] Starting dynamic subtest: pipe-A-eDP-1
[74.856628] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.322s)
[74.890468] Starting dynamic subtest: pipe-D-eDP-1
[78.828082] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.945s)
[78.830486] Subtest cursor-random-64x64: SUCCESS (7.298s)
[79.685335] [012/133] (940s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled)
[79.744532] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[79.746769] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.001s)
[79.837083] [013/133] (940s left) gem_exec_fence (keep-in-fence)
[80.013412] Starting subtest: keep-in-fence
[80.015821] Starting dynamic subtest: rcs0
[80.078630] Dynamic subtest rcs0: SUCCESS (0.065s)
[80.088759] Starting dynamic subtest: bcs0
[80.131473] Dynamic subtest bcs0: SUCCESS (0.052s)
[80.144219] Starting dynamic subtest: vcs0
[81.878139] Dynamic subtest vcs0: SUCCESS (1.744s)
[81.889033] Starting dynamic subtest: vcs1
[83.926071] Dynamic subtest vcs1: SUCCESS (2.047s)
[83.937122] Starting dynamic subtest: vecs0
[85.910447] Dynamic subtest vecs0: SUCCESS (1.983s)
[85.920744] Starting dynamic subtest: ccs0
[86.149675] Dynamic subtest ccs0: SUCCESS (0.240s)
[86.152597] Subtest keep-in-fence: SUCCESS (6.136s)
[87.970477] [FACT gem_exec_fence (keep-in-fence)] new: kernel.kmod_is_loaded.vgem: true
[87.973854] [014/133] (932s left) kms_ccs (bad-rotation-90-y-tiled-gen12-rc-ccs-cc)
[88.079952] Starting subtest: bad-rotation-90-y-tiled-gen12-rc-ccs-cc
[88.082364] Starting dynamic subtest: pipe-A-eDP-1
[88.105803] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[88.114241] Starting dynamic subtest: pipe-B-eDP-1
[88.135347] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[88.142397] Starting dynamic subtest: pipe-C-eDP-1
[88.164062] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[88.171182] Starting dynamic subtest: pipe-D-eDP-1
[88.192963] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[88.197324] Subtest bad-rotation-90-y-tiled-gen12-rc-ccs-cc: SKIP (0.003s)
[90.341858] [015/133] (930s left) gem_exec_basic (basic)
[90.397973] Starting subtest: basic
[90.400427] Starting dynamic subtest: rcs0-smem
[90.402832] Dynamic subtest rcs0-smem: SUCCESS (0.003s)
[90.412902] Starting dynamic subtest: bcs0-smem
[90.414825] Dynamic subtest bcs0-smem: SUCCESS (0.002s)
[90.422126] Starting dynamic subtest: vcs0-smem
[90.424020] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[90.431140] Starting dynamic subtest: vcs1-smem
[90.433073] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[90.440162] Starting dynamic subtest: vecs0-smem
[90.442049] Dynamic subtest vecs0-smem: SUCCESS (0.002s)
[90.449147] Starting dynamic subtest: ccs0-smem
[90.451056] Dynamic subtest ccs0-smem: SUCCESS (0.001s)
[90.452959] Subtest basic: SUCCESS (0.012s)
[91.970518] [016/133] (928s left) gem_pxp (fail-invalid-protected-context)
[92.102335] Starting subtest: fail-invalid-protected-context
[92.104859] Subtest fail-invalid-protected-context: SUCCESS (0.000s)
[92.216986] [017/133] (928s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs-cc)
[92.316151] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs-cc
[92.318360] Starting dynamic subtest: pipe-A-eDP-1
[93.038993] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.716s)
[93.046770] Starting dynamic subtest: pipe-B-eDP-1
[94.852875] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.813s)
[94.862450] Starting dynamic subtest: pipe-C-eDP-1
[96.676170] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.823s)
[96.683302] Starting dynamic subtest: pipe-D-eDP-1
[98.427646] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.750s)
[98.429816] Subtest random-ccs-data-4-tiled-mtl-rc-ccs-cc: SUCCESS (6.106s)
[99.564902] [018/133] (921s left) kms_big_fb (linear-addfb)
[99.664933] Starting subtest: linear-addfb
[99.667140] Subtest linear-addfb: SUCCESS (0.000s)
[99.779859] [019/133] (920s left) kms_plane_multiple (tiling-none)
[99.870045] Starting subtest: tiling-none
[99.872526] Starting dynamic subtest: pipe-A-eDP-1
[103.597134] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.727s)
[103.606412] Starting dynamic subtest: pipe-B-eDP-1
[107.995232] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.399s)
[108.005103] Starting dynamic subtest: pipe-C-eDP-1
[112.358189] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.361s)
[112.367888] Starting dynamic subtest: pipe-D-eDP-1
[116.692591] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.333s)
[116.695014] Subtest tiling-none: SUCCESS (16.823s)
[117.506037] [020/133] (903s left) kms_psr (fbc-psr-primary-blt)
[117.616272] Starting subtest: fbc-psr-primary-blt
[117.618216] Starting dynamic subtest: eDP-1
[117.622331] Dynamic subtest eDP-1: SKIP (0.000s)
[117.626420] Subtest fbc-psr-primary-blt: SKIP (0.001s)
[117.690858] [021/133] (903s left) dmabuf_sync_file (import-multiple-read-write)
[117.730248] Starting subtest: import-multiple-read-write
[117.732501] Subtest import-multiple-read-write: SUCCESS (0.003s)
[117.792639] [022/133] (903s left) sw_sync (sync_busy_fork)
[117.827771] Starting subtest: sync_busy_fork
[118.838446] Subtest sync_busy_fork: SUCCESS (1.011s)
[118.915128] [023/133] (901s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-pwrite)
[119.015113] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-pwrite
[119.019409] Subtest fbc-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[119.143566] [024/133] (901s left) prime_vgem (fence-wait)
[119.220939] Starting subtest: fence-wait
[119.223265] Starting dynamic subtest: rcs0
[120.263047] Dynamic subtest rcs0: SUCCESS (1.041s)
[120.270786] Starting dynamic subtest: bcs0
[121.323036] Dynamic subtest bcs0: SUCCESS (1.059s)
[121.331563] Starting dynamic subtest: vcs0
[122.366300] Dynamic subtest vcs0: SUCCESS (1.042s)
[122.374955] Starting dynamic subtest: vcs1
[123.914946] Dynamic subtest vcs1: SUCCESS (1.547s)
[123.923135] Starting dynamic subtest: vecs0
[124.959065] Dynamic subtest vecs0: SUCCESS (1.042s)
[124.969624] Starting dynamic subtest: ccs0
[126.000052] Dynamic subtest ccs0: SUCCESS (1.040s)
[126.003207] Subtest fence-wait: SUCCESS (6.779s)
[126.122534] [025/133] (894s left) kms_rotation_crc (multiplane-rotation)
[126.213064] Starting subtest: multiplane-rotation
[143.659451] Subtest multiplane-rotation: SUCCESS (17.449s)
[143.767833] [026/133] (877s left) gem_ctx_exec (basic-norecovery)
[143.822037] Starting subtest: basic-norecovery
[144.157120] Subtest basic-norecovery: SUCCESS (0.337s)
[144.278061] [027/133] (876s left) gem_pread (display)
[144.336787] Subtest display: SKIP (0.000s)
[144.403196] [028/133] (876s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[144.491996] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[144.495352] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[144.582854] [029/133] (876s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area)
[144.674960] Starting subtest: psr2-primary-plane-update-sf-dmg-area
[144.676792] Starting dynamic subtest: pipe-A-eDP-1
[150.598030] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.922s)
[150.607978] Starting dynamic subtest: pipe-B-eDP-1
[157.251748] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.655s)
[157.254567] Subtest psr2-primary-plane-update-sf-dmg-area: SUCCESS (12.581s)
[158.124498] [030/133] (863s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs)
[158.226917] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs
[158.229058] Starting dynamic subtest: pipe-A-eDP-1
[158.248836] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[158.258963] Starting dynamic subtest: pipe-B-eDP-1
[158.278055] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[158.286026] Starting dynamic subtest: pipe-C-eDP-1
[158.304188] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[158.313608] Starting dynamic subtest: pipe-D-eDP-1
[158.332566] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[158.334738] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SUCCESS (0.007s)
[160.516471] [031/133] (860s left) kms_joiner (basic-ultra-joiner)
[160.608360] Starting subtest: basic-ultra-joiner
[160.612624] Subtest basic-ultra-joiner: SKIP (0.000s)
[160.689245] [032/133] (860s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-onoff)
[160.783813] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-onoff
[167.840266] Subtest fbcpsr-1p-primscrn-cur-indfb-onoff: SUCCESS (7.059s)
[167.986858] [033/133] (853s left) i915_drm_fdinfo (virtual-busy-idle)
[168.026122] Starting subtest: virtual-busy-idle
[168.030591] Subtest virtual-busy-idle: SKIP (0.000s)
[168.095983] [034/133] (853s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted)
[168.164588] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted
[168.265525] Subtest etime-multi-wait-all-for-submit-unsubmitted: SUCCESS (0.102s)
[168.341403] [035/133] (853s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[168.384963] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[168.387170] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[168.499759] [036/133] (852s left) gem_exec_reloc (basic-cpu-read-noreloc)
[168.563359] Subtest basic-cpu-read-noreloc: SKIP (0.000s)
[168.641438] [037/133] (852s left) sw_sync (alloc_timeline)
[168.681103] Starting subtest: alloc_timeline
[168.683569] Subtest alloc_timeline: SUCCESS (0.000s)
[168.733553] [038/133] (852s left) gem_exec_whisper (basic-contexts-priority-all)
[168.796845] Starting subtest: basic-contexts-priority-all
[192.150474] Subtest basic-contexts-priority-all: SUCCESS (23.351s)
[192.342388] [039/133] (829s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[192.451510] Starting subtest: y-tiled-32bpp-rotate-180
[192.455648] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s)
[192.578431] [040/133] (829s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-cpu)
[192.674788] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-cpu
[192.679293] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[192.774316] [041/133] (828s left) kms_big_fb (4-tiled-16bpp-rotate-180)
[192.869191] Starting subtest: 4-tiled-16bpp-rotate-180
[194.226511] Subtest 4-tiled-16bpp-rotate-180: SUCCESS (1.358s)
[194.358102] [042/133] (827s left) kms_addfb_basic (unused-pitches)
[194.416917] Starting subtest: unused-pitches
[194.418893] Subtest unused-pitches: SUCCESS (0.000s)
[194.566090] [043/133] (827s left) gem_exec_reloc (basic-range)
[194.632974] Subtest basic-range: SKIP (0.000s)
[194.704096] [044/133] (827s left) kms_cursor_crc (cursor-onscreen-32x32)
[194.836703] Starting subtest: cursor-onscreen-32x32
[194.883654] Subtest cursor-onscreen-32x32: SKIP (0.043s)
[195.178190] [045/133] (826s left) kms_big_fb (yf-tiled-16bpp-rotate-90)
[195.285655] Starting subtest: yf-tiled-16bpp-rotate-90
[195.289417] Subtest yf-tiled-16bpp-rotate-90: SKIP (0.000s)
[195.419504] [046/133] (826s left) kms_busy (extended-modeset-hang-oldfb-with-reset)
[195.524897] Starting subtest: extended-modeset-hang-oldfb-with-reset
[195.527596] Starting dynamic subtest: pipe-A
[207.287163] Dynamic subtest pipe-A: SUCCESS (11.759s)
[207.297242] Starting dynamic subtest: pipe-D
[219.550973] Dynamic subtest pipe-D: SUCCESS (12.262s)
[219.553420] Subtest extended-modeset-hang-oldfb-with-reset: SUCCESS (24.026s)
[220.345084] [047/133] (801s left) gem_mmap_gtt (close-race)
[220.402544] Subtest close-race: SKIP (0.000s)
[220.470391] [048/133] (801s left) syncobj_wait (wait-for-submit-complex)
[220.518487] Starting subtest: wait-for-submit-complex
[220.579029] Subtest wait-for-submit-complex: SUCCESS (0.062s)
[220.657739] [049/133] (801s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-mc-ccs)
[220.741337] Starting subtest: crc-primary-suspend-4-tiled-mtl-mc-ccs
[220.743596] Starting dynamic subtest: pipe-A-eDP-1
[252.744607] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.968s)
[252.754160] Starting dynamic subtest: pipe-B-eDP-1
[285.662582] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.632s)
[285.672285] Starting dynamic subtest: pipe-C-eDP-1
[318.640908] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.652s)
[318.651204] Starting dynamic subtest: pipe-D-eDP-1
[351.637719] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.617s)
[351.640102] Subtest crc-primary-suspend-4-tiled-mtl-mc-ccs: SUCCESS (13.874s)
[352.815129] [050/133] (669s left) kms_flip (dpms-vs-vblank-race)
[352.927310] Starting subtest: dpms-vs-vblank-race
[352.929608] Starting dynamic subtest: A-eDP1
[356.784424] Dynamic subtest A-eDP1: SUCCESS (3.852s)
[356.793697] Starting dynamic subtest: B-eDP1
[360.310088] Dynamic subtest B-eDP1: SUCCESS (3.521s)
[360.320171] Starting dynamic subtest: C-eDP1
[364.928941] Dynamic subtest C-eDP1: SUCCESS (4.611s)
[364.939305] Starting dynamic subtest: D-eDP1
[368.460505] Dynamic subtest D-eDP1: SUCCESS (3.529s)
[368.466494] Subtest dpms-vs-vblank-race: SUCCESS (15.526s)
[369.328637] [051/133] (652s left) kms_addfb_basic (too-high)
[369.433950] Starting subtest: too-high
[369.436773] Subtest too-high: SUCCESS (0.001s)
[369.556610] [052/133] (652s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[369.654522] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt
[369.658813] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[369.750930] [053/133] (652s left) kms_pm_rpm (cursor)
[371.285936] Starting subtest: cursor
[371.291130] Subtest cursor: SKIP (0.000s)
[372.072708] [054/133] (650s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-pwrite)
[372.169327] Starting subtest: psr-1p-primscrn-pri-indfb-draw-pwrite
[379.813083] Subtest psr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (7.642s)
[379.909853] [055/133] (642s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-upscaling)
[380.013714] Starting subtest: flip-64bpp-yftile-to-32bpp-yftile-upscaling
[380.018104] Subtest flip-64bpp-yftile-to-32bpp-yftile-upscaling: SKIP (0.000s)
[380.088777] [056/133] (642s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-downscaling)
[380.191623] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-downscaling
[380.195723] Subtest flip-32bpp-yftile-to-64bpp-yftile-downscaling: SKIP (0.000s)
[380.269629] [057/133] (642s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[380.327229] Subtest no-spare-fences-interruptible: SKIP (0.000s)
[380.386340] [058/133] (641s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-cpu)
[380.485843] Starting subtest: psr-rgb565-draw-mmap-cpu
[387.270155] Subtest psr-rgb565-draw-mmap-cpu: SUCCESS (6.794s)
[387.383588] [059/133] (635s left) gem_ctx_persistence (process)
[387.444213] Starting subtest: process
[387.638039] Subtest process: SUCCESS (0.193s)
[387.717385] [060/133] (634s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible)
[387.827044] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible
[387.839635] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SKIP (0.010s)
[387.916404] [061/133] (634s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-sf)
[388.006526] Starting subtest: fbc-pr-overlay-plane-move-continuous-sf
[388.010603] Subtest fbc-pr-overlay-plane-move-continuous-sf: SKIP (0.000s)
[388.074080] [062/133] (634s left) gem_flink_basic (double-flink)
[388.134897] Starting subtest: double-flink
[388.136853] Subtest double-flink: SUCCESS (0.000s)
[388.248456] [063/133] (634s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[388.345579] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[388.348975] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[388.446070] [064/133] (634s left) gem_ctx_sseu (mmap-args)
[388.517214] Subtest mmap-args: SKIP (0.000s)
[388.583185] [065/133] (634s left) template (b)
[388.639471] Starting subtest: B
[388.641381] Subtest B: SUCCESS (0.000s)
[388.745033] [066/133] (633s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff)
[388.832655] Starting subtest: psr-2p-primscrn-spr-indfb-onoff
[388.836336] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[388.932443] [067/133] (633s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[389.032723] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu
[389.036077] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[389.136830] [068/133] (633s left) kms_content_protection (dp-mst-type-0-suspend-resume)
[389.277559] Starting subtest: dp-mst-type-0-suspend-resume
[389.281324] Subtest dp-mst-type-0-suspend-resume: SKIP (0.000s)
[389.397526] [069/133] (633s left) kms_addfb_basic (bad-pitch-128)
[389.461765] Starting subtest: bad-pitch-128
[389.463539] Subtest bad-pitch-128: SUCCESS (0.000s)
[389.609868] [070/133] (633s left) gem_render_copy (linear)
[389.680473] Starting subtest: linear
[389.682587] Starting dynamic subtest: smem
[389.720669] Dynamic subtest smem: SUCCESS (0.040s)
[389.722785] Subtest linear: SUCCESS (0.041s)
[389.910092] [071/133] (633s left) kms_flip (bo-too-big)
[390.009700] Starting subtest: bo-too-big
[390.011633] Starting dynamic subtest: A-eDP1
[391.342951] Dynamic subtest A-eDP1: SUCCESS (1.335s)
[391.352444] Starting dynamic subtest: B-eDP1
[392.672227] Dynamic subtest B-eDP1: SUCCESS (1.328s)
[392.684982] Starting dynamic subtest: C-eDP1
[393.999810] Dynamic subtest C-eDP1: SUCCESS (1.328s)
[394.011517] Starting dynamic subtest: D-eDP1
[395.332961] Dynamic subtest D-eDP1: SUCCESS (1.330s)
[395.338827] Subtest bo-too-big: SUCCESS (5.332s)
[396.538408] [072/133] (626s left) gem_pxp (verify-pxp-key-change-after-suspend-resume)
[396.645579] Starting subtest: verify-pxp-key-change-after-suspend-resume
[403.797525] Subtest verify-pxp-key-change-after-suspend-resume: SUCCESS (7.152s)
[403.928495] [073/133] (619s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[404.054394] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu
[404.058799] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[404.151736] [074/133] (618s left) kms_vblank (wait-idle)
[404.250790] Starting subtest: wait-idle
[404.252707] Starting dynamic subtest: pipe-A-eDP-1
[406.009796] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.761s)
[406.026765] Starting dynamic subtest: pipe-D-eDP-1
[408.409625] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.394s)
[408.411515] Subtest wait-idle: SUCCESS (4.159s)
[409.236528] [075/133] (613s left) gem_exec_parallel (userptr)
[409.287011] Starting subtest: userptr
[409.289371] Starting dynamic subtest: rcs0
[410.733862] Dynamic subtest rcs0: SUCCESS (1.447s)
[410.747151] Starting dynamic subtest: bcs0
[412.128488] Dynamic subtest bcs0: SUCCESS (1.392s)
[412.138534] Starting dynamic subtest: vcs0
[413.861128] Dynamic subtest vcs0: SUCCESS (1.729s)
[413.871049] Starting dynamic subtest: vcs1
[415.845540] Dynamic subtest vcs1: SUCCESS (1.981s)
[415.858128] Starting dynamic subtest: vecs0
[417.893882] Dynamic subtest vecs0: SUCCESS (2.045s)
[417.905627] Starting dynamic subtest: ccs0
[419.390445] Dynamic subtest ccs0: SUCCESS (1.495s)
[419.393378] Subtest userptr: SUCCESS (10.103s)
[419.592585] [076/133] (603s left) kms_vrr (flipline)
[419.687506] Starting subtest: flipline
[419.694333] Subtest flipline: SKIP (0.000s)
[419.757752] [077/133] (603s left) i915_query (query-topology-known-pci-ids)
[419.807517] Starting subtest: query-topology-known-pci-ids
[419.811570] Subtest query-topology-known-pci-ids: SKIP (0.000s)
[419.915329] [078/133] (603s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt)
[420.011543] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt
[427.299687] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.293s)
[427.426707] [079/133] (595s left) gem_exec_params (cliprects_ptr-dirt)
[427.481118] Starting subtest: cliprects_ptr-dirt
[427.483431] Subtest cliprects_ptr-dirt: SUCCESS (0.000s)
[427.601822] [080/133] (595s left) kms_color_pipeline (plane-ctm3x4-lut1d)
[427.692730] Starting subtest: plane-ctm3x4-lut1d
[427.871800] Starting dynamic subtest: pipe-A-plane-0
[428.019141] Dynamic subtest pipe-A-plane-0: SUCCESS (0.144s)
[428.034475] Starting dynamic subtest: pipe-A-plane-1
[428.150021] Dynamic subtest pipe-A-plane-1: SUCCESS (0.133s)
[428.160132] Starting dynamic subtest: pipe-A-plane-2
[428.293480] Dynamic subtest pipe-A-plane-2: SUCCESS (0.143s)
[429.507573] Starting dynamic subtest: pipe-B-plane-0
[429.644266] Dynamic subtest pipe-B-plane-0: SUCCESS (0.144s)
[429.653770] Starting dynamic subtest: pipe-B-plane-1
[429.832924] Dynamic subtest pipe-B-plane-1: SUCCESS (0.187s)
[429.842695] Starting dynamic subtest: pipe-B-plane-2
[429.988637] Dynamic subtest pipe-B-plane-2: SUCCESS (0.155s)
[431.196229] Starting dynamic subtest: pipe-C-plane-0
[431.320164] Dynamic subtest pipe-C-plane-0: SUCCESS (0.133s)
[431.330272] Starting dynamic subtest: pipe-C-plane-1
[431.453253] Dynamic subtest pipe-C-plane-1: SUCCESS (0.133s)
[431.463344] Starting dynamic subtest: pipe-C-plane-2
[431.586890] Dynamic subtest pipe-C-plane-2: SUCCESS (0.133s)
[432.739864] Starting dynamic subtest: pipe-D-plane-0
[432.875681] Dynamic subtest pipe-D-plane-0: SUCCESS (0.144s)
[432.885640] Starting dynamic subtest: pipe-D-plane-1
[433.009369] Dynamic subtest pipe-D-plane-1: SUCCESS (0.133s)
[433.019876] Starting dynamic subtest: pipe-D-plane-2
[433.153904] Dynamic subtest pipe-D-plane-2: SUCCESS (0.144s)
[433.438124] Subtest plane-ctm3x4-lut1d: SUCCESS (5.746s)
[434.327402] [081/133] (589s left) kms_dsc (dsc-with-output-formats)
[434.430522] Starting subtest: dsc-with-output-formats
[434.451851] Subtest dsc-with-output-formats: SKIP (0.000s)
[434.499928] [082/133] (588s left) syncobj_timeline (signal)
[434.548267] Starting subtest: signal
[434.550588] Subtest signal: SUCCESS (0.000s)
[434.650063] [083/133] (588s left) kms_setmode (invalid-clone-single-crtc)
[434.710532] Starting subtest: invalid-clone-single-crtc
[434.717261] Subtest invalid-clone-single-crtc: SKIP (0.000s)
[434.810576] [084/133] (588s left) gem_exec_schedule (semaphore-user)
[434.873750] Starting subtest: semaphore-user
[434.923559] Subtest semaphore-user: SUCCESS (0.057s)
[436.940973] [085/133] (586s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[437.341642] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[438.128362] [086/133] (585s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[438.228807] Starting subtest: fbcpsr-indfb-scaledprimary
[444.062411] Subtest fbcpsr-indfb-scaledprimary: SUCCESS (5.837s)
[444.220088] [087/133] (579s left) syncobj_timeline (multi-wait-submitted-signaled)
[444.276356] Starting subtest: multi-wait-submitted-signaled
[444.278355] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[444.373921] [088/133] (579s left) api_intel_allocator (fork-simple-once)
[444.421310] Starting subtest: fork-simple-once
[444.438538] Subtest fork-simple-once: SUCCESS (0.019s)
[444.552424] [089/133] (579s left) kms_plane_alpha_blend (alpha-transparent-fb)
[444.640794] Starting subtest: alpha-transparent-fb
[444.921965] Starting dynamic subtest: pipe-A-eDP-1
[445.554491] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.632s)
[445.564373] Starting dynamic subtest: pipe-D-eDP-1
[446.917112] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.358s)
[446.919491] Subtest alpha-transparent-fb: SUCCESS (2.276s)
[447.788233] [090/133] (575s left) kms_big_fb (4-tiled-8bpp-rotate-90)
[447.894433] Starting subtest: 4-tiled-8bpp-rotate-90
[447.918987] Subtest 4-tiled-8bpp-rotate-90: SKIP (0.021s)
[448.042531] [091/133] (575s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[448.141178] Starting subtest: psr-rgb565-draw-render
[455.238809] Subtest psr-rgb565-draw-render: SUCCESS (7.100s)
[455.349259] [092/133] (568s left) kms_atomic_interruptible (universal-setplane-primary)
[455.433648] Starting subtest: universal-setplane-primary
[455.435906] Starting dynamic subtest: pipe-A-eDP-1
[462.856757] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.421s)
[462.859113] Subtest universal-setplane-primary: SUCCESS (7.422s)
[463.683407] [093/133] (560s left) i915_pm_rc6_residency (media-rc6-accuracy)
[463.742961] Starting subtest: media-rc6-accuracy
[463.747290] Subtest media-rc6-accuracy: SKIP (0.000s)
[463.842677] [094/133] (560s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[463.940579] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[470.542505] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.602s)
[470.665981] [095/133] (553s left) kms_flip (flip-vs-absolute-wf_vblank-interruptible)
[470.764788] Starting subtest: flip-vs-absolute-wf_vblank-interruptible
[470.767222] Starting dynamic subtest: A-eDP1
[479.682684] Dynamic subtest A-eDP1: SUCCESS (8.915s)
[479.698989] Starting dynamic subtest: B-eDP1
[488.617900] Dynamic subtest B-eDP1: SUCCESS (8.930s)
[488.636364] Starting dynamic subtest: C-eDP1
[497.536972] Dynamic subtest C-eDP1: SUCCESS (8.914s)
[497.548886] Starting dynamic subtest: D-eDP1
[506.474028] Dynamic subtest D-eDP1: SUCCESS (8.933s)
[506.479421] Subtest flip-vs-absolute-wf_vblank-interruptible: SUCCESS (35.707s)
[507.693997] [096/133] (516s left) kms_dp_link_training (uhbr-mst)
[507.792688] Starting subtest: uhbr-mst
[507.801385] Subtest uhbr-mst: SKIP (0.000s)
[507.884299] [097/133] (516s left) i915_suspend (sysfs-reader)
[507.940535] Starting subtest: sysfs-reader
[526.464234] Subtest sysfs-reader: SUCCESS (3.141s)
[526.545570] [098/133] (497s left) gem_exec_whisper (basic-sync-all)
[526.616645] Starting subtest: basic-sync-all
[532.916263] Subtest basic-sync-all: SUCCESS (6.291s)
[533.101244] [099/133] (490s left) gem_userptr_blits (set-cache-level)
[533.176409] Starting subtest: set-cache-level
[533.180477] Subtest set-cache-level: SKIP (0.000s)
[533.304951] [100/133] (490s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[533.399966] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[533.404187] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[533.497972] [101/133] (490s left) kms_psr (psr-cursor-mmap-cpu)
[533.592758] Starting subtest: psr-cursor-mmap-cpu
[533.594991] Starting dynamic subtest: eDP-1
[535.348559] Dynamic subtest eDP-1: SUCCESS (1.752s)
[535.350935] Subtest psr-cursor-mmap-cpu: SUCCESS (1.753s)
[536.220140] [102/133] (488s left) kms_frontbuffer_tracking (fbc-1p-indfb-fliptrack-mmap-gtt)
[536.307929] Starting subtest: fbc-1p-indfb-fliptrack-mmap-gtt
[536.312245] Subtest fbc-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[536.397689] [103/133] (487s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-pwrite)
[536.498639] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-pwrite
[545.786114] Subtest psr-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (9.284s)
[545.917116] [104/133] (478s left) kms_plane_scaling (planes-upscale-factor-0-25)
[546.020873] Starting subtest: planes-upscale-factor-0-25
[546.023231] Starting dynamic subtest: pipe-A
[546.081437] Dynamic subtest pipe-A: SUCCESS (0.063s)
[546.093402] Starting dynamic subtest: pipe-B
[547.259211] Dynamic subtest pipe-B: SUCCESS (1.175s)
[547.271457] Starting dynamic subtest: pipe-C
[548.369485] Dynamic subtest pipe-C: SUCCESS (1.108s)
[548.379600] Starting dynamic subtest: pipe-D
[549.503753] Dynamic subtest pipe-D: SUCCESS (1.133s)
[549.506042] Subtest planes-upscale-factor-0-25: SUCCESS (3.484s)
[550.670145] [105/133] (473s left) gem_ctx_engines (none)
[550.727139] Starting subtest: none
[550.732688] Subtest none: SUCCESS (0.003s)
[550.927988] [106/133] (473s left) kms_psr (pr-primary-mmap-gtt)
[551.021078] Starting subtest: pr-primary-mmap-gtt
[551.025294] Subtest pr-primary-mmap-gtt: SKIP (0.000s)
[551.091934] [107/133] (473s left) gem_ringfill (basic-all)
[556.287934] Starting subtest: basic-all
[557.453939] Subtest basic-all: SUCCESS (1.166s)
[557.589602] [108/133] (466s left) gen3_mixed_blits
[557.718924] [109/133] (466s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions)
[557.840751] Starting subtest: cursorA-vs-flipB-atomic-transitions
[557.845074] Subtest cursorA-vs-flipB-atomic-transitions: SKIP (0.001s)
[558.003218] [110/133] (466s left) kms_atomic_transition (plane-all-transition-fencing)
[558.089548] Starting subtest: plane-all-transition-fencing
[558.091844] Starting dynamic subtest: pipe-A-eDP-1
[560.582748] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.495s)
[560.904562] Starting dynamic subtest: pipe-B-eDP-1
[564.103110] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.209s)
[564.403614] Subtest plane-all-transition-fencing: SUCCESS (6.316s)
[565.226909] [111/133] (459s left) perf_pmu (busy-start)
[565.273045] Starting subtest: busy-start
[565.275249] Starting dynamic subtest: rcs0
[567.821083] Dynamic subtest rcs0: SUCCESS (2.549s)
[567.836352] Starting dynamic subtest: bcs0
[570.370656] Dynamic subtest bcs0: SUCCESS (2.547s)
[570.383647] Starting dynamic subtest: vcs0
[574.331344] Dynamic subtest vcs0: SUCCESS (3.957s)
[574.344001] Starting dynamic subtest: vcs1
[578.299456] Dynamic subtest vcs1: SUCCESS (3.965s)
[578.312380] Starting dynamic subtest: vecs0
[582.332332] Dynamic subtest vecs0: SUCCESS (4.029s)
[582.345520] Starting dynamic subtest: ccs0
[584.882755] Dynamic subtest ccs0: SUCCESS (2.548s)
[584.885287] Subtest busy-start: SUCCESS (19.611s)
[585.000809] [112/133] (439s left) gem_tiled_wb
[585.121803] [113/133] (439s left) gem_exec_schedule (noreorder-priority)
[585.301684] Starting subtest: noreorder-priority
[585.304102] Starting dynamic subtest: rcs0
[586.462335] Dynamic subtest rcs0: SUCCESS (1.161s)
[586.476246] Starting dynamic subtest: vcs0
[588.278517] Dynamic subtest vcs0: SUCCESS (1.812s)
[588.292399] Starting dynamic subtest: vcs1
[590.265603] Dynamic subtest vcs1: SUCCESS (1.984s)
[590.278427] Starting dynamic subtest: vecs0
[592.320872] Dynamic subtest vecs0: SUCCESS (2.052s)
[592.333891] Starting dynamic subtest: ccs0
[593.459281] Dynamic subtest ccs0: SUCCESS (1.137s)
[593.461787] Subtest noreorder-priority: SUCCESS (8.158s)
[593.664003] [114/133] (431s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area-big-fb)
[593.772860] Starting subtest: pr-primary-plane-update-sf-dmg-area-big-fb
[593.777242] Subtest pr-primary-plane-update-sf-dmg-area-big-fb: SKIP (0.000s)
[593.855788] [115/133] (430s left) kms_cursor_crc (cursor-sliding-64x64)
[594.024255] Starting subtest: cursor-sliding-64x64
[594.029249] Starting dynamic subtest: pipe-A-eDP-1
[597.252923] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.224s)
[597.283264] Starting dynamic subtest: pipe-D-eDP-1
[601.154197] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.876s)
[601.156422] Subtest cursor-sliding-64x64: SUCCESS (7.127s)
[601.999343] [116/133] (422s left) gem_exec_balancer (fairslice)
[602.054918] Starting subtest: fairslice
[604.958342] Subtest fairslice: SUCCESS (2.901s)
[605.316967] [117/133] (419s left) kms_psr (fbc-pr-sprite-mmap-cpu)
[605.406585] Starting subtest: fbc-pr-sprite-mmap-cpu
[605.410936] Subtest fbc-pr-sprite-mmap-cpu: SKIP (0.000s)
[605.491541] [118/133] (419s left) kms_addfb_basic (basic-y-tiled-legacy)
[605.566074] Starting subtest: basic-y-tiled-legacy
[605.569822] Subtest basic-y-tiled-legacy: SKIP (0.000s)
[605.694258] [119/133] (419s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-rc-ccs-cc)
[605.790776] Starting subtest: crc-primary-suspend-y-tiled-gen12-rc-ccs-cc
[605.792994] Starting dynamic subtest: pipe-A-eDP-1
[605.801505] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[605.812387] Starting dynamic subtest: pipe-B-eDP-1
[605.820987] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[605.832193] Starting dynamic subtest: pipe-C-eDP-1
[605.840281] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[605.849691] Starting dynamic subtest: pipe-D-eDP-1
[605.857972] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[605.862177] Subtest crc-primary-suspend-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[607.987598] [120/133] (417s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0)
[608.086285] Starting subtest: linear-max-hw-stride-64bpp-rotate-0
[609.198356] Subtest linear-max-hw-stride-64bpp-rotate-0: SUCCESS (1.111s)
[609.337985] [121/133] (415s left) gem_fence_thrash (bo-write-verify-threaded-none)
[609.378485] Starting subtest: bo-write-verify-threaded-none
[609.391488] Subtest bo-write-verify-threaded-none: SKIP (0.013s)
[609.453637] [122/133] (415s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[609.561698] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[609.565394] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[609.656839] [123/133] (415s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-blt)
[609.760016] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-blt
[613.496782] Subtest fbc-1p-primscrn-spr-indfb-draw-blt: SUCCESS (3.740s)
[614.678204] [124/133] (410s left) fbdev (info)
[614.712994] Starting subtest: info
[614.715275] Subtest info: SUCCESS (0.000s)
[614.776611] [125/133] (410s left) kms_lease (lease-unleased-crtc)
[614.856076] Starting subtest: lease-unleased-crtc
[614.858319] Starting dynamic subtest: pipe-A-eDP-1
[615.147551] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.292s)
[615.158297] Starting dynamic subtest: pipe-B-eDP-1
[615.917047] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.767s)
[615.935077] Starting dynamic subtest: pipe-C-eDP-1
[615.937161] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.004s)
[615.953798] Starting dynamic subtest: pipe-D-eDP-1
[615.955990] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.004s)
[615.958268] Subtest lease-unleased-crtc: SUCCESS (1.073s)
[616.291413] [126/133] (408s left) api_intel_bb (simple-bb-ctx)
[616.349320] Starting subtest: simple-bb-ctx
[616.355969] Subtest simple-bb-ctx: SUCCESS (0.008s)
[616.446055] [127/133] (408s left) vgem_basic (bad-pad)
[616.492760] Starting subtest: bad-pad
[616.494933] Subtest bad-pad: SUCCESS (0.000s)
[616.553587] [128/133] (408s left) gem_sync (basic-store-each)
[616.629380] Starting subtest: basic-store-each
[619.171459] Subtest basic-store-each: SUCCESS (2.550s)
[619.377243] [129/133] (405s left) kms_sequence (queue-busy)
[619.472624] Starting subtest: queue-busy
[619.474801] Starting dynamic subtest: pipe-A-eDP-1
[621.426946] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.953s)
[621.438391] Starting dynamic subtest: pipe-B-eDP-1
[623.991740] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.563s)
[624.005239] Starting dynamic subtest: pipe-C-eDP-1
[626.584165] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.593s)
[626.601461] Starting dynamic subtest: pipe-D-eDP-1
[629.131725] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.547s)
[629.133939] Subtest queue-busy: SUCCESS (9.661s)
[629.943058] [130/133] (395s left) gem_exec_params (secure-non-root)
[629.995192] Starting subtest: secure-non-root
[629.999870] Subtest secure-non-root: SKIP (0.000s)
[630.090952] [131/133] (395s left) kms_pm_rpm (pm-caching)
[631.617774] Starting subtest: pm-caching
[631.622729] Subtest pm-caching: SKIP (0.000s)
[632.377319] [132/133] (393s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted)
[632.437615] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted
[632.544845] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.107s)
[632.621185] [133/133] (392s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-modifiers)
[632.713637] Starting subtest: plane-scaler-with-clipping-clamping-modifiers
[632.716003] Starting dynamic subtest: pipe-A
[633.074602] Dynamic subtest pipe-A: SUCCESS (0.363s)
[633.087614] Starting dynamic subtest: pipe-B
[634.480945] Dynamic subtest pipe-B: SUCCESS (1.406s)
[634.496649] Starting dynamic subtest: pipe-C
[635.891985] Dynamic subtest pipe-C: SUCCESS (1.410s)
[635.909272] Starting dynamic subtest: pipe-D
[637.376285] Dynamic subtest pipe-D: SUCCESS (1.483s)
[637.378754] Subtest plane-scaler-with-clipping-clamping-modifiers: SUCCESS (4.666s)
[638.509180] Closing watchdogs
results: parsing output: 0/ for test: syncobj_basic
results: parsing output: 1/ for test: gem_mmap_gtt
results: parsing output: 2/ for test: kms_plane
results: parsing output: 3/ for test: gem_spin_batch
results: parsing output: 4/ for test: i915_drm_fdinfo
results: parsing output: 5/ for test: kms_chamelium_hpd
results: parsing output: 6/ for test: kms_cursor_legacy
results: parsing output: 7/ for test: gen7_exec_parse
results: parsing output: 8/ for test: gem_exec_suspend
results: parsing output: 9/ for test: gem_render_copy_redux
results: parsing output: 10/ for test: kms_cursor_crc
results: parsing output: 11/ for test: syncobj_timeline
results: parsing output: 12/ for test: gem_exec_fence
results: parsing output: 13/ for test: kms_ccs
results: parsing output: 14/ for test: gem_exec_basic
results: parsing output: 15/ for test: gem_pxp
results: parsing output: 16/ for test: kms_ccs
results: parsing output: 17/ for test: kms_big_fb
results: parsing output: 18/ for test: kms_plane_multiple
results: parsing output: 19/ for test: kms_psr
results: parsing output: 20/ for test: dmabuf_sync_file
results: parsing output: 21/ for test: sw_sync
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: prime_vgem
results: parsing output: 24/ for test: kms_rotation_crc
results: parsing output: 25/ for test: gem_ctx_exec
results: parsing output: 26/ for test: gem_pread
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: kms_psr2_sf
results: parsing output: 29/ for test: kms_ccs
results: parsing output: 30/ for test: kms_joiner
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: i915_drm_fdinfo
results: parsing output: 33/ for test: syncobj_timeline
results: parsing output: 34/ for test: syncobj_wait
results: parsing output: 35/ for test: gem_exec_reloc
results: parsing output: 36/ for test: sw_sync
results: parsing output: 37/ for test: gem_exec_whisper
results: parsing output: 38/ for test: kms_big_fb
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: kms_big_fb
results: parsing output: 41/ for test: kms_addfb_basic
results: parsing output: 42/ for test: gem_exec_reloc
results: parsing output: 43/ for test: kms_cursor_crc
results: parsing output: 44/ for test: kms_big_fb
results: parsing output: 45/ for test: kms_busy
results: parsing output: 46/ for test: gem_mmap_gtt
results: parsing output: 47/ for test: syncobj_wait
results: parsing output: 48/ for test: kms_ccs
results: parsing output: 49/ for test: kms_flip
results: parsing output: 50/ for test: kms_addfb_basic
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_pm_rpm
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: kms_flip_scaled_crc
results: parsing output: 55/ for test: kms_flip_scaled_crc
results: parsing output: 56/ for test: gem_fenced_exec_thrash
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: gem_ctx_persistence
results: parsing output: 59/ for test: kms_flip
results: parsing output: 60/ for test: kms_psr2_sf
results: parsing output: 61/ for test: gem_flink_basic
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: gem_ctx_sseu
results: parsing output: 64/ for test: template
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: kms_content_protection
results: parsing output: 68/ for test: kms_addfb_basic
results: parsing output: 69/ for test: gem_render_copy
results: parsing output: 70/ for test: kms_flip
results: parsing output: 71/ for test: gem_pxp
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_vblank
results: parsing output: 74/ for test: gem_exec_parallel
results: parsing output: 75/ for test: kms_vrr
results: parsing output: 76/ for test: i915_query
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: gem_exec_params
results: parsing output: 79/ for test: kms_color_pipeline
results: parsing output: 80/ for test: kms_dsc
results: parsing output: 81/ for test: syncobj_timeline
results: parsing output: 82/ for test: kms_setmode
results: parsing output: 83/ for test: gem_exec_schedule
results: parsing output: 84/ for test: kms_chamelium_edid
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: syncobj_timeline
results: parsing output: 87/ for test: api_intel_allocator
results: parsing output: 88/ for test: kms_plane_alpha_blend
results: parsing output: 89/ for test: kms_big_fb
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: kms_atomic_interruptible
results: parsing output: 92/ for test: i915_pm_rc6_residency
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: kms_flip
results: parsing output: 95/ for test: kms_dp_link_training
results: parsing output: 96/ for test: i915_suspend
results: parsing output: 97/ for test: gem_exec_whisper
results: parsing output: 98/ for test: gem_userptr_blits
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_psr
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_plane_scaling
results: parsing output: 104/ for test: gem_ctx_engines
results: parsing output: 105/ for test: kms_psr
results: parsing output: 106/ for test: gem_ringfill
results: parsing output: 107/ for test: gen3_mixed_blits
results: parsing output: 108/ for test: kms_cursor_legacy
results: parsing output: 109/ for test: kms_atomic_transition
results: parsing output: 110/ for test: perf_pmu
results: parsing output: 111/ for test: gem_tiled_wb
results: parsing output: 112/ for test: gem_exec_schedule
results: parsing output: 113/ for test: kms_psr2_sf
results: parsing output: 114/ for test: kms_cursor_crc
results: parsing output: 115/ for test: gem_exec_balancer
results: parsing output: 116/ for test: kms_psr
results: parsing output: 117/ for test: kms_addfb_basic
results: parsing output: 118/ for test: kms_ccs
results: parsing output: 119/ for test: kms_big_fb
results: parsing output: 120/ for test: gem_fence_thrash
results: parsing output: 121/ for test: kms_big_fb
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: fbdev
results: parsing output: 124/ for test: kms_lease
results: parsing output: 125/ for test: api_intel_bb
results: parsing output: 126/ for test: vgem_basic
results: parsing output: 127/ for test: gem_sync
results: parsing output: 128/ for test: kms_sequence
results: parsing output: 129/ for test: gem_exec_params
results: parsing output: 130/ for test: kms_pm_rpm
results: parsing output: 131/ for test: syncobj_timeline
results: parsing output: 132/ for test: kms_plane_scaling
Done.