[58.890889] Initializing watchdogs
[58.890937]   /dev/watchdog0
[58.903836] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[58.908225] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.910335] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.913587] [001/133] (960s left) gem_exec_nop (basic-sequential)
[59.015852] Starting subtest: basic-sequential
[73.427986] Subtest basic-sequential: SUCCESS (14.418s)
[73.661819] [002/133] (945s left) kms_big_fb (y-tiled-32bpp-rotate-90)
[73.771718] Starting subtest: y-tiled-32bpp-rotate-90
[73.775829] Subtest y-tiled-32bpp-rotate-90: SKIP (0.000s)
[73.890059] [003/133] (945s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-render)
[73.991517] Starting subtest: fbc-rgb101010-draw-render
[78.594827] Subtest fbc-rgb101010-draw-render: SUCCESS (4.608s)
[79.771585] [004/133] (939s left) kms_plane_multiple (2x-tiling-4)
[79.869727] Starting subtest: 2x-tiling-4
[79.874611] Subtest 2x-tiling-4: SKIP (0.000s)
[79.958421] [005/133] (939s left) perf_pmu (semaphore-busy)
[79.997759] Starting subtest: semaphore-busy
[80.000247] Starting dynamic subtest: rcs0
[81.652601] Dynamic subtest rcs0: SUCCESS (1.652s)
[81.667866] Starting dynamic subtest: bcs0
[83.286303] Dynamic subtest bcs0: SUCCESS (1.632s)
[83.296207] Starting dynamic subtest: vcs0
[87.378848] Dynamic subtest vcs0: SUCCESS (4.090s)
[87.391681] Starting dynamic subtest: vcs1
[93.393259] Dynamic subtest vcs1: SUCCESS (6.014s)
[93.402106] Starting dynamic subtest: vecs0
[99.409167] Dynamic subtest vecs0: SUCCESS (6.014s)
[99.418265] Starting dynamic subtest: ccs0
[102.483057] Dynamic subtest ccs0: SUCCESS (3.072s)
[102.485868] Subtest semaphore-busy: SUCCESS (22.481s)
[102.600323] [006/133] (917s left) kms_psr (psr2-primary-page-flip)
[102.699688] Starting subtest: psr2-primary-page-flip
[102.701883] Starting dynamic subtest: eDP-1
[105.084921] Dynamic subtest eDP-1: FAIL (1.795s)
[105.087304] Subtest psr2-primary-page-flip: FAIL (1.795s)
[105.122971] [007/133] (914s left) i915_suspend (fence-restore-tiled2untiled)
[105.186979] Starting subtest: fence-restore-tiled2untiled
[105.191221] Subtest fence-restore-tiled2untiled: SKIP (0.000s)
[105.295386] [008/133] (914s left) gem_exec_balancer (busy)
[105.359129] Starting subtest: busy
[106.878205] Subtest busy: SUCCESS (1.517s)
[107.193159] [009/133] (912s left) kms_rotation_crc (primary-yf-tiled-reflect-x-180)
[107.285859] Starting subtest: primary-yf-tiled-reflect-x-180
[107.362161] Subtest primary-yf-tiled-reflect-x-180: SKIP (0.075s)
[107.451083] [010/133] (912s left) gem_exec_reloc (basic-wc-gtt-noreloc)
[107.517873] Subtest basic-wc-gtt-noreloc: SKIP (0.000s)
[107.605729] [011/133] (912s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-downscaling)
[107.699475] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-downscaling
[107.701887] Starting dynamic subtest: pipe-A-default-mode
[108.860317] Dynamic subtest pipe-A-default-mode: SKIP (1.156s)
[108.864811] Subtest flip-32bpp-4tile-to-64bpp-4tile-downscaling: SKIP (1.157s)
[109.008817] [012/133] (910s left) kms_tiled_display (basic-test-pattern-with-chamelium)
[109.130949] Subtest basic-test-pattern-with-chamelium: SKIP (0.000s)
[109.177797] [013/133] (910s left) gem_exec_fence (syncobj-timeline-export)
[109.753042] Starting subtest: syncobj-timeline-export
[109.758369] Subtest syncobj-timeline-export: SUCCESS (0.007s)
[111.006487] [FACT gem_exec_fence (syncobj-timeline-export)] new: kernel.kmod_is_loaded.vgem: true
[111.009417] [014/133] (908s left) gen7_exec_parse (bitmasks)
[111.072447] Subtest bitmasks: SKIP (0.000s)
[111.143514] [015/133] (908s left) kms_plane (pixel-format-x-tiled-modifier-source-clamping)
[111.232606] Starting subtest: pixel-format-x-tiled-modifier-source-clamping
[111.249752] Starting dynamic subtest: pipe-A-plane-0
[111.838384] Dynamic subtest pipe-A-plane-0: SUCCESS (0.589s)
[111.846820] Starting dynamic subtest: pipe-A-plane-3
[112.227151] Dynamic subtest pipe-A-plane-3: SUCCESS (0.389s)
[113.313844] Starting dynamic subtest: pipe-B-plane-0
[113.957461] Dynamic subtest pipe-B-plane-0: SUCCESS (0.655s)
[113.970678] Starting dynamic subtest: pipe-B-plane-3
[114.390083] Dynamic subtest pipe-B-plane-3: SUCCESS (0.432s)
[114.688599] Subtest pixel-format-x-tiled-modifier-source-clamping: SUCCESS (3.456s)
[115.476406] [016/133] (904s left) syncobj_timeline (single-wait-for-submit-available-signaled)
[115.529097] Starting subtest: single-wait-for-submit-available-signaled
[115.531505] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.000s)
[115.636020] [017/133] (904s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[115.730702] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[115.734698] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[115.843642] [018/133] (904s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode)
[116.249483] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s)
[117.088166] [019/133] (903s left) kms_pm_rpm (dpms-mode-unset-lpsp)
[119.056871] Starting subtest: dpms-mode-unset-lpsp
[123.102639] Subtest dpms-mode-unset-lpsp: SUCCESS (4.047s)
[123.479062] [020/133] (896s left) kms_big_fb (yf-tiled-addfb)
[123.573963] Starting subtest: yf-tiled-addfb
[123.578610] Subtest yf-tiled-addfb: SKIP (0.000s)
[123.686466] [021/133] (896s left) gem_pxp (fail-invalid-protected-context)
[123.806075] Starting subtest: fail-invalid-protected-context
[123.808427] Subtest fail-invalid-protected-context: SUCCESS (0.000s)
[123.917651] [022/133] (896s left) kms_atomic_interruptible (legacy-cursor)
[124.009578] Starting subtest: legacy-cursor
[124.011825] Starting dynamic subtest: pipe-A-eDP-1
[131.387263] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.377s)
[131.389748] Subtest legacy-cursor: SUCCESS (7.378s)
[132.237221] [023/133] (888s left) kms_frontbuffer_tracking (fbc-1p-shrfb-fliptrack-mmap-gtt)
[132.338228] Starting subtest: fbc-1p-shrfb-fliptrack-mmap-gtt
[132.342187] Subtest fbc-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[132.431657] [024/133] (887s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-mc-ccs)
[132.514619] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-mc-ccs
[132.516735] Starting dynamic subtest: pipe-A-eDP-1
[132.538831] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[132.551322] Starting dynamic subtest: pipe-B-eDP-1
[132.573496] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[132.583753] Starting dynamic subtest: pipe-C-eDP-1
[132.604359] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[132.611501] Starting dynamic subtest: pipe-D-eDP-1
[132.632596] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[132.636725] Subtest crc-primary-rotation-180-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[134.712224] [025/133] (885s left) gem_exec_fence (expired-history)
[135.135126] Starting subtest: expired-history
[142.676666] Subtest expired-history: SUCCESS (7.541s)
[143.331158] [026/133] (877s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-signaled)
[143.391047] Starting subtest: multi-wait-all-for-submit-unsubmitted-signaled
[143.499753] Subtest multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.107s)
[143.579859] [027/133] (876s left) gem_ctx_engines (execute-allforone)
[143.648709] Starting subtest: execute-allforone
[143.674814] Subtest execute-allforone: SUCCESS (0.026s)
[144.998564] [028/133] (875s left) gem_lmem_swapping (heavy-random)
[145.054887] Subtest heavy-random: SKIP (0.000s)
[145.103167] [029/133] (875s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[145.376276] Starting subtest: cursor-rapid-movement-512x512
[145.380480] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[145.528978] [030/133] (875s left) kms_getfb (getfb2-accept-nv12)
[145.627679] Starting subtest: getfb2-accept-nv12
[145.629953] Subtest getfb2-accept-nv12: SUCCESS (0.001s)
[145.734625] [031/133] (874s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[145.840236] Starting subtest: basic-flip-before-cursor-atomic
[146.762953] Subtest basic-flip-before-cursor-atomic: SUCCESS (0.923s)
[147.642880] [032/133] (872s left) gem_render_copy (x-tiled-to-vebox-yf-tiled)
[147.699520] Starting subtest: x-tiled-to-vebox-yf-tiled
[147.703808] Subtest x-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[147.895593] [033/133] (872s left) kms_pipe_stress (stress-xrgb8888-4tiled)
[147.977262] Starting subtest: stress-xrgb8888-4tiled
[153.858333] Subtest stress-xrgb8888-4tiled: SUCCESS (5.882s)
[153.907458] [034/133] (866s left) gem_exec_suspend (basic)
[153.962392] Starting subtest: basic
[153.964280] Starting dynamic subtest: smem
[155.927320] Dynamic subtest smem: SUCCESS (1.962s)
[155.930044] Subtest basic: SUCCESS (1.964s)
[156.099007] [035/133] (864s left) i915_hangman (engine-engine-error)
[156.170263] Starting subtest: engine-engine-error
[156.172555] Starting dynamic subtest: rcs0
[157.877838] Dynamic subtest rcs0: SUCCESS (1.705s)
[157.888908] Starting dynamic subtest: bcs0
[159.861103] Dynamic subtest bcs0: SUCCESS (1.982s)
[159.871745] Starting dynamic subtest: vcs0
[161.909717] Dynamic subtest vcs0: SUCCESS (2.046s)
[161.921063] Starting dynamic subtest: vcs1
[163.892522] Dynamic subtest vcs1: SUCCESS (1.981s)
[163.906043] Starting dynamic subtest: vecs0
[165.877071] Dynamic subtest vecs0: SUCCESS (1.983s)
[165.889493] Starting dynamic subtest: ccs0
[167.860327] Dynamic subtest ccs0: SUCCESS (1.981s)
[167.863085] Subtest engine-engine-error: SUCCESS (11.689s)
[167.946512] [036/133] (852s left) perf (oa-formats)
[168.069474] Starting subtest: oa-formats
[168.071711] Starting dynamic subtest: 0-rcs0
[168.083449] Dynamic subtest 0-rcs0: SUCCESS (0.016s)
[168.093820] Starting dynamic subtest: 1-vcs1
[168.105453] Dynamic subtest 1-vcs1: SUCCESS (0.021s)
[168.107784] Subtest oa-formats: SUCCESS (0.038s)
[168.145478] [037/133] (852s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-ccs)
[168.204854] Starting subtest: y-tiled-ccs-to-yf-tiled-ccs
[168.210260] Subtest y-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[168.395808] [038/133] (852s left) kms_cursor_legacy (cursora-vs-flipb-toggle)
[168.488092] Starting subtest: cursorA-vs-flipB-toggle
[168.492215] Subtest cursorA-vs-flipB-toggle: SKIP (0.001s)
[168.564540] [039/133] (852s left) gem_softpin (zero)
[168.616891] Starting subtest: zero
[168.621315] Subtest zero: SUCCESS (0.006s)
[168.737487] [040/133] (852s left) kms_invalid_mode (bad-hsync-start)
[168.831873] Starting subtest: bad-hsync-start
[168.834013] Starting dynamic subtest: pipe-A-eDP-1
[169.135083] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.304s)
[169.145272] Starting dynamic subtest: pipe-B-eDP-1
[169.147480] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[169.155585] Starting dynamic subtest: pipe-C-eDP-1
[169.157412] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[169.164592] Starting dynamic subtest: pipe-D-eDP-1
[169.166795] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[169.169048] Subtest bad-hsync-start: SUCCESS (0.308s)
[169.973750] [041/133] (851s left) kms_flip (modeset-vs-vblank-race)
[170.068054] Starting subtest: modeset-vs-vblank-race
[170.070452] Starting dynamic subtest: A-eDP1
[174.783059] Dynamic subtest A-eDP1: SUCCESS (4.716s)
[174.792936] Starting dynamic subtest: B-eDP1
[179.420208] Dynamic subtest B-eDP1: SUCCESS (4.635s)
[179.428291] Starting dynamic subtest: C-eDP1
[184.139139] Dynamic subtest C-eDP1: SUCCESS (4.717s)
[184.148928] Starting dynamic subtest: D-eDP1
[188.791464] Dynamic subtest D-eDP1: SUCCESS (4.650s)
[188.793812] Subtest modeset-vs-vblank-race: SUCCESS (18.729s)
[189.945720] [042/133] (831s left) gem_wait (invalid-flags)
[189.993916] Starting subtest: invalid-flags
[189.996197] Subtest invalid-flags: SUCCESS (0.000s)
[190.210406] [043/133] (830s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-wc)
[190.307164] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-wc
[194.620843] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (4.317s)
[195.752933] [044/133] (825s left) gem_exec_fence (syncobj-timeline-signal)
[196.311566] Starting subtest: syncobj-timeline-signal
[196.318611] Subtest syncobj-timeline-signal: SUCCESS (0.009s)
[197.976760] [045/133] (823s left) kms_psr (pr-cursor-plane-move)
[198.068071] Starting subtest: pr-cursor-plane-move
[198.072074] Subtest pr-cursor-plane-move: SKIP (0.000s)
[198.143032] [046/133] (823s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[198.245180] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[198.249413] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[198.346109] [047/133] (822s left) sysfs_timeslice_duration (idempotent)
[198.414973] Starting subtest: idempotent
[198.417368] Starting dynamic subtest: vecs0
[198.419603] Dynamic subtest vecs0: SUCCESS (0.001s)
[198.428398] Starting dynamic subtest: ccs0
[198.430708] Dynamic subtest ccs0: SUCCESS (0.001s)
[198.438339] Starting dynamic subtest: vcs0
[198.440506] Dynamic subtest vcs0: SUCCESS (0.001s)
[198.447854] Starting dynamic subtest: bcs0
[198.450097] Dynamic subtest bcs0: SUCCESS (0.001s)
[198.457370] Starting dynamic subtest: rcs0
[198.459607] Dynamic subtest rcs0: SUCCESS (0.001s)
[198.467156] Starting dynamic subtest: vcs1
[198.469352] Dynamic subtest vcs1: SUCCESS (0.001s)
[198.471565] Subtest idempotent: SUCCESS (0.019s)
[198.541013] [048/133] (822s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[198.634687] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[198.638878] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[198.734385] [049/133] (822s left) kms_draw_crc (draw-method-blt)
[198.840139] Starting subtest: draw-method-blt
[198.842315] Starting dynamic subtest: xrgb8888-untiled
[199.077100] Dynamic subtest xrgb8888-untiled: SUCCESS (0.239s)
[199.084954] Starting dynamic subtest: rgb565-untiled
[199.266366] Dynamic subtest rgb565-untiled: SUCCESS (0.188s)
[199.273530] Starting dynamic subtest: xrgb2101010-untiled
[199.455051] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.188s)
[199.463599] Starting dynamic subtest: xbgr16161616f-untiled
[199.644186] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.188s)
[199.652066] Starting dynamic subtest: xrgb8888-xtiled
[199.755193] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.111s)
[199.765141] Starting dynamic subtest: rgb565-xtiled
[199.877330] Dynamic subtest rgb565-xtiled: SUCCESS (0.120s)
[199.886327] Starting dynamic subtest: xrgb2101010-xtiled
[199.966284] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.088s)
[199.974153] Starting dynamic subtest: xbgr16161616f-xtiled
[200.054997] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.088s)
[200.064933] Starting dynamic subtest: xrgb8888-4tiled
[200.166224] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.109s)
[200.176606] Starting dynamic subtest: rgb565-4tiled
[200.277186] Dynamic subtest rgb565-4tiled: SUCCESS (0.110s)
[200.285708] Starting dynamic subtest: xrgb2101010-4tiled
[200.366132] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.087s)
[200.373864] Starting dynamic subtest: xbgr16161616f-4tiled
[200.466258] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.098s)
[200.468117] Subtest draw-method-blt: SUCCESS (1.629s)
[200.582060] [050/133] (820s left) kms_color (deep-color)
[200.690573] Starting subtest: deep-color
[201.814314] Starting dynamic subtest: pipe-A-eDP-1-gamma
[202.505178] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.691s)
[202.513738] Starting dynamic subtest: pipe-A-eDP-1-degamma
[203.887515] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.382s)
[203.896895] Starting dynamic subtest: pipe-A-eDP-1-ctm
[205.297743] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.409s)
[206.122889] Starting dynamic subtest: pipe-B-eDP-1-gamma
[206.798163] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.681s)
[206.807084] Starting dynamic subtest: pipe-B-eDP-1-degamma
[208.157499] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.358s)
[208.166650] Starting dynamic subtest: pipe-B-eDP-1-ctm
[209.610735] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.451s)
[210.411340] Starting dynamic subtest: pipe-C-eDP-1-gamma
[211.100910] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.696s)
[211.109742] Starting dynamic subtest: pipe-C-eDP-1-degamma
[212.459229] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.356s)
[212.467799] Starting dynamic subtest: pipe-C-eDP-1-ctm
[213.890573] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.433s)
[214.698301] Starting dynamic subtest: pipe-D-eDP-1-gamma
[215.382517] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.692s)
[215.391739] Starting dynamic subtest: pipe-D-eDP-1-degamma
[216.754907] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.372s)
[216.763841] Starting dynamic subtest: pipe-D-eDP-1-ctm
[218.159237] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.401s)
[218.161185] Subtest deep-color: SUCCESS (17.466s)
[219.036438] [051/133] (802s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-upscaling)
[219.144118] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-upscaling
[219.148148] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-upscaling: SKIP (0.000s)
[219.232838] [052/133] (802s left) gem_mmap_gtt (medium-copy)
[219.300959] Subtest medium-copy: SKIP (0.000s)
[219.376178] [053/133] (802s left) kms_psr (psr-dpms)
[219.464040] Starting subtest: psr-dpms
[219.466308] Starting dynamic subtest: eDP-1
[222.477472] Dynamic subtest eDP-1: SUCCESS (3.014s)
[222.479786] Subtest psr-dpms: SUCCESS (3.015s)
[223.336413] [054/133] (798s left) syncobj_timeline (invalid-wait-illegal-handle)
[223.393136] Starting subtest: invalid-wait-illegal-handle
[223.395527] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s)
[223.506767] [055/133] (798s left) kms_pm_rpm (system-suspend-idle)
[225.036639] Starting subtest: system-suspend-idle
[245.159807] Subtest system-suspend-idle: SUCCESS (4.456s)
[245.534848] [056/133] (776s left) kms_big_fb (4-tiled-addfb-size-overflow)
[245.664127] Starting subtest: 4-tiled-addfb-size-overflow
[245.666603] Subtest 4-tiled-addfb-size-overflow: SUCCESS (0.000s)
[245.756016] [057/133] (775s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[245.847053] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[252.756397] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (7.039s)
[252.856124] [058/133] (768s left) kms_plane (plane-position-covered)
[252.953119] Starting subtest: plane-position-covered
[253.474673] Starting dynamic subtest: pipe-A-plane-1
[254.724957] Dynamic subtest pipe-A-plane-1: SUCCESS (1.264s)
[254.734192] Starting dynamic subtest: pipe-A-plane-2
[255.954689] Dynamic subtest pipe-A-plane-2: SUCCESS (1.239s)
[255.966065] Starting dynamic subtest: pipe-A-plane-3
[257.164631] Dynamic subtest pipe-A-plane-3: SUCCESS (1.219s)
[257.174809] Starting dynamic subtest: pipe-A-plane-4
[258.415377] Dynamic subtest pipe-A-plane-4: SUCCESS (1.255s)
[258.425938] Starting dynamic subtest: pipe-A-plane-5
[258.441963] Dynamic subtest pipe-A-plane-5: SUCCESS (0.025s)
[259.552565] Starting dynamic subtest: pipe-B-plane-1
[260.770212] Dynamic subtest pipe-B-plane-1: SUCCESS (1.229s)
[260.780024] Starting dynamic subtest: pipe-B-plane-2
[261.981755] Dynamic subtest pipe-B-plane-2: SUCCESS (1.217s)
[261.992013] Starting dynamic subtest: pipe-B-plane-3
[263.200248] Dynamic subtest pipe-B-plane-3: SUCCESS (1.223s)
[263.210222] Starting dynamic subtest: pipe-B-plane-4
[264.435267] Dynamic subtest pipe-B-plane-4: SUCCESS (1.237s)
[264.445931] Starting dynamic subtest: pipe-B-plane-5
[264.463395] Dynamic subtest pipe-B-plane-5: SUCCESS (0.026s)
[264.466452] Subtest plane-position-covered: SUCCESS (11.577s)
[265.229601] [059/133] (756s left) gem_exec_whisper (basic-contexts-all)
[265.299103] Starting subtest: basic-contexts-all
[276.583587] Subtest basic-contexts-all: SUCCESS (11.293s)
[276.773731] [060/133] (744s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-msflip-blt)
[276.881517] Starting subtest: psr-2p-scndscrn-shrfb-msflip-blt
[276.886399] Subtest psr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[276.994721] [061/133] (744s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-render)
[277.093896] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-render
[277.099049] Subtest fbc-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[277.211256] [062/133] (744s left) kms_joiner (invalid-modeset-ultra-joiner)
[277.313276] Starting subtest: invalid-modeset-ultra-joiner
[277.318119] Subtest invalid-modeset-ultra-joiner: SKIP (0.000s)
[277.381732] [063/133] (744s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[277.473365] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[277.478345] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[277.595185] [064/133] (744s left) gem_bad_reloc (negative-reloc-lut)
[277.656249] Subtest negative-reloc-lut: SKIP (0.000s)
[277.735540] [065/133] (744s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-move)
[277.833445] Starting subtest: fbc-2p-scndscrn-spr-indfb-move
[277.837634] Subtest fbc-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[277.942813] [066/133] (744s left) syncobj_timeline (multi-wait-for-submit-signaled)
[277.998133] Starting subtest: multi-wait-for-submit-signaled
[278.000380] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[278.104883] [067/133] (743s left) gem_mmap_offset (partial-remap)
[278.155276] Starting subtest: partial-remap
[278.157395] Starting dynamic subtest: smem0
[278.166287] Dynamic subtest smem0: SUCCESS (0.004s)
[278.168323] Subtest partial-remap: SUCCESS (0.005s)
[278.262762] [068/133] (743s left) gem_mmap_gtt (cpuset-basic-small-copy)
[278.325107] Subtest cpuset-basic-small-copy: SKIP (0.000s)
[278.382629] [069/133] (743s left) kms_frontbuffer_tracking (fbc-tiling-4)
[278.468384] Starting subtest: fbc-tiling-4
[282.715723] Subtest fbc-tiling-4: SUCCESS (4.248s)
[283.931863] [070/133] (738s left) kms_cursor_crc (cursor-offscreen-32x10)
[284.102088] Starting subtest: cursor-offscreen-32x10
[284.155434] Subtest cursor-offscreen-32x10: SKIP (0.048s)
[284.438140] [071/133] (737s left) kms_psr (fbc-psr2-primary-mmap-cpu)
[284.530581] Starting subtest: fbc-psr2-primary-mmap-cpu
[284.533062] Starting dynamic subtest: eDP-1
[284.538254] Dynamic subtest eDP-1: SKIP (0.000s)
[284.543453] Subtest fbc-psr2-primary-mmap-cpu: SKIP (0.001s)
[284.613750] [072/133] (737s left) perf_pmu (idle)
[284.665046] Starting subtest: idle
[284.667225] Starting dynamic subtest: rcs0
[285.214841] Dynamic subtest rcs0: SUCCESS (0.549s)
[285.225413] Starting dynamic subtest: bcs0
[285.730870] Dynamic subtest bcs0: SUCCESS (0.513s)
[285.742994] Starting dynamic subtest: vcs0
[286.257298] Dynamic subtest vcs0: SUCCESS (0.524s)
[286.269120] Starting dynamic subtest: vcs1
[286.774706] Dynamic subtest vcs1: SUCCESS (0.514s)
[286.787440] Starting dynamic subtest: vecs0
[287.295567] Dynamic subtest vecs0: SUCCESS (0.518s)
[287.308001] Starting dynamic subtest: ccs0
[287.823703] Dynamic subtest ccs0: SUCCESS (0.525s)
[287.826968] Subtest idle: SUCCESS (3.160s)
[287.924679] [073/133] (734s left) syncobj_wait (single-wait-all-for-submit-signaled)
[287.985290] Starting subtest: single-wait-all-for-submit-signaled
[287.988199] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[288.095613] [074/133] (734s left) kms_big_fb (x-tiled-64bpp-rotate-90)
[288.191137] Starting subtest: x-tiled-64bpp-rotate-90
[288.226723] Subtest x-tiled-64bpp-rotate-90: SKIP (0.035s)
[288.333235] [075/133] (734s left) api_intel_allocator (default-alignment)
[288.384067] Starting subtest: default-alignment
[288.386597] Subtest default-alignment: SUCCESS (0.004s)
[288.503792] [076/133] (733s left) gem_ctx_shared (q-out-order)
[288.569217] Starting subtest: Q-out-order
[288.572235] Starting dynamic subtest: rcs0
[288.695176] Dynamic subtest rcs0: SUCCESS (0.124s)
[288.706398] Starting dynamic subtest: vcs0
[288.796582] Dynamic subtest vcs0: SUCCESS (0.102s)
[288.814180] Starting dynamic subtest: vcs1
[288.879667] Dynamic subtest vcs1: SUCCESS (0.082s)
[288.897184] Starting dynamic subtest: vecs0
[288.963444] Dynamic subtest vecs0: SUCCESS (0.083s)
[288.980920] Starting dynamic subtest: ccs0
[289.053860] Dynamic subtest ccs0: SUCCESS (0.090s)
[289.056418] Subtest Q-out-order: SUCCESS (0.485s)
[290.733860] [077/133] (731s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[290.843421] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[290.848239] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[290.938018] [078/133] (731s left) syncobj_timeline (etime-multi-wait-all-submitted)
[290.995407] Starting subtest: etime-multi-wait-all-submitted
[291.097788] Subtest etime-multi-wait-all-submitted: SUCCESS (0.103s)
[291.211891] [079/133] (731s left) perf (gen12-invalid-class-instance)
[291.301400] Starting subtest: gen12-invalid-class-instance
[291.312715] Subtest gen12-invalid-class-instance: SUCCESS (0.008s)
[291.361461] [080/133] (731s left) kms_cursor_legacy (single-move)
[291.465216] Starting subtest: single-move
[291.467680] Starting dynamic subtest: pipe-A
[296.845695] Dynamic subtest pipe-A: SUCCESS (5.379s)
[296.857382] Starting dynamic subtest: pipe-B
[302.227229] Dynamic subtest pipe-B: SUCCESS (5.380s)
[302.238043] Starting dynamic subtest: pipe-C
[307.609304] Dynamic subtest pipe-C: SUCCESS (5.379s)
[307.620126] Starting dynamic subtest: pipe-D
[312.988058] Dynamic subtest pipe-D: SUCCESS (5.379s)
[313.017266] Starting dynamic subtest: all-pipes
[318.369574] Dynamic subtest all-pipes: SUCCESS (5.380s)
[318.372556] Subtest single-move: SUCCESS (26.909s)
[318.443103] [081/133] (704s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-pwrite)
[318.560807] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-pwrite
[327.402276] Subtest psr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.848s)
[327.504819] [082/133] (695s left) gem_pwrite_snooped
[327.644306] [083/133] (695s left) kms_cursor_legacy (cursorb-vs-flipb-toggle)
[327.743235] Starting subtest: cursorB-vs-flipB-toggle
[327.748096] Subtest cursorB-vs-flipB-toggle: SKIP (0.002s)
[327.832729] [084/133] (694s left) gem_mmap_gtt (basic-write-read-distinct)
[327.894216] Subtest basic-write-read-distinct: SKIP (0.000s)
[327.968899] [085/133] (694s left) syncobj_wait (reset-multiple-signaled)
[328.029424] Starting subtest: reset-multiple-signaled
[328.032181] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[328.111059] [086/133] (694s left) kms_concurrent (multi-plane-atomic-lowres)
[328.200339] Starting subtest: multi-plane-atomic-lowres
[328.203060] Starting dynamic subtest: pipe-A-eDP-1
[328.717121] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.516s)
[328.727456] Starting dynamic subtest: pipe-B-eDP-1
[329.984423] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.265s)
[329.993986] Starting dynamic subtest: pipe-C-eDP-1
[331.182388] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.197s)
[331.192190] Starting dynamic subtest: pipe-D-eDP-1
[332.418450] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.238s)
[332.421400] Subtest multi-plane-atomic-lowres: SUCCESS (4.221s)
[333.262857] [087/133] (689s left) api_intel_bb (object-noreloc-keep-cache-simple)
[333.317405] Starting subtest: object-noreloc-keep-cache-simple
[333.320372] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.005s)
[333.445035] [088/133] (689s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs)
[333.528397] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs
[333.531133] Starting dynamic subtest: pipe-A-eDP-1
[333.558731] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[333.572419] Starting dynamic subtest: pipe-B-eDP-1
[333.597967] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[333.606285] Starting dynamic subtest: pipe-C-eDP-1
[333.631949] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[333.642014] Starting dynamic subtest: pipe-D-eDP-1
[333.668501] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[333.673345] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs: SKIP (0.006s)
[335.815891] [089/133] (687s left) kms_big_fb (linear-8bpp-rotate-90)
[335.924406] Starting subtest: linear-8bpp-rotate-90
[335.973142] Subtest linear-8bpp-rotate-90: SKIP (0.047s)
[336.110857] [090/133] (686s left) i915_drm_fdinfo (busy)
[336.148800] Starting subtest: busy
[336.151222] Starting dynamic subtest: rcs0
[336.178146] Dynamic subtest rcs0: SKIP (0.028s)
[336.187275] Starting dynamic subtest: bcs0
[336.192650] Dynamic subtest bcs0: SKIP (0.000s)
[336.201427] Starting dynamic subtest: vcs0
[336.206282] Dynamic subtest vcs0: SKIP (0.000s)
[336.215241] Starting dynamic subtest: vcs1
[336.220386] Dynamic subtest vcs1: SKIP (0.000s)
[336.229099] Starting dynamic subtest: vecs0
[336.234217] Dynamic subtest vecs0: SKIP (0.000s)
[336.243391] Starting dynamic subtest: ccs0
[336.249033] Dynamic subtest ccs0: SKIP (0.000s)
[336.254223] Subtest busy: SKIP (0.032s)
[336.292655] [091/133] (686s left) kms_cursor_edge_walk (64x64-right-edge)
[336.383441] Starting subtest: 64x64-right-edge
[336.385819] Starting dynamic subtest: pipe-A-eDP-1
[339.893890] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.511s)
[339.903162] Starting dynamic subtest: pipe-D-eDP-1
[343.094345] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.196s)
[343.097242] Subtest 64x64-right-edge: SUCCESS (6.710s)
[343.907681] [092/133] (679s left) gem_exec_reloc (basic-cpu-gtt-active)
[343.969193] Subtest basic-cpu-gtt-active: SKIP (0.000s)
[344.028434] [093/133] (679s left) gem_exec_params (batch-first)
[344.083474] Starting subtest: batch-first
[344.090172] Subtest batch-first: SUCCESS (0.007s)
[344.192985] [094/133] (679s left) kms_chamelium_edid (dp-edid-change-during-suspend)
[344.591051] Subtest dp-edid-change-during-suspend: SKIP (0.000s)
[345.412433] [095/133] (677s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-pwrite)
[345.519527] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-pwrite
[345.524654] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[345.625840] [096/133] (677s left) core_getversion (basic)
[345.669381] Starting subtest: basic
[345.674632] Subtest basic: SUCCESS (0.000s)
[345.730690] [097/133] (677s left) kms_chamelium_color (ctm-max)
[345.816160] Subtest ctm-max: SKIP (0.000s)
[345.868829] [098/133] (677s left) prime_mmap (test_userptr)
[345.926385] Starting subtest: test_userptr
[345.928946] Starting dynamic subtest: test_userptr-smem
[345.931180] Dynamic subtest test_userptr-smem: SUCCESS (0.000s)
[345.933700] Subtest test_userptr: SUCCESS (0.001s)
[346.019684] [099/133] (677s left) gem_ctx_persistence (userptr)
[346.070456] Starting subtest: userptr
[346.257074] Subtest userptr: SUCCESS (0.187s)
[346.354534] [100/133] (677s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-msflip-blt)
[346.461893] Starting subtest: fbcpsr-2p-primscrn-shrfb-msflip-blt
[346.465961] Subtest fbcpsr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[346.568753] [101/133] (676s left) kms_flip (flip-vs-panning-interruptible)
[346.670566] Starting subtest: flip-vs-panning-interruptible
[346.672700] Starting dynamic subtest: A-eDP1
[355.350615] Dynamic subtest A-eDP1: SUCCESS (8.676s)
[355.362385] Starting dynamic subtest: B-eDP1
[364.071644] Dynamic subtest B-eDP1: SUCCESS (8.716s)
[364.081010] Starting dynamic subtest: C-eDP1
[372.790264] Dynamic subtest C-eDP1: SUCCESS (8.717s)
[372.800008] Starting dynamic subtest: D-eDP1
[381.523385] Dynamic subtest D-eDP1: SUCCESS (8.730s)
[381.528269] Subtest flip-vs-panning-interruptible: SUCCESS (34.852s)
[382.687572] [102/133] (640s left) kms_flip (plain-flip-fb-recreate)
[382.786914] Starting subtest: plain-flip-fb-recreate
[382.789263] Starting dynamic subtest: A-eDP1
[391.684140] Dynamic subtest A-eDP1: SUCCESS (8.902s)
[391.693114] Starting dynamic subtest: B-eDP1
[400.527671] Dynamic subtest B-eDP1: SUCCESS (8.844s)
[400.537430] Starting dynamic subtest: C-eDP1
[409.445692] Dynamic subtest C-eDP1: SUCCESS (8.919s)
[409.455576] Starting dynamic subtest: D-eDP1
[418.273664] Dynamic subtest D-eDP1: SUCCESS (8.827s)
[418.278843] Subtest plain-flip-fb-recreate: SUCCESS (35.501s)
[419.448630] [103/133] (604s left) kms_psr2_sf (psr2-cursor-plane-update-sf)
[419.550557] Starting subtest: psr2-cursor-plane-update-sf
[419.552952] Starting dynamic subtest: pipe-A-eDP-1
[420.917225] Dynamic subtest pipe-A-eDP-1: FAIL (0.664s)
[420.927839] Starting dynamic subtest: pipe-B-eDP-1
[422.586022] Dynamic subtest pipe-B-eDP-1: FAIL (1.665s)
[422.588312] Subtest psr2-cursor-plane-update-sf: FAIL (2.332s)
[423.113934] [104/133] (600s left) gen7_exec_parse (basic-allowed)
[423.172886] Subtest basic-allowed: SKIP (0.000s)
[423.252705] [105/133] (600s left) gem_exec_reloc (basic-wc-gtt)
[423.310277] Subtest basic-wc-gtt: SKIP (0.000s)
[423.387889] [106/133] (600s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[423.481797] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-gtt
[423.487191] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[423.585777] [107/133] (600s left) kms_pwrite_crc
[425.151771] [108/133] (598s left) kms_psr (fbc-psr-primary-mmap-gtt)
[425.245021] Starting subtest: fbc-psr-primary-mmap-gtt
[425.247404] Starting dynamic subtest: eDP-1
[425.251871] Dynamic subtest eDP-1: SKIP (0.000s)
[425.256390] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.001s)
[425.334288] [109/133] (598s left) gem_ctx_isolation (dirty-switch)
[425.398220] Starting subtest: dirty-switch
[425.400698] Starting dynamic subtest: rcs0
[425.605278] Dynamic subtest rcs0: SUCCESS (0.210s)
[425.614899] Starting dynamic subtest: bcs0
[425.834361] Dynamic subtest bcs0: SUCCESS (0.228s)
[425.843765] Starting dynamic subtest: vcs0
[426.019702] Dynamic subtest vcs0: SUCCESS (0.184s)
[426.031833] Starting dynamic subtest: vcs1
[427.846733] Dynamic subtest vcs1: SUCCESS (1.826s)
[427.858055] Starting dynamic subtest: vecs0
[429.848963] Dynamic subtest vecs0: SUCCESS (2.002s)
[429.860070] Starting dynamic subtest: ccs0
[431.842280] Dynamic subtest ccs0: SUCCESS (1.993s)
[431.845315] Subtest dirty-switch: SUCCESS (6.449s)
[432.083520] [110/133] (591s left) gem_ctx_param (set-priority-not-supported)
[432.137864] Starting subtest: set-priority-not-supported
[432.143101] Subtest set-priority-not-supported: SKIP (0.000s)
[432.220224] [111/133] (591s left) kms_plane_scaling (plane-upscale-factor-0-25-with-rotation)
[432.320059] Starting subtest: plane-upscale-factor-0-25-with-rotation
[432.322654] Starting dynamic subtest: pipe-A
[432.594266] Dynamic subtest pipe-A: SUCCESS (0.276s)
[432.603406] Starting dynamic subtest: pipe-B
[433.958255] Dynamic subtest pipe-B: SUCCESS (1.364s)
[433.967401] Starting dynamic subtest: pipe-C
[435.262990] Dynamic subtest pipe-C: SUCCESS (1.304s)
[435.271838] Starting dynamic subtest: pipe-D
[436.595831] Dynamic subtest pipe-D: SUCCESS (1.332s)
[436.598144] Subtest plane-upscale-factor-0-25-with-rotation: SUCCESS (4.280s)
[437.779883] [112/133] (586s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180)
[437.884395] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180
[438.921103] Subtest x-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.038s)
[439.034810] [113/133] (584s left) sw_sync (sync_busy)
[439.076140] Starting subtest: sync_busy
[439.079056] Subtest sync_busy: SUCCESS (0.002s)
[439.141470] [114/133] (584s left) i915_pm_rpm (debugfs-forcewake-user)
[440.795737] Starting subtest: debugfs-forcewake-user
[452.193563] Subtest debugfs-forcewake-user: SUCCESS (11.404s)
[452.588251] [115/133] (571s left) gem_exec_schedule (u-semaphore-codependency)
[452.660666] Starting subtest: u-semaphore-codependency
[452.666183] Subtest u-semaphore-codependency: SUCCESS (0.012s)
[452.999623] [116/133] (571s left) kms_ccs (missing-ccs-buffer-y-tiled-gen12-mc-ccs)
[453.089674] Starting subtest: missing-ccs-buffer-y-tiled-gen12-mc-ccs
[453.091938] Starting dynamic subtest: pipe-A-eDP-1
[453.114812] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[453.124404] Starting dynamic subtest: pipe-B-eDP-1
[453.146409] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[453.154786] Starting dynamic subtest: pipe-C-eDP-1
[453.177430] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[453.185785] Starting dynamic subtest: pipe-D-eDP-1
[453.209205] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[453.213341] Subtest missing-ccs-buffer-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[455.350473] [117/133] (568s left) kms_ccs (bad-rotation-90-yf-tiled-ccs)
[455.439809] Starting subtest: bad-rotation-90-yf-tiled-ccs
[455.442138] Starting dynamic subtest: pipe-A-eDP-1
[455.465350] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[455.476253] Starting dynamic subtest: pipe-B-eDP-1
[455.501171] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[455.510624] Starting dynamic subtest: pipe-C-eDP-1
[455.537143] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[455.548141] Starting dynamic subtest: pipe-D-eDP-1
[455.573389] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[455.578230] Subtest bad-rotation-90-yf-tiled-ccs: SKIP (0.004s)
[457.643606] [118/133] (566s left) kms_addfb_basic (bad-pitch-256)
[457.704774] Starting subtest: bad-pitch-256
[457.706746] Subtest bad-pitch-256: SUCCESS (0.000s)
[457.851521] [119/133] (566s left) kms_flip (2x-flip-vs-modeset-vs-hang)
[457.937808] Starting subtest: 2x-flip-vs-modeset-vs-hang
[457.946728] Subtest 2x-flip-vs-modeset-vs-hang: SKIP (0.011s)
[458.027968] [120/133] (566s left) gem_exec_schedule (manyslice)
[458.104127] Starting subtest: manyslice
[458.106923] Starting dynamic subtest: rcs0
[463.741986] Dynamic subtest rcs0: SUCCESS (5.652s)
[463.757187] Starting dynamic subtest: bcs0
[470.896860] Dynamic subtest bcs0: SUCCESS (7.149s)
[470.906951] Starting dynamic subtest: vcs0
[477.006812] Dynamic subtest vcs0: SUCCESS (6.109s)
[477.021861] Starting dynamic subtest: vcs1
[483.106265] Dynamic subtest vcs1: SUCCESS (6.096s)
[483.115543] Starting dynamic subtest: vecs0
[489.715418] Dynamic subtest vecs0: SUCCESS (6.605s)
[489.726222] Starting dynamic subtest: ccs0
[495.382135] Dynamic subtest ccs0: SUCCESS (5.664s)
[495.385105] Subtest manyslice: SUCCESS (37.286s)
[495.693493] [121/133] (528s left) kms_async_flips (crc-atomic)
[495.791249] Starting subtest: crc-atomic
[496.169324] Starting dynamic subtest: pipe-A-eDP-1
[499.035704] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.864s)
[499.413033] Starting dynamic subtest: pipe-B-eDP-1
[502.259423] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.852s)
[502.656412] Starting dynamic subtest: pipe-C-eDP-1
[505.512347] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.875s)
[505.881670] Starting dynamic subtest: pipe-D-eDP-1
[508.729919] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.859s)
[508.732458] Subtest crc-atomic: SUCCESS (12.938s)
[509.900426] [122/133] (514s left) kms_flip (flip-vs-dpms-off-vs-modeset-interruptible)
[510.000626] Starting subtest: flip-vs-dpms-off-vs-modeset-interruptible
[510.003227] Starting dynamic subtest: A-eDP1
[513.624801] Dynamic subtest A-eDP1: SUCCESS (3.623s)
[513.634832] Starting dynamic subtest: B-eDP1
[516.808410] Dynamic subtest B-eDP1: SUCCESS (3.182s)
[516.819161] Starting dynamic subtest: C-eDP1
[519.899883] Dynamic subtest C-eDP1: SUCCESS (3.089s)
[519.910826] Starting dynamic subtest: D-eDP1
[522.991253] Dynamic subtest D-eDP1: SUCCESS (3.091s)
[522.994083] Subtest flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (12.993s)
[523.803395] [123/133] (500s left) syncobj_eventfd (invalid-illegal-eventfd)
[523.874695] Starting subtest: invalid-illegal-eventfd
[523.877287] Subtest invalid-illegal-eventfd: SUCCESS (0.000s)
[523.967869] [124/133] (500s left) kms_prop_blob (blob-prop-core)
[524.026417] Starting subtest: blob-prop-core
[524.028915] Subtest blob-prop-core: SUCCESS (0.000s)
[524.142834] [125/133] (500s left) kms_async_flips (alternate-sync-async-flip-atomic)
[524.242193] Starting subtest: alternate-sync-async-flip-atomic
[524.626213] Starting dynamic subtest: pipe-A-eDP-1
[527.393672] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.768s)
[527.774566] Starting dynamic subtest: pipe-B-eDP-1
[530.520397] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.753s)
[530.894267] Starting dynamic subtest: pipe-C-eDP-1
[533.656897] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.770s)
[534.024576] Starting dynamic subtest: pipe-D-eDP-1
[536.785258] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.768s)
[536.787668] Subtest alternate-sync-async-flip-atomic: SUCCESS (12.546s)
[537.963204] [126/133] (486s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-sf)
[538.077177] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-sf
[538.079916] Starting dynamic subtest: pipe-A-eDP-1
[538.177424] Dynamic subtest pipe-A-eDP-1: SKIP (0.105s)
[538.187441] Starting dynamic subtest: pipe-B-eDP-1
[539.341394] Dynamic subtest pipe-B-eDP-1: SKIP (1.160s)
[539.347245] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-sf: SKIP (1.268s)
[540.535809] [127/133] (484s left) gem_eio (wait-10ms)
[540.772989] Starting subtest: wait-10ms
[541.129293] Subtest wait-10ms: SUCCESS (0.355s)
[541.280523] [128/133] (483s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-cpu)
[541.377241] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-cpu
[545.677022] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (4.304s)
[546.840725] [129/133] (477s left) gem_flink_basic (flink-lifetime)
[546.892670] Starting subtest: flink-lifetime
[546.895437] Subtest flink-lifetime: SUCCESS (0.002s)
[547.015281] [130/133] (477s left) gem_exec_reloc (basic-write-wc-noreloc)
[547.070236] Subtest basic-write-wc-noreloc: SKIP (0.000s)
[547.154110] [131/133] (477s left) kms_vblank (wait-forked-hang)
[547.247863] Starting subtest: wait-forked-hang
[547.250349] Starting dynamic subtest: pipe-A-eDP-1
[573.392375] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.147s)
[573.409401] Starting dynamic subtest: pipe-D-eDP-1
[598.408752] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.014s)
[598.411249] Subtest wait-forked-hang: SUCCESS (51.166s)
[599.303368] [132/133] (425s left) kms_frontbuffer_tracking (basic)
[599.398065] Starting subtest: basic
[602.253109] Subtest basic: SUCCESS (2.861s)
[602.360649] [133/133] (422s left) kms_addfb_basic (small-bo)
[602.452183] Starting subtest: small-bo
[602.454555] Subtest small-bo: SUCCESS (0.000s)
[602.559883] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_nop
results: parsing output: 1/ for test: kms_big_fb
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: kms_plane_multiple
results: parsing output: 4/ for test: perf_pmu
results: parsing output: 5/ for test: kms_psr
results: parsing output: 6/ for test: i915_suspend
results: parsing output: 7/ for test: gem_exec_balancer
results: parsing output: 8/ for test: kms_rotation_crc
results: parsing output: 9/ for test: gem_exec_reloc
results: parsing output: 10/ for test: kms_flip_scaled_crc
results: parsing output: 11/ for test: kms_tiled_display
results: parsing output: 12/ for test: gem_exec_fence
results: parsing output: 13/ for test: gen7_exec_parse
results: parsing output: 14/ for test: kms_plane
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: kms_chamelium_hpd
results: parsing output: 18/ for test: kms_pm_rpm
results: parsing output: 19/ for test: kms_big_fb
results: parsing output: 20/ for test: gem_pxp
results: parsing output: 21/ for test: kms_atomic_interruptible
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: kms_ccs
results: parsing output: 24/ for test: gem_exec_fence
results: parsing output: 25/ for test: syncobj_wait
results: parsing output: 26/ for test: gem_ctx_engines
results: parsing output: 27/ for test: gem_lmem_swapping
results: parsing output: 28/ for test: kms_cursor_crc
results: parsing output: 29/ for test: kms_getfb
results: parsing output: 30/ for test: kms_cursor_legacy
results: parsing output: 31/ for test: gem_render_copy
results: parsing output: 32/ for test: kms_pipe_stress
results: parsing output: 33/ for test: gem_exec_suspend
results: parsing output: 34/ for test: i915_hangman
results: parsing output: 35/ for test: perf
results: parsing output: 36/ for test: gem_render_copy
results: parsing output: 37/ for test: kms_cursor_legacy
results: parsing output: 38/ for test: gem_softpin
results: parsing output: 39/ for test: kms_invalid_mode
results: parsing output: 40/ for test: kms_flip
results: parsing output: 41/ for test: gem_wait
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: gem_exec_fence
results: parsing output: 44/ for test: kms_psr
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: sysfs_timeslice_duration
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: kms_draw_crc
results: parsing output: 49/ for test: kms_color
results: parsing output: 50/ for test: kms_flip_scaled_crc
results: parsing output: 51/ for test: gem_mmap_gtt
results: parsing output: 52/ for test: kms_psr
results: parsing output: 53/ for test: syncobj_timeline
results: parsing output: 54/ for test: kms_pm_rpm
results: parsing output: 55/ for test: kms_big_fb
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_plane
results: parsing output: 58/ for test: gem_exec_whisper
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: kms_joiner
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: gem_bad_reloc
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: syncobj_timeline
results: parsing output: 66/ for test: gem_mmap_offset
results: parsing output: 67/ for test: gem_mmap_gtt
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: kms_cursor_crc
results: parsing output: 70/ for test: kms_psr
results: parsing output: 71/ for test: perf_pmu
results: parsing output: 72/ for test: syncobj_wait
results: parsing output: 73/ for test: kms_big_fb
results: parsing output: 74/ for test: api_intel_allocator
results: parsing output: 75/ for test: gem_ctx_shared
results: parsing output: 76/ for test: kms_big_fb
results: parsing output: 77/ for test: syncobj_timeline
results: parsing output: 78/ for test: perf
results: parsing output: 79/ for test: kms_cursor_legacy
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: gem_pwrite_snooped
results: parsing output: 82/ for test: kms_cursor_legacy
results: parsing output: 83/ for test: gem_mmap_gtt
results: parsing output: 84/ for test: syncobj_wait
results: parsing output: 85/ for test: kms_concurrent
results: parsing output: 86/ for test: api_intel_bb
results: parsing output: 87/ for test: kms_ccs
results: parsing output: 88/ for test: kms_big_fb
results: parsing output: 89/ for test: i915_drm_fdinfo
results: parsing output: 90/ for test: kms_cursor_edge_walk
results: parsing output: 91/ for test: gem_exec_reloc
results: parsing output: 92/ for test: gem_exec_params
results: parsing output: 93/ for test: kms_chamelium_edid
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: core_getversion
results: parsing output: 96/ for test: kms_chamelium_color
results: parsing output: 97/ for test: prime_mmap
results: parsing output: 98/ for test: gem_ctx_persistence
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_flip
results: parsing output: 101/ for test: kms_flip
results: parsing output: 102/ for test: kms_psr2_sf
results: parsing output: 103/ for test: gen7_exec_parse
results: parsing output: 104/ for test: gem_exec_reloc
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_pwrite_crc
results: parsing output: 107/ for test: kms_psr
results: parsing output: 108/ for test: gem_ctx_isolation
results: parsing output: 109/ for test: gem_ctx_param
results: parsing output: 110/ for test: kms_plane_scaling
results: parsing output: 111/ for test: kms_big_fb
results: parsing output: 112/ for test: sw_sync
results: parsing output: 113/ for test: i915_pm_rpm
results: parsing output: 114/ for test: gem_exec_schedule
results: parsing output: 115/ for test: kms_ccs
results: parsing output: 116/ for test: kms_ccs
results: parsing output: 117/ for test: kms_addfb_basic
results: parsing output: 118/ for test: kms_flip
results: parsing output: 119/ for test: gem_exec_schedule
results: parsing output: 120/ for test: kms_async_flips
results: parsing output: 121/ for test: kms_flip
results: parsing output: 122/ for test: syncobj_eventfd
results: parsing output: 123/ for test: kms_prop_blob
results: parsing output: 124/ for test: kms_async_flips
results: parsing output: 125/ for test: kms_psr2_sf
results: parsing output: 126/ for test: gem_eio
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: gem_flink_basic
results: parsing output: 129/ for test: gem_exec_reloc
results: parsing output: 130/ for test: kms_vblank
results: parsing output: 131/ for test: kms_frontbuffer_tracking
results: parsing output: 132/ for test: kms_addfb_basic
Done.