[56.932176] Initializing watchdogs
[56.932219]   /dev/watchdog0
[56.945891] [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]
[56.950063] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[56.952171] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[56.955528] [001/133] (960s left) gem_exec_whisper (basic-queues-priority-all)
[57.070350] Starting subtest: basic-queues-priority-all
[79.333991] Subtest basic-queues-priority-all: SUCCESS (22.277s)
[79.513785] [002/133] (937s left) kms_plane (plane-position-hole)
[79.617904] Starting subtest: plane-position-hole
[80.147433] Starting dynamic subtest: pipe-A-plane-1
[81.402059] Dynamic subtest pipe-A-plane-1: SUCCESS (1.253s)
[81.411802] Starting dynamic subtest: pipe-A-plane-2
[82.685816] Dynamic subtest pipe-A-plane-2: SUCCESS (1.287s)
[82.696085] Starting dynamic subtest: pipe-A-plane-3
[84.010619] Dynamic subtest pipe-A-plane-3: SUCCESS (1.323s)
[84.023791] Starting dynamic subtest: pipe-A-plane-4
[85.316260] Dynamic subtest pipe-A-plane-4: SUCCESS (1.308s)
[85.325656] Starting dynamic subtest: pipe-A-plane-5
[85.344831] Dynamic subtest pipe-A-plane-5: SUCCESS (0.027s)
[86.490500] Starting dynamic subtest: pipe-B-plane-1
[87.699623] Dynamic subtest pipe-B-plane-1: SUCCESS (1.221s)
[87.709078] Starting dynamic subtest: pipe-B-plane-2
[88.976532] Dynamic subtest pipe-B-plane-2: SUCCESS (1.277s)
[88.985087] Starting dynamic subtest: pipe-B-plane-3
[90.283398] Dynamic subtest pipe-B-plane-3: SUCCESS (1.307s)
[90.291072] Starting dynamic subtest: pipe-B-plane-4
[91.529854] Dynamic subtest pipe-B-plane-4: SUCCESS (1.247s)
[91.538040] Starting dynamic subtest: pipe-B-plane-5
[91.555422] Dynamic subtest pipe-B-plane-5: SUCCESS (0.025s)
[91.557596] Subtest plane-position-hole: SUCCESS (11.940s)
[92.322682] [003/133] (925s left) kms_big_fb (x-tiled-32bpp-rotate-0)
[92.423327] Starting subtest: x-tiled-32bpp-rotate-0
[93.823494] Subtest x-tiled-32bpp-rotate-0: SUCCESS (1.401s)
[93.963275] [004/133] (923s left) gem_tiled_fence_blits (normal)
[94.025503] Subtest normal: SKIP (0.000s)
[94.077388] [005/133] (923s left) kms_psr (fbc-psr2-primary-page-flip)
[94.154997] Starting subtest: fbc-psr2-primary-page-flip
[94.157222] Starting dynamic subtest: eDP-1
[94.161874] Dynamic subtest eDP-1: SKIP (0.000s)
[94.166236] Subtest fbc-psr2-primary-page-flip: SKIP (0.000s)
[94.223308] [006/133] (923s left) kms_getfb (getfb2-handle-zero)
[94.316447] Starting subtest: getfb2-handle-zero
[94.318384] Subtest getfb2-handle-zero: SUCCESS (0.000s)
[94.439536] [007/133] (923s left) kms_flip (flip-vs-expired-vblank)
[94.541437] Starting subtest: flip-vs-expired-vblank
[94.543205] Starting dynamic subtest: A-eDP1
[103.274606] Dynamic subtest A-eDP1: SUCCESS (8.702s)
[103.283777] Starting dynamic subtest: B-eDP1
[112.002764] Dynamic subtest B-eDP1: SUCCESS (8.727s)
[112.013272] Starting dynamic subtest: C-eDP1
[120.633308] Dynamic subtest C-eDP1: SUCCESS (8.617s)
[120.643612] Starting dynamic subtest: D-eDP1
[129.273176] Dynamic subtest D-eDP1: SUCCESS (8.637s)
[129.275280] Subtest flip-vs-expired-vblank: SUCCESS (34.692s)
[130.404929] [008/133] (887s left) core_auth (getclient-master-drop)
[130.440994] Starting subtest: getclient-master-drop
[130.465689] Subtest getclient-master-drop: SUCCESS (0.026s)
[130.581904] [009/133] (887s left) kms_invalid_mode (uint-max-clock)
[130.683203] Starting subtest: uint-max-clock
[130.685382] Starting dynamic subtest: pipe-A-eDP-1
[130.969405] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.288s)
[130.980561] Starting dynamic subtest: pipe-B-eDP-1
[130.982742] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[130.990100] Starting dynamic subtest: pipe-C-eDP-1
[130.991944] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[131.003055] Starting dynamic subtest: pipe-D-eDP-1
[131.005259] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[131.007521] Subtest uint-max-clock: SUCCESS (0.292s)
[131.828781] [010/133] (885s left) prime_mmap (test_map_unmap)
[131.884957] Starting subtest: test_map_unmap
[131.887320] Starting dynamic subtest: test_map_unmap-smem
[131.914020] Dynamic subtest test_map_unmap-smem: SUCCESS (0.031s)
[131.917071] Subtest test_map_unmap: SUCCESS (0.031s)
[132.029782] [011/133] (885s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-downscaling)
[132.123069] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-downscaling
[132.126554] Starting dynamic subtest: pipe-A-default-mode
[133.315324] Dynamic subtest pipe-A-default-mode: SKIP (1.188s)
[133.319854] Subtest flip-64bpp-xtile-to-32bpp-xtile-downscaling: SKIP (1.190s)
[133.475678] [012/133] (884s left) gem_mmap_wc (bad-offset)
[133.543505] Subtest bad-offset: SKIP (0.000s)
[133.595238] [013/133] (884s left) gem_exec_schedule (lateslice)
[133.670196] Starting subtest: lateslice
[133.672337] Starting dynamic subtest: rcs0
[133.681080] Dynamic subtest rcs0: SUCCESS (0.022s)
[133.689373] Starting dynamic subtest: bcs0
[133.699286] Dynamic subtest bcs0: SUCCESS (0.018s)
[133.707079] Starting dynamic subtest: vcs0
[133.717740] Dynamic subtest vcs0: SUCCESS (0.018s)
[133.725208] Starting dynamic subtest: vcs1
[133.735496] Dynamic subtest vcs1: SUCCESS (0.018s)
[133.743198] Starting dynamic subtest: vecs0
[133.753231] Dynamic subtest vecs0: SUCCESS (0.017s)
[133.760819] Starting dynamic subtest: ccs0
[133.769063] Dynamic subtest ccs0: SUCCESS (0.015s)
[133.771338] Subtest lateslice: SUCCESS (0.110s)
[135.014123] [014/133] (882s left) kms_cursor_crc (cursor-offscreen-512x170)
[135.310244] Starting subtest: cursor-offscreen-512x170
[135.314650] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[135.473626] [015/133] (882s left) kms_atomic_transition (plane-all-modeset-transition-fencing-internal-panels)
[135.563996] Starting subtest: plane-all-modeset-transition-fencing-internal-panels
[135.566277] Starting dynamic subtest: pipe-A-eDP-1
[136.932427] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.367s)
[137.211280] Starting dynamic subtest: pipe-B-eDP-1
[138.252393] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.048s)
[138.515660] Subtest plane-all-modeset-transition-fencing-internal-panels: SUCCESS (2.953s)
[139.368400] [016/133] (878s left) i915_drm_fdinfo (busy-idle-check-all)
[139.413523] Starting subtest: busy-idle-check-all
[139.415846] Starting dynamic subtest: rcs0
[139.420586] Dynamic subtest rcs0: SKIP (0.003s)
[139.431340] Starting dynamic subtest: bcs0
[139.435423] Dynamic subtest bcs0: SKIP (0.000s)
[139.443389] Starting dynamic subtest: vcs0
[139.447790] Dynamic subtest vcs0: SKIP (0.000s)
[139.455589] Starting dynamic subtest: vcs1
[139.459973] Dynamic subtest vcs1: SKIP (0.000s)
[139.467759] Starting dynamic subtest: vecs0
[139.472166] Dynamic subtest vecs0: SKIP (0.000s)
[139.479852] Starting dynamic subtest: ccs0
[139.484188] Dynamic subtest ccs0: SKIP (0.000s)
[139.488589] Subtest busy-idle-check-all: SKIP (0.006s)
[139.525660] [017/133] (878s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[140.118547] Starting subtest: syncobj-timeline-multiple-ext-nodes
[140.121068] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.004s)
[141.994117] [FACT gem_exec_fence (syncobj-timeline-multiple-ext-nodes)] new: kernel.kmod_is_loaded.vgem: true
[141.997568] [018/133] (876s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[142.109701] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[142.114087] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[142.218922] [019/133] (875s left) kms_flip (flip-vs-expired-vblank-interruptible)
[142.321597] Starting subtest: flip-vs-expired-vblank-interruptible
[142.323884] Starting dynamic subtest: A-eDP1
[150.989941] Dynamic subtest A-eDP1: SUCCESS (8.634s)
[151.000085] Starting dynamic subtest: B-eDP1
[159.629863] Dynamic subtest B-eDP1: SUCCESS (8.639s)
[159.639853] Starting dynamic subtest: C-eDP1
[168.258529] Dynamic subtest C-eDP1: SUCCESS (8.616s)
[168.269820] Starting dynamic subtest: D-eDP1
[176.901184] Dynamic subtest D-eDP1: SUCCESS (8.641s)
[176.903447] Subtest flip-vs-expired-vblank-interruptible: SUCCESS (34.538s)
[178.019971] [020/133] (840s left) perf_pmu (rc6-all-gts)
[178.066458] Starting subtest: rc6-all-gts
[184.498685] Subtest rc6-all-gts: SUCCESS (6.381s)
[185.348890] [021/133] (832s left) gem_exec_balancer (persistence)
[185.604779] Starting subtest: persistence
[186.491627] Subtest persistence: SUCCESS (0.886s)
[186.606039] [022/133] (831s left) perf (oa-formats)
[186.730887] Starting subtest: oa-formats
[186.733056] Starting dynamic subtest: 0-rcs0
[186.743761] Dynamic subtest 0-rcs0: SUCCESS (0.017s)
[186.753398] Starting dynamic subtest: 1-vcs1
[186.769517] Dynamic subtest 1-vcs1: SUCCESS (0.025s)
[186.771792] Subtest oa-formats: SUCCESS (0.044s)
[186.817906] [023/133] (831s left) kms_atomic_interruptible (legacy-cursor)
[186.914619] Starting subtest: legacy-cursor
[186.916743] Starting dynamic subtest: pipe-A-eDP-1
[194.334033] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.419s)
[194.336383] Subtest legacy-cursor: SUCCESS (7.420s)
[195.191749] [024/133] (823s left) kms_psr (psr-dpms)
[195.299710] Starting subtest: psr-dpms
[195.301944] Starting dynamic subtest: eDP-1
[198.312844] Dynamic subtest eDP-1: SUCCESS (3.014s)
[198.315160] Subtest psr-dpms: SUCCESS (3.015s)
[199.169088] [025/133] (819s left) kms_rotation_crc (primary-y-tiled-reflect-x-0)
[199.268190] Starting subtest: primary-y-tiled-reflect-x-0
[199.327481] Subtest primary-y-tiled-reflect-x-0: SKIP (0.059s)
[199.449731] [026/133] (818s left) kms_chamelium_color (ctm-blue-to-red)
[199.548334] Subtest ctm-blue-to-red: SKIP (0.000s)
[199.596819] [027/133] (818s left) gem_userptr_blits (invalid-null-pointer)
[199.658492] Starting subtest: invalid-null-pointer
[199.660462] Subtest invalid-null-pointer: SUCCESS (0.001s)
[199.796295] [028/133] (818s left) vgem_basic (second-client)
[199.850060] Starting subtest: second-client
[199.872232] Subtest second-client: SUCCESS (0.022s)
[199.929287] [029/133] (818s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-fullscreen)
[200.016275] Starting subtest: psr-1p-primscrn-spr-indfb-fullscreen
[206.595998] Subtest psr-1p-primscrn-spr-indfb-fullscreen: SUCCESS (6.583s)
[206.731964] [030/133] (811s left) sriov_basic (bind-unbind-vf)
[206.786493] Starting subtest: bind-unbind-vf
[206.788881] Starting dynamic subtest: vf-1
[206.868650] Dynamic subtest vf-1: FAIL (0.030s)
[206.880197] Starting dynamic subtest: vf-2
[206.952750] Dynamic subtest vf-2: FAIL (0.003s)
[206.962492] Starting dynamic subtest: vf-3
[207.034637] Dynamic subtest vf-3: FAIL (0.003s)
[207.044228] Starting dynamic subtest: vf-4
[207.116177] Dynamic subtest vf-4: FAIL (0.003s)
[207.125726] Starting dynamic subtest: vf-5
[207.197888] Dynamic subtest vf-5: FAIL (0.004s)
[207.207665] Starting dynamic subtest: vf-6
[207.279639] Dynamic subtest vf-6: FAIL (0.003s)
[207.289186] Starting dynamic subtest: vf-7
[207.362758] Dynamic subtest vf-7: FAIL (0.003s)
[207.373099] Starting dynamic subtest: vf-random
[207.445273] Dynamic subtest vf-random: FAIL (0.003s)
[207.455256] Starting dynamic subtest: vf-last
[207.527630] Dynamic subtest vf-last: FAIL (0.506s)
[207.529702] Subtest bind-unbind-vf: FAIL (0.565s)
[207.568635] [031/133] (811s left) syncobj_wait (wait-for-submit-delayed-submit)
[207.622884] Starting subtest: wait-for-submit-delayed-submit
[207.727245] Subtest wait-for-submit-delayed-submit: SUCCESS (0.102s)
[207.816203] [032/133] (810s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[207.927372] Starting subtest: basic-flip-after-cursor-varying-size
[208.874827] Subtest basic-flip-after-cursor-varying-size: SUCCESS (0.947s)
[209.735391] [033/133] (808s left) gem_exec_flush (basic-wb-ro-before-default)
[209.814373] Starting subtest: basic-wb-ro-before-default
[215.299098] Subtest basic-wb-ro-before-default: SUCCESS (5.447s)
[215.459940] [034/133] (803s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[215.557056] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[215.559328] Starting dynamic subtest: A-eDP1
[219.179159] Dynamic subtest A-eDP1: SUCCESS (3.619s)
[219.189379] Starting dynamic subtest: B-eDP1
[222.363884] Dynamic subtest B-eDP1: SUCCESS (3.185s)
[222.373758] Starting dynamic subtest: C-eDP1
[225.462742] Dynamic subtest C-eDP1: SUCCESS (3.095s)
[225.472493] Starting dynamic subtest: D-eDP1
[228.568075] Dynamic subtest D-eDP1: SUCCESS (3.105s)
[228.570418] Subtest single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (13.012s)
[229.371232] [035/133] (789s left) i915_suspend (forcewake)
[229.427254] Starting subtest: forcewake
[261.150828] Subtest forcewake: SUCCESS (3.126s)
[262.231147] [036/133] (757s left) syncobj_timeline (device-signal-unordered)
[262.306180] Starting subtest: device-signal-unordered
[262.308510] Subtest device-signal-unordered: SUCCESS (0.000s)
[262.408482] [037/133] (757s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs)
[262.518395] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs
[262.520629] Starting dynamic subtest: pipe-A-eDP-1
[262.543081] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[262.554170] Starting dynamic subtest: pipe-B-eDP-1
[262.575526] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[262.584402] Starting dynamic subtest: pipe-C-eDP-1
[262.605750] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[262.614306] Starting dynamic subtest: pipe-D-eDP-1
[262.636308] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[262.640333] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[264.745001] [038/133] (755s left) gem_exec_reloc (basic-wc-read)
[264.818365] Subtest basic-wc-read: SKIP (0.000s)
[264.892124] [039/133] (755s left) kms_joiner (switch-modeset-ultra-joiner-big-joiner)
[264.997511] Starting subtest: switch-modeset-ultra-joiner-big-joiner
[265.001838] Subtest switch-modeset-ultra-joiner-big-joiner: SKIP (0.000s)
[265.078329] [040/133] (754s left) kms_ccs (crc-primary-suspend-y-tiled-ccs)
[265.168633] Starting subtest: crc-primary-suspend-y-tiled-ccs
[265.171005] Starting dynamic subtest: pipe-A-eDP-1
[265.180036] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[265.190221] Starting dynamic subtest: pipe-B-eDP-1
[265.199176] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[265.207756] Starting dynamic subtest: pipe-C-eDP-1
[265.215971] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[265.224260] Starting dynamic subtest: pipe-D-eDP-1
[265.232505] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[265.236509] Subtest crc-primary-suspend-y-tiled-ccs: SKIP (0.004s)
[267.413597] [041/133] (752s left) syncobj_timeline (multi-wait-available-signaled)
[267.481259] Starting subtest: multi-wait-available-signaled
[267.483591] Subtest multi-wait-available-signaled: SUCCESS (0.000s)
[267.579307] [042/133] (752s left) gem_exec_whisper (basic-fds-priority)
[267.642579] Starting subtest: basic-fds-priority
[291.122925] Subtest basic-fds-priority: SUCCESS (23.505s)
[291.301108] [043/133] (728s left) gem_exec_schedule (semaphore-user)
[291.367510] Starting subtest: semaphore-user
[291.421155] Subtest semaphore-user: SUCCESS (0.062s)
[292.524137] [044/133] (727s left) kms_addfb_basic (addfb25-bad-modifier)
[292.620631] Starting subtest: addfb25-bad-modifier
[292.622886] Subtest addfb25-bad-modifier: SUCCESS (0.000s)
[292.739899] [045/133] (727s left) gen9_exec_parse (bb-large)
[292.797229] Subtest bb-large: SKIP (0.000s)
[292.869083] [046/133] (727s left) gem_mmap_gtt (zero-extend)
[292.935750] Subtest zero-extend: SKIP (0.000s)
[292.995044] [047/133] (727s left) gem_softpin (safe-alignment)
[293.058634] Starting subtest: safe-alignment
[293.080470] Subtest safe-alignment: SUCCESS (0.022s)
[294.572682] [048/133] (725s left) gem_exec_params (batch-first)
[294.627251] Starting subtest: batch-first
[294.633502] Subtest batch-first: SUCCESS (0.006s)
[294.755647] [049/133] (725s left) kms_plane (pixel-format-4-tiled-dg2-mc-ccs-modifier-source-clamping)
[294.844595] Starting subtest: pixel-format-4-tiled-dg2-mc-ccs-modifier-source-clamping
[294.848787] Subtest pixel-format-4-tiled-dg2-mc-ccs-modifier-source-clamping: SKIP (0.000s)
[294.920921] [050/133] (725s left) syncobj_wait (single-wait-for-submit-signaled)
[294.966638] Starting subtest: single-wait-for-submit-signaled
[294.968894] Subtest single-wait-for-submit-signaled: SUCCESS (0.000s)
[295.058403] [051/133] (725s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-y-tiled)
[295.114672] Starting subtest: yf-tiled-mc-ccs-to-vebox-y-tiled
[295.119185] Subtest yf-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[295.314075] [052/133] (725s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs)
[295.394588] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs
[295.398286] Starting dynamic subtest: pipe-A-eDP-1
[295.421809] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[295.433797] Starting dynamic subtest: pipe-B-eDP-1
[295.455736] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[295.464525] Starting dynamic subtest: pipe-C-eDP-1
[295.486552] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[295.494958] Starting dynamic subtest: pipe-D-eDP-1
[295.516915] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[295.521292] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[297.552755] [053/133] (723s left) i915_hangman (gt-engine-error)
[297.620598] Starting subtest: gt-engine-error
[297.622441] Starting dynamic subtest: rcs0
[299.493008] Dynamic subtest rcs0: SUCCESS (1.873s)
[299.505552] Starting dynamic subtest: bcs0
[301.474765] Dynamic subtest bcs0: SUCCESS (1.981s)
[301.486235] Starting dynamic subtest: vcs0
[303.458527] Dynamic subtest vcs0: SUCCESS (1.983s)
[303.470226] Starting dynamic subtest: vcs1
[305.442986] Dynamic subtest vcs1: SUCCESS (1.983s)
[305.457676] Starting dynamic subtest: vecs0
[307.489881] Dynamic subtest vecs0: SUCCESS (2.045s)
[307.502710] Starting dynamic subtest: ccs0
[309.474761] Dynamic subtest ccs0: SUCCESS (1.983s)
[309.477389] Subtest gt-engine-error: SUCCESS (11.862s)
[309.569101] [054/133] (711s left) kms_big_fb (4-tiled-8bpp-rotate-90)
[309.680663] Starting subtest: 4-tiled-8bpp-rotate-90
[309.701861] Subtest 4-tiled-8bpp-rotate-90: SKIP (0.021s)
[309.838822] [055/133] (710s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-render)
[309.933678] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-render
[309.937880] Subtest psr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[310.039805] [056/133] (710s left) kms_psr2_sf (fbc-pr-plane-move-sf-dmg-area)
[310.145813] Starting subtest: fbc-pr-plane-move-sf-dmg-area
[310.149743] Subtest fbc-pr-plane-move-sf-dmg-area: SKIP (0.000s)
[310.219152] [057/133] (710s left) kms_async_flips (test-time-stamp)
[310.310946] Starting subtest: test-time-stamp
[310.685820] Starting dynamic subtest: pipe-A-eDP-1
[311.448393] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.761s)
[311.831215] Starting dynamic subtest: pipe-B-eDP-1
[312.588270] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.763s)
[312.954714] Starting dynamic subtest: pipe-C-eDP-1
[313.717194] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.768s)
[314.084525] Starting dynamic subtest: pipe-D-eDP-1
[314.845624] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.769s)
[314.847911] Subtest test-time-stamp: SUCCESS (4.537s)
[316.005057] [058/133] (704s left) kms_plane_scaling (planes-downscale-factor-0-75)
[316.120519] Starting subtest: planes-downscale-factor-0-75
[316.122766] Starting dynamic subtest: pipe-A
[316.141794] Dynamic subtest pipe-A: SKIP (0.018s)
[316.151044] Starting dynamic subtest: pipe-B
[316.172739] Dynamic subtest pipe-B: SKIP (0.031s)
[316.182246] Starting dynamic subtest: pipe-C
[316.210169] Dynamic subtest pipe-C: SKIP (0.034s)
[316.219604] Starting dynamic subtest: pipe-D
[316.243045] Dynamic subtest pipe-D: SKIP (0.033s)
[316.247473] Subtest planes-downscale-factor-0-75: SKIP (0.118s)
[316.392169] [059/133] (704s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy)
[316.516901] Starting subtest: 2x-cursor-vs-flip-legacy
[316.521514] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.001s)
[316.661764] [060/133] (704s left) drm_read (short-buffer-block)
[316.809211] Starting subtest: short-buffer-block
[316.811737] Subtest short-buffer-block: SUCCESS (0.000s)
[316.935611] [061/133] (703s left) gem_userptr_blits (invalid-mmap-offset-unsync)
[316.991903] Subtest invalid-mmap-offset-unsync: SKIP (0.000s)
[317.105576] [062/133] (703s left) kms_psr (fbc-pr-cursor-plane-move)
[317.192284] Starting subtest: fbc-pr-cursor-plane-move
[317.196050] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s)
[317.289043] [063/133] (703s left) kms_psr (fbc-psr-cursor-mmap-cpu)
[317.375002] Starting subtest: fbc-psr-cursor-mmap-cpu
[317.376869] Starting dynamic subtest: eDP-1
[317.380353] Dynamic subtest eDP-1: SKIP (0.000s)
[317.384011] Subtest fbc-psr-cursor-mmap-cpu: SKIP (0.001s)
[317.446625] [064/133] (703s left) kms_async_flips (alternate-sync-async-flip)
[317.536978] Starting subtest: alternate-sync-async-flip
[317.915387] Starting dynamic subtest: pipe-A-eDP-1
[320.685671] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.773s)
[321.066497] Starting dynamic subtest: pipe-B-eDP-1
[323.813990] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.758s)
[324.181496] Starting dynamic subtest: pipe-C-eDP-1
[326.940126] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.769s)
[327.304736] Starting dynamic subtest: pipe-D-eDP-1
[330.063959] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.769s)
[330.065853] Subtest alternate-sync-async-flip: SUCCESS (12.536s)
[331.248357] [065/133] (689s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions-varying-size)
[331.386160] Starting subtest: cursorA-vs-flipB-atomic-transitions-varying-size
[331.390787] Subtest cursorA-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s)
[331.543590] [066/133] (689s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[331.646998] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[331.651393] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[331.756963] [067/133] (689s left) kms_cursor_crc (cursor-sliding-max-size)
[332.079678] Starting subtest: cursor-sliding-max-size
[332.086340] Subtest cursor-sliding-max-size: SKIP (0.000s)
[332.220405] [068/133] (689s left) kms_atomic_transition (plane-all-transition-nonblocking)
[332.307624] Starting subtest: plane-all-transition-nonblocking
[332.309491] Starting dynamic subtest: pipe-A-eDP-1
[334.817585] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.510s)
[335.122231] Starting dynamic subtest: pipe-B-eDP-1
[338.358124] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.247s)
[338.667066] Subtest plane-all-transition-nonblocking: SUCCESS (6.361s)
[339.488290] [069/133] (681s left) kms_psr (psr-cursor-plane-onoff)
[339.580068] Starting subtest: psr-cursor-plane-onoff
[339.582317] Starting dynamic subtest: eDP-1
[341.275105] Dynamic subtest eDP-1: SUCCESS (1.698s)
[341.277548] Subtest psr-cursor-plane-onoff: SUCCESS (1.699s)
[342.152130] [070/133] (679s left) gem_ctx_persistence (file)
[342.221250] Starting subtest: file
[342.358743] Subtest file: SUCCESS (0.137s)
[342.487616] [071/133] (678s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-wc)
[342.587067] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-wc
[342.591479] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[342.696774] [072/133] (678s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[342.800945] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu
[342.805550] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[342.903557] [073/133] (678s left) kms_multipipe_modeset (basic-max-pipe-crc-check)
[342.994867] Starting subtest: basic-max-pipe-crc-check
[342.998984] Subtest basic-max-pipe-crc-check: SKIP (0.000s)
[343.042138] [074/133] (678s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-gtt)
[343.155842] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-gtt
[343.159270] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[343.255039] [075/133] (678s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[343.350270] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-gtt
[343.353664] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[343.432999] [076/133] (678s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt)
[343.542851] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt
[343.546651] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[343.638647] [077/133] (677s left) kms_pm_dc (dc9-dpms)
[344.739510] Starting subtest: dc9-dpms
[346.157043] Subtest dc9-dpms: SUCCESS (1.417s)
[346.235123] [078/133] (675s left) gem_eio (throttle)
[346.474557] Starting subtest: throttle
[346.770417] Subtest throttle: SUCCESS (0.295s)
[346.893889] [079/133] (674s left) gem_mmap_wc (coherency)
[346.961921] Subtest coherency: SKIP (0.000s)
[347.021508] [080/133] (674s left) syncobj_timeline (multi-wait-all-for-submit-available-submitted)
[347.078011] Starting subtest: multi-wait-all-for-submit-available-submitted
[347.080345] Subtest multi-wait-all-for-submit-available-submitted: SUCCESS (0.000s)
[347.171807] [081/133] (674s left) kms_big_fb (x-tiled-addfb-size-overflow)
[347.274760] Starting subtest: x-tiled-addfb-size-overflow
[347.276652] Subtest x-tiled-addfb-size-overflow: SUCCESS (0.000s)
[347.371009] [082/133] (674s left) fbdev (write)
[347.410415] Starting subtest: write
[347.769919] Subtest write: SUCCESS (0.357s)
[347.832475] [083/133] (673s left) gem_ctx_shared (q-promotion)
[347.897624] Starting subtest: Q-promotion
[347.900116] Starting dynamic subtest: rcs0
[348.020171] Dynamic subtest rcs0: SUCCESS (0.120s)
[348.032714] Starting dynamic subtest: vcs0
[348.130759] Dynamic subtest vcs0: SUCCESS (0.110s)
[348.148855] Starting dynamic subtest: vcs1
[348.216525] Dynamic subtest vcs1: SUCCESS (0.085s)
[348.234915] Starting dynamic subtest: vecs0
[348.299343] Dynamic subtest vecs0: SUCCESS (0.082s)
[348.316962] Starting dynamic subtest: ccs0
[348.400294] Dynamic subtest ccs0: SUCCESS (0.100s)
[348.403086] Subtest Q-promotion: SUCCESS (0.503s)
[349.587303] [084/133] (672s left) kms_dsc (dsc-with-output-formats)
[349.683030] Starting subtest: dsc-with-output-formats
[349.704886] Subtest dsc-with-output-formats: SKIP (0.000s)
[349.754935] [085/133] (672s left) gem_workarounds (reset)
[349.821292] Starting subtest: reset
[349.989883] Subtest reset: SUCCESS (0.171s)
[350.104237] [086/133] (671s left) gem_pread (uncached)
[350.166079] Subtest uncached: SKIP (0.000s)
[350.229249] [087/133] (671s left) gem_exec_balancer (parallel-balancer)
[350.478123] Starting subtest: parallel-balancer
[351.346750] Subtest parallel-balancer: SUCCESS (0.869s)
[351.449741] [088/133] (670s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[351.545654] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu
[351.549926] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[351.643677] [089/133] (670s left) perf (gen12-mi-rpc)
[351.744107] Starting subtest: gen12-mi-rpc
[351.746478] Starting dynamic subtest: rcs0
[351.761815] Dynamic subtest rcs0: SUCCESS (0.016s)
[351.763749] Subtest gen12-mi-rpc: SUCCESS (0.017s)
[351.812097] [090/133] (670s left) syncobj_timeline (single-wait-all-for-submit-available-submitted)
[351.868086] Starting subtest: single-wait-all-for-submit-available-submitted
[351.870271] Subtest single-wait-all-for-submit-available-submitted: SUCCESS (0.000s)
[351.975828] [091/133] (670s left) kms_vblank (query-forked-hang)
[352.069915] Starting subtest: query-forked-hang
[352.071799] Starting dynamic subtest: pipe-A-eDP-1
[378.322771] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.237s)
[378.339445] Starting dynamic subtest: pipe-D-eDP-1
[393.288932] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.959s)
[393.291224] Subtest query-forked-hang: SUCCESS (41.200s)
[394.089047] [092/133] (628s left) gem_render_copy_redux (flink)
[394.150379] Starting subtest: flink
[394.969741] Subtest flink: SUCCESS (0.819s)
[395.096100] [093/133] (627s left) syncobj_timeline (etime-single-wait-available-unsubmitted)
[395.146088] Starting subtest: etime-single-wait-available-unsubmitted
[395.247976] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.101s)
[395.324108] [094/133] (626s left) gem_busy (close-race)
[395.378315] Starting subtest: close-race
[420.484930] Subtest close-race: SUCCESS (25.104s)
[420.859573] [095/133] (601s left) syncobj_wait (multi-wait-for-submit-unsubmitted)
[420.956340] Starting subtest: multi-wait-for-submit-unsubmitted
[421.065123] Subtest multi-wait-for-submit-unsubmitted: SUCCESS (0.106s)
[421.143099] [096/133] (601s left) sw_sync (alloc_merge_fence)
[421.180367] Starting subtest: alloc_merge_fence
[421.182774] Subtest alloc_merge_fence: SUCCESS (0.000s)
[421.229170] [097/133] (601s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[421.327575] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[421.331973] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.001s)
[421.443529] [098/133] (600s left) kms_frontbuffer_tracking (fbc-2p-pri-indfb-multidraw)
[421.536010] Starting subtest: fbc-2p-pri-indfb-multidraw
[421.540293] Subtest fbc-2p-pri-indfb-multidraw: SKIP (0.000s)
[421.638265] [099/133] (600s left) perf (gen8-unprivileged-single-ctx-counters)
[421.741637] Starting subtest: gen8-unprivileged-single-ctx-counters
[421.746955] Subtest gen8-unprivileged-single-ctx-counters: SKIP (0.000s)
[421.785883] [100/133] (600s left) kms_psr (psr2-cursor-blt)
[421.886084] Starting subtest: psr2-cursor-blt
[421.888341] Starting dynamic subtest: eDP-1
[423.569023] Dynamic subtest eDP-1: SUCCESS (1.685s)
[423.571211] Subtest psr2-cursor-blt: SUCCESS (1.686s)
[424.365242] [101/133] (598s left) kms_color (deep-color)
[424.466828] Starting subtest: deep-color
[425.537578] Starting dynamic subtest: pipe-A-eDP-1-gamma
[426.258556] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.719s)
[426.269593] Starting dynamic subtest: pipe-A-eDP-1-degamma
[427.732677] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.474s)
[427.745068] Starting dynamic subtest: pipe-A-eDP-1-ctm
[429.140450] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.406s)
[429.942951] Starting dynamic subtest: pipe-B-eDP-1-gamma
[430.679644] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.743s)
[430.690221] Starting dynamic subtest: pipe-B-eDP-1-degamma
[432.105844] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.425s)
[432.116125] Starting dynamic subtest: pipe-B-eDP-1-ctm
[433.546403] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.439s)
[434.330260] Starting dynamic subtest: pipe-C-eDP-1-gamma
[434.994553] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.672s)
[435.005262] Starting dynamic subtest: pipe-C-eDP-1-degamma
[436.373813] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.378s)
[436.384272] Starting dynamic subtest: pipe-C-eDP-1-ctm
[437.819906] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.448s)
[438.640082] Starting dynamic subtest: pipe-D-eDP-1-gamma
[439.324876] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.694s)
[439.335888] Starting dynamic subtest: pipe-D-eDP-1-degamma
[440.678706] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.351s)
[440.689203] Starting dynamic subtest: pipe-D-eDP-1-ctm
[442.100890] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.422s)
[442.103102] Subtest deep-color: SUCCESS (17.637s)
[442.979760] [102/133] (579s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-pwrite)
[443.098413] Starting subtest: psr-1p-primscrn-cur-indfb-draw-pwrite
[449.910464] Subtest psr-1p-primscrn-cur-indfb-draw-pwrite: SUCCESS (6.817s)
[450.036187] [103/133] (572s left) kms_big_fb (y-tiled-16bpp-rotate-270)
[450.138977] Starting subtest: y-tiled-16bpp-rotate-270
[450.143292] Subtest y-tiled-16bpp-rotate-270: SKIP (0.000s)
[450.239098] [104/133] (572s left) sysfs_defaults (readonly)
[450.300646] Starting subtest: readonly
[450.303027] Starting dynamic subtest: vecs0
[450.305391] Dynamic subtest vecs0: SUCCESS (0.000s)
[450.316870] Starting dynamic subtest: ccs0
[450.318924] Dynamic subtest ccs0: SUCCESS (0.000s)
[450.328543] Starting dynamic subtest: vcs0
[450.330804] Dynamic subtest vcs0: SUCCESS (0.000s)
[450.340091] Starting dynamic subtest: bcs0
[450.342520] Dynamic subtest bcs0: SUCCESS (0.000s)
[450.351738] Starting dynamic subtest: rcs0
[450.353806] Dynamic subtest rcs0: SUCCESS (0.000s)
[450.362922] Starting dynamic subtest: vcs1
[450.364975] Dynamic subtest vcs1: SUCCESS (0.000s)
[450.367057] Subtest readonly: SUCCESS (0.006s)
[450.403534] [105/133] (572s left) i915_pm_rps (reset)
[450.468736] Starting subtest: reset
[458.914753] Subtest reset: SUCCESS (8.447s)
[459.022579] [106/133] (563s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-blt)
[459.126163] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-blt
[466.416944] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (7.296s)
[466.563298] [107/133] (556s left) kms_getfb (getfb-handle-not-fb)
[466.664714] Starting subtest: getfb-handle-not-fb
[466.667054] Subtest getfb-handle-not-fb: SUCCESS (0.000s)
[466.760700] [108/133] (556s left) gem_ctx_engines (independent)
[466.813453] Starting subtest: independent
[466.815790] Starting dynamic subtest: rcs0
[466.965562] Dynamic subtest rcs0: SUCCESS (0.150s)
[466.978328] Starting dynamic subtest: bcs0
[467.123725] Dynamic subtest bcs0: SUCCESS (0.157s)
[467.135268] Starting dynamic subtest: vcs0
[467.272289] Dynamic subtest vcs0: SUCCESS (0.147s)
[467.282333] Starting dynamic subtest: vcs1
[467.451345] Dynamic subtest vcs1: SUCCESS (0.178s)
[467.464113] Starting dynamic subtest: vecs0
[467.624441] Dynamic subtest vecs0: SUCCESS (0.172s)
[467.635345] Starting dynamic subtest: ccs0
[467.806701] Dynamic subtest ccs0: SUCCESS (0.181s)
[467.820244] Starting dynamic subtest: all-engines
[468.522012] Dynamic subtest all-engines: SUCCESS (0.715s)
[468.524348] Subtest independent: SUCCESS (1.708s)
[470.513992] [109/133] (552s left) kms_plane (pixel-format-y-tiled-ccs-modifier)
[470.613580] Starting subtest: pixel-format-y-tiled-ccs-modifier
[470.618127] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.000s)
[470.722045] [110/133] (552s left) kms_debugfs (display-off-read-all)
[470.817815] Starting subtest: display-off-read-all
[471.111522] Subtest display-off-read-all: SUCCESS (0.296s)
[471.957552] [111/133] (551s left) dumb_buffer (create-clear)
[472.014277] Starting subtest: create-clear
[506.093737] Subtest create-clear: SUCCESS (34.020s)
[506.154364] [112/133] (516s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs)
[506.250656] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs
[506.252962] Starting dynamic subtest: pipe-A-eDP-1
[506.274202] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[506.287368] Starting dynamic subtest: pipe-B-eDP-1
[506.306909] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[506.316105] Starting dynamic subtest: pipe-C-eDP-1
[506.335217] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[506.344747] Starting dynamic subtest: pipe-D-eDP-1
[506.363836] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[506.365736] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs: SUCCESS (0.005s)
[508.532755] [113/133] (514s left) kms_universal_plane (universal-plane-sanity)
[508.636906] Starting subtest: universal-plane-sanity
[508.639339] Starting dynamic subtest: pipe-A-eDP-1
[509.241867] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.605s)
[509.252975] Starting dynamic subtest: pipe-B-eDP-1
[510.472459] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.230s)
[510.483150] Starting dynamic subtest: pipe-C-eDP-1
[511.673121] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.199s)
[511.684308] Starting dynamic subtest: pipe-D-eDP-1
[512.911801] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.235s)
[512.914010] Subtest universal-plane-sanity: SUCCESS (4.274s)
[513.770989] [114/133] (509s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled-ccs)
[513.832791] Starting subtest: yf-tiled-ccs-to-yf-tiled-ccs
[513.837254] Subtest yf-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[514.016002] [115/133] (509s left) gem_mmap_gtt (cpuset-medium-copy)
[514.072173] Subtest cpuset-medium-copy: SKIP (0.000s)
[514.134779] [116/133] (509s left) api_intel_allocator (reloc-allocator)
[514.200589] Starting subtest: reloc-allocator
[514.202941] Starting dynamic subtest: basic
[514.204906] Dynamic subtest basic: SUCCESS (0.003s)
[514.218413] Starting dynamic subtest: parallel-one
[514.220635] Dynamic subtest parallel-one: SUCCESS (0.008s)
[514.230986] Starting dynamic subtest: print
[514.232818] Dynamic subtest print: SUCCESS (0.000s)
[514.242166] Starting dynamic subtest: reuse
[514.244062] Dynamic subtest reuse: SUCCESS (0.000s)
[514.253299] Starting dynamic subtest: fork-reopen-allocator
[514.255242] Dynamic subtest fork-reopen-allocator: SUCCESS (0.013s)
[514.257119] Subtest reloc-allocator: SUCCESS (0.028s)
[514.345110] [117/133] (508s left) kms_content_protection (dp-mst-lic-type-0-hdcp14)
[514.485772] Starting subtest: dp-mst-lic-type-0-hdcp14
[514.490251] Subtest dp-mst-lic-type-0-hdcp14: SKIP (0.000s)
[514.623068] [118/133] (508s left) gem_exec_params (mmapped)
[514.681254] Starting subtest: mmapped
[514.686219] Subtest mmapped: SUCCESS (0.003s)
[514.808647] [119/133] (508s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area)
[514.909771] Starting subtest: pr-primary-plane-update-sf-dmg-area
[514.914272] Subtest pr-primary-plane-update-sf-dmg-area: SKIP (0.000s)
[514.984845] [120/133] (508s left) kms_getfb (getfb-handle-valid)
[515.081376] Starting subtest: getfb-handle-valid
[515.083269] Subtest getfb-handle-valid: SUCCESS (0.000s)
[515.216431] [121/133] (508s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[515.314260] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-cpu
[521.975010] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (6.659s)
[522.119203] [122/133] (501s left) gem_ctx_persistence (engines-cleanup)
[522.182446] Starting subtest: engines-cleanup
[522.185075] Starting dynamic subtest: rcs0
[522.257061] Dynamic subtest rcs0: SUCCESS (0.074s)
[522.270882] Starting dynamic subtest: bcs0
[522.297173] Dynamic subtest bcs0: SUCCESS (0.039s)
[522.308274] Starting dynamic subtest: vcs0
[522.349751] Dynamic subtest vcs0: SUCCESS (0.050s)
[522.361644] Starting dynamic subtest: vcs1
[522.395379] Dynamic subtest vcs1: SUCCESS (0.044s)
[522.406747] Starting dynamic subtest: vecs0
[522.455867] Dynamic subtest vecs0: SUCCESS (0.059s)
[522.467735] Starting dynamic subtest: ccs0
[522.513719] Dynamic subtest ccs0: SUCCESS (0.054s)
[522.516145] Subtest engines-cleanup: SUCCESS (0.331s)
[522.589050] [123/133] (500s left) kms_big_fb (yf-tiled-8bpp-rotate-0)
[522.685130] Starting subtest: yf-tiled-8bpp-rotate-0
[522.689062] Subtest yf-tiled-8bpp-rotate-0: SKIP (0.000s)
[522.785906] [124/133] (500s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[522.884869] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[523.720451] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.837s)
[523.875511] [125/133] (499s left) kms_chamelium_hpd (vga-hpd-for-each-pipe)
[524.251779] Subtest vga-hpd-for-each-pipe: SKIP (0.000s)
[525.025625] [126/133] (498s left) kms_prop_blob (blob-multiple)
[525.078960] Starting subtest: blob-multiple
[525.081339] Subtest blob-multiple: SUCCESS (0.002s)
[525.178820] [127/133] (498s left) vgem_basic (unload)
[525.223842] Starting subtest: unload
[554.305510] Subtest unload: SUCCESS (29.082s)
[554.416896] [128/133] (469s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-pwrite)
[554.531139] Starting subtest: fbcpsr-rgb565-draw-pwrite
[561.542458] Subtest fbcpsr-rgb565-draw-pwrite: SUCCESS (7.014s)
[561.668051] [129/133] (462s left) kms_cursor_crc (cursor-rapid-movement-512x170)
[561.984601] Starting subtest: cursor-rapid-movement-512x170
[561.988959] Subtest cursor-rapid-movement-512x170: SKIP (0.001s)
[562.132921] [130/133] (461s left) kms_flip (2x-plain-flip-fb-recreate-interruptible)
[562.238659] Starting subtest: 2x-plain-flip-fb-recreate-interruptible
[562.248869] Subtest 2x-plain-flip-fb-recreate-interruptible: SKIP (0.010s)
[562.324861] [131/133] (461s left) kms_chamelium_frames (hdmi-crc-fast)
[562.696171] Subtest hdmi-crc-fast: SKIP (0.000s)
[563.485075] [132/133] (460s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-blt)
[563.591007] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-blt
[570.531673] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.942s)
[570.680193] [133/133] (453s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-upscaling)
[570.770125] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-upscaling
[570.774179] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-upscaling: SKIP (0.000s)
[570.845568] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_whisper
results: parsing output: 1/ for test: kms_plane
results: parsing output: 2/ for test: kms_big_fb
results: parsing output: 3/ for test: gem_tiled_fence_blits
results: parsing output: 4/ for test: kms_psr
results: parsing output: 5/ for test: kms_getfb
results: parsing output: 6/ for test: kms_flip
results: parsing output: 7/ for test: core_auth
results: parsing output: 8/ for test: kms_invalid_mode
results: parsing output: 9/ for test: prime_mmap
results: parsing output: 10/ for test: kms_flip_scaled_crc
results: parsing output: 11/ for test: gem_mmap_wc
results: parsing output: 12/ for test: gem_exec_schedule
results: parsing output: 13/ for test: kms_cursor_crc
results: parsing output: 14/ for test: kms_atomic_transition
results: parsing output: 15/ for test: i915_drm_fdinfo
results: parsing output: 16/ for test: gem_exec_fence
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: kms_flip
results: parsing output: 19/ for test: perf_pmu
results: parsing output: 20/ for test: gem_exec_balancer
results: parsing output: 21/ for test: perf
results: parsing output: 22/ for test: kms_atomic_interruptible
results: parsing output: 23/ for test: kms_psr
results: parsing output: 24/ for test: kms_rotation_crc
results: parsing output: 25/ for test: kms_chamelium_color
results: parsing output: 26/ for test: gem_userptr_blits
results: parsing output: 27/ for test: vgem_basic
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: sriov_basic
results: parsing output: 30/ for test: syncobj_wait
results: parsing output: 31/ for test: kms_cursor_legacy
results: parsing output: 32/ for test: gem_exec_flush
results: parsing output: 33/ for test: kms_flip
results: parsing output: 34/ for test: i915_suspend
results: parsing output: 35/ for test: syncobj_timeline
results: parsing output: 36/ for test: kms_ccs
results: parsing output: 37/ for test: gem_exec_reloc
results: parsing output: 38/ for test: kms_joiner
results: parsing output: 39/ for test: kms_ccs
results: parsing output: 40/ for test: syncobj_timeline
results: parsing output: 41/ for test: gem_exec_whisper
results: parsing output: 42/ for test: gem_exec_schedule
results: parsing output: 43/ for test: kms_addfb_basic
results: parsing output: 44/ for test: gen9_exec_parse
results: parsing output: 45/ for test: gem_mmap_gtt
results: parsing output: 46/ for test: gem_softpin
results: parsing output: 47/ for test: gem_exec_params
results: parsing output: 48/ for test: kms_plane
results: parsing output: 49/ for test: syncobj_wait
results: parsing output: 50/ for test: gem_render_copy
results: parsing output: 51/ for test: kms_ccs
results: parsing output: 52/ for test: i915_hangman
results: parsing output: 53/ for test: kms_big_fb
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_psr2_sf
results: parsing output: 56/ for test: kms_async_flips
results: parsing output: 57/ for test: kms_plane_scaling
results: parsing output: 58/ for test: kms_cursor_legacy
results: parsing output: 59/ for test: drm_read
results: parsing output: 60/ for test: gem_userptr_blits
results: parsing output: 61/ for test: kms_psr
results: parsing output: 62/ for test: kms_psr
results: parsing output: 63/ for test: kms_async_flips
results: parsing output: 64/ for test: kms_cursor_legacy
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_cursor_crc
results: parsing output: 67/ for test: kms_atomic_transition
results: parsing output: 68/ for test: kms_psr
results: parsing output: 69/ for test: gem_ctx_persistence
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: kms_multipipe_modeset
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_pm_dc
results: parsing output: 77/ for test: gem_eio
results: parsing output: 78/ for test: gem_mmap_wc
results: parsing output: 79/ for test: syncobj_timeline
results: parsing output: 80/ for test: kms_big_fb
results: parsing output: 81/ for test: fbdev
results: parsing output: 82/ for test: gem_ctx_shared
results: parsing output: 83/ for test: kms_dsc
results: parsing output: 84/ for test: gem_workarounds
results: parsing output: 85/ for test: gem_pread
results: parsing output: 86/ for test: gem_exec_balancer
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: perf
results: parsing output: 89/ for test: syncobj_timeline
results: parsing output: 90/ for test: kms_vblank
results: parsing output: 91/ for test: gem_render_copy_redux
results: parsing output: 92/ for test: syncobj_timeline
results: parsing output: 93/ for test: gem_busy
results: parsing output: 94/ for test: syncobj_wait
results: parsing output: 95/ for test: sw_sync
results: parsing output: 96/ for test: kms_big_fb
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: perf
results: parsing output: 99/ for test: kms_psr
results: parsing output: 100/ for test: kms_color
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_big_fb
results: parsing output: 103/ for test: sysfs_defaults
results: parsing output: 104/ for test: i915_pm_rps
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_getfb
results: parsing output: 107/ for test: gem_ctx_engines
results: parsing output: 108/ for test: kms_plane
results: parsing output: 109/ for test: kms_debugfs
results: parsing output: 110/ for test: dumb_buffer
results: parsing output: 111/ for test: kms_ccs
results: parsing output: 112/ for test: kms_universal_plane
results: parsing output: 113/ for test: gem_render_copy
results: parsing output: 114/ for test: gem_mmap_gtt
results: parsing output: 115/ for test: api_intel_allocator
results: parsing output: 116/ for test: kms_content_protection
results: parsing output: 117/ for test: gem_exec_params
results: parsing output: 118/ for test: kms_psr2_sf
results: parsing output: 119/ for test: kms_getfb
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: gem_ctx_persistence
results: parsing output: 122/ for test: kms_big_fb
results: parsing output: 123/ for test: kms_big_fb
results: parsing output: 124/ for test: kms_chamelium_hpd
results: parsing output: 125/ for test: kms_prop_blob
results: parsing output: 126/ for test: vgem_basic
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: kms_cursor_crc
results: parsing output: 129/ for test: kms_flip
results: parsing output: 130/ for test: kms_chamelium_frames
results: parsing output: 131/ for test: kms_frontbuffer_tracking
results: parsing output: 132/ for test: kms_flip_scaled_crc
Done.