[57.818344] Initializing watchdogs
[57.818386]   /dev/watchdog0
[57.832353] [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]
[57.836539] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.838652] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.842367] [001/133] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-move)
[57.972401] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-move
[57.976695] Subtest fbcpsr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[58.084401] [002/133] (960s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt)
[58.177581] Starting subtest: psr-rgb565-draw-mmap-gtt
[58.182092] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[58.274041] [003/133] (960s left) gen9_exec_parse (bb-start-out)
[58.338541] Subtest bb-start-out: SKIP (0.000s)
[58.418053] [004/133] (960s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs)
[58.501447] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs
[58.503597] Starting dynamic subtest: pipe-A-eDP-1
[58.523678] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[58.532213] Starting dynamic subtest: pipe-B-eDP-1
[58.551824] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[58.558452] Starting dynamic subtest: pipe-C-eDP-1
[58.577661] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[58.583869] Starting dynamic subtest: pipe-D-eDP-1
[58.602373] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[58.604488] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs: SUCCESS (0.006s)
[60.759333] [005/133] (957s left) kms_pm_rpm (basic-pci-d3-state)
[63.122245] Starting subtest: basic-pci-d3-state
[64.591181] Subtest basic-pci-d3-state: SUCCESS (1.473s)
[64.689245] [006/133] (953s left) kms_feature_discovery (psr2)
[64.789043] Starting subtest: psr2
[64.791324] Subtest psr2: SUCCESS (0.000s)
[64.855305] [007/133] (953s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[64.955931] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-gtt
[64.960235] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[65.045869] [008/133] (953s left) fbdev (nullptr)
[65.089126] Starting subtest: nullptr
[65.091253] Subtest nullptr: SUCCESS (0.000s)
[65.141922] [009/133] (953s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-upscaling)
[65.236063] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-upscaling
[65.240224] Subtest flip-32bpp-ytile-to-64bpp-ytile-upscaling: SKIP (0.000s)
[65.300634] [010/133] (953s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs-cc)
[65.390807] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs-cc
[65.393185] Starting dynamic subtest: pipe-A-eDP-1
[65.420961] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[65.427560] Starting dynamic subtest: pipe-B-eDP-1
[65.448717] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[65.455193] Starting dynamic subtest: pipe-C-eDP-1
[65.476710] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[65.483072] Starting dynamic subtest: pipe-D-eDP-1
[65.504907] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[65.509073] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs-cc: SKIP (0.003s)
[67.711174] [011/133] (950s left) kms_prime (d3hot)
[67.806408] Subtest D3hot: SKIP (0.000s)
[67.927183] [FACT kms_prime (d3hot)] new: kernel.kmod_is_loaded.vgem: true
[67.930457] [012/133] (950s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-blt)
[68.026300] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-blt
[68.030404] Subtest fbc-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[68.124369] [013/133] (950s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180-hflip)
[68.213368] Starting subtest: linear-max-hw-stride-32bpp-rotate-180-hflip
[68.217876] Subtest linear-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[68.330316] [014/133] (950s left) gem_exec_schedule (u-fairslice)
[68.406691] Starting subtest: u-fairslice
[68.408643] Starting dynamic subtest: rcs0
[70.426248] Dynamic subtest rcs0: SUCCESS (2.028s)
[70.435883] Starting dynamic subtest: bcs0
[72.445683] Dynamic subtest bcs0: SUCCESS (2.019s)
[72.453823] Starting dynamic subtest: vcs0
[74.468761] Dynamic subtest vcs0: SUCCESS (2.024s)
[74.477902] Starting dynamic subtest: vcs1
[76.487553] Dynamic subtest vcs1: SUCCESS (2.019s)
[76.496138] Starting dynamic subtest: vecs0
[78.508754] Dynamic subtest vecs0: SUCCESS (2.020s)
[78.518116] Starting dynamic subtest: ccs0
[80.532657] Dynamic subtest ccs0: SUCCESS (2.022s)
[80.534676] Subtest u-fairslice: SUCCESS (12.134s)
[80.828837] [015/133] (938s left) kms_pipe_b_c_ivb (pipe-b-double-modeset-then-modeset-pipe-c)
[80.893162] Subtest pipe-B-double-modeset-then-modeset-pipe-C: SKIP (0.000s)
[80.956902] [016/133] (937s left) prime_vgem (basic-blt)
[81.033698] Starting subtest: basic-blt
[81.058143] Subtest basic-blt: SUCCESS (0.026s)
[81.198049] [017/133] (937s left) gem_pxp (protected-encrypted-src-copy-not-readible)
[81.329540] Starting subtest: protected-encrypted-src-copy-not-readible
[81.459342] Subtest protected-encrypted-src-copy-not-readible: SUCCESS (0.132s)
[81.584598] [018/133] (937s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[81.682639] Starting subtest: fbc-psr2-cursor-plane-update-sf
[81.685215] Starting dynamic subtest: pipe-A-eDP-1
[81.758938] Dynamic subtest pipe-A-eDP-1: SKIP (0.078s)
[81.766931] Starting dynamic subtest: pipe-B-eDP-1
[82.872972] Dynamic subtest pipe-B-eDP-1: SKIP (1.113s)
[82.877287] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (1.193s)
[84.055334] [019/133] (934s left) gem_ctx_exec (basic-invalid-context)
[84.108198] Starting subtest: basic-invalid-context
[84.112750] Subtest basic-invalid-context: SUCCESS (0.004s)
[84.247438] [020/133] (934s left) kms_frontbuffer_tracking (fbcpsr-slowdraw)
[84.344311] Starting subtest: fbcpsr-slowdraw
[109.571721] Subtest fbcpsr-slowdraw: SUCCESS (25.229s)
[109.716380] [021/133] (909s left) kms_flip (flip-vs-expired-vblank-interruptible)
[109.826037] Starting subtest: flip-vs-expired-vblank-interruptible
[109.828390] Starting dynamic subtest: A-eDP1
[118.493667] Dynamic subtest A-eDP1: SUCCESS (8.667s)
[118.503688] Starting dynamic subtest: B-eDP1
[127.107176] Dynamic subtest B-eDP1: SUCCESS (8.613s)
[127.116899] Starting dynamic subtest: C-eDP1
[135.744597] Dynamic subtest C-eDP1: SUCCESS (8.637s)
[135.754151] Starting dynamic subtest: D-eDP1
[144.353656] Dynamic subtest D-eDP1: SUCCESS (8.608s)
[144.358852] Subtest flip-vs-expired-vblank-interruptible: SUCCESS (34.533s)
[145.539622] [022/133] (873s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation)
[145.636922] Starting subtest: plane-scaler-with-clipping-clamping-rotation
[145.639218] Starting dynamic subtest: pipe-A
[145.874568] Dynamic subtest pipe-A: SUCCESS (0.240s)
[145.882302] Starting dynamic subtest: pipe-B
[147.215908] Dynamic subtest pipe-B: SUCCESS (1.341s)
[147.224489] Starting dynamic subtest: pipe-C
[148.560333] Dynamic subtest pipe-C: SUCCESS (1.344s)
[148.568527] Starting dynamic subtest: pipe-D
[149.899735] Dynamic subtest pipe-D: SUCCESS (1.338s)
[149.902049] Subtest plane-scaler-with-clipping-clamping-rotation: SUCCESS (4.266s)
[151.061632] [023/133] (868s left) gem_ctx_persistence (engines-persistence)
[151.130852] Starting subtest: engines-persistence
[151.133226] Starting dynamic subtest: rcs0
[151.956198] Dynamic subtest rcs0: SUCCESS (0.825s)
[151.968048] Starting dynamic subtest: bcs0
[152.712503] Dynamic subtest bcs0: SUCCESS (0.755s)
[152.722711] Starting dynamic subtest: vcs0
[153.467778] Dynamic subtest vcs0: SUCCESS (0.754s)
[153.475834] Starting dynamic subtest: vcs1
[154.252987] Dynamic subtest vcs1: SUCCESS (0.784s)
[154.263063] Starting dynamic subtest: vecs0
[155.022658] Dynamic subtest vecs0: SUCCESS (0.769s)
[155.032605] Starting dynamic subtest: ccs0
[155.788850] Dynamic subtest ccs0: SUCCESS (0.765s)
[155.791360] Subtest engines-persistence: SUCCESS (4.658s)
[155.869014] [024/133] (863s left) perf (invalid-oa-metric-set-id)
[156.011473] Starting subtest: invalid-oa-metric-set-id
[156.025256] Subtest invalid-oa-metric-set-id: SUCCESS (0.016s)
[156.074832] [025/133] (863s left) gem_exec_reloc (basic-gtt-noreloc)
[156.131498] Subtest basic-gtt-noreloc: SKIP (0.000s)
[156.213854] [026/133] (863s left) perf (gen12-group-exclusive-stream-sample-oa)
[156.306847] Starting subtest: gen12-group-exclusive-stream-sample-oa
[156.326658] Subtest gen12-group-exclusive-stream-sample-oa: SUCCESS (0.019s)
[156.370068] [027/133] (862s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted-signaled)
[156.421416] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[156.423754] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[156.528180] [028/133] (862s left) i915_selftest (perf)
[159.737197] Starting subtest: perf
[159.739995] Starting dynamic subtest: engine_cs
[162.432827] Dynamic subtest engine_cs: SUCCESS (2.695s)
[162.441305] Starting dynamic subtest: request
[167.712699] Dynamic subtest request: SUCCESS (5.279s)
[167.720903] Starting dynamic subtest: migrate
[170.566246] Dynamic subtest migrate: SUCCESS (2.852s)
[170.574057] Starting dynamic subtest: region
[176.272678] Dynamic subtest region: SUCCESS (5.705s)
[176.275448] Subtest perf: SUCCESS (16.535s)
[176.299908] [FACT i915_selftest (perf)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[176.300679] [FACT i915_selftest (perf)] deleted: kernel.kmod_is_loaded.i915: true
[176.303740] [029/133] (843s left) vgem_basic (bad-handle)
[176.356438] Starting subtest: bad-handle
[176.358505] Subtest bad-handle: SUCCESS (0.000s)
[176.390340] [030/133] (843s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt)
[177.955519] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt
[182.400268] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (4.448s)
[183.592662] [FACT kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[183.593886] [FACT kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt)] new: kernel.kmod_is_loaded.i915: true
[183.597438] [031/133] (835s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted)
[183.662468] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted
[183.769531] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.107s)
[183.855646] [032/133] (835s left) kms_flip (blocking-absolute-wf_vblank)
[183.957370] Starting subtest: blocking-absolute-wf_vblank
[183.959801] Starting dynamic subtest: A-eDP1
[192.715324] Dynamic subtest A-eDP1: SUCCESS (8.760s)
[192.722775] Starting dynamic subtest: B-eDP1
[201.441139] Dynamic subtest B-eDP1: SUCCESS (8.724s)
[201.450649] Starting dynamic subtest: C-eDP1
[210.159877] Dynamic subtest C-eDP1: SUCCESS (8.718s)
[210.172699] Starting dynamic subtest: D-eDP1
[218.880229] Dynamic subtest D-eDP1: SUCCESS (8.718s)
[218.886060] Subtest blocking-absolute-wf_vblank: SUCCESS (34.932s)
[220.088069] [033/133] (799s left) gem_mmap_gtt (basic-small-copy)
[220.149386] Subtest basic-small-copy: SKIP (0.000s)
[220.248620] [034/133] (799s left) gem_lmem_swapping (parallel-random-verify)
[220.302633] Subtest parallel-random-verify: SKIP (0.000s)
[220.347422] [035/133] (799s left) gem_render_copy (y-tiled-to-vebox-x-tiled)
[220.402223] Starting subtest: y-tiled-to-vebox-x-tiled
[220.406518] Subtest y-tiled-to-vebox-x-tiled: SKIP (0.000s)
[220.583454] [036/133] (799s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-sf)
[220.698851] Starting subtest: psr2-overlay-plane-move-continuous-exceed-sf
[220.701183] Starting dynamic subtest: pipe-A-eDP-1
[232.038162] Dynamic subtest pipe-A-eDP-1: SUCCESS (11.338s)
[232.045935] Starting dynamic subtest: pipe-B-eDP-1
[244.029508] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.988s)
[244.031462] Subtest psr2-overlay-plane-move-continuous-exceed-sf: SUCCESS (23.330s)
[244.866840] [037/133] (774s left) kms_properties (colorop-properties-atomic)
[244.967181] Starting subtest: colorop-properties-atomic
[244.969399] Starting dynamic subtest: pipe-A-eDP-1
[245.325668] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.357s)
[245.336478] Starting dynamic subtest: pipe-B-eDP-1
[246.437087] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.113s)
[246.445508] Starting dynamic subtest: pipe-C-eDP-1
[247.472616] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.031s)
[247.481424] Starting dynamic subtest: pipe-D-eDP-1
[248.505690] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.035s)
[248.508137] Subtest colorop-properties-atomic: SUCCESS (3.541s)
[249.304614] [038/133] (770s left) gem_ctx_param (invalid-param-get)
[249.365727] Starting subtest: invalid-param-get
[249.368128] Subtest invalid-param-get: SUCCESS (0.001s)
[249.465243] [039/133] (770s left) i915_module_load (reload)
[249.499970] Starting subtest: reload
[254.223694] Subtest reload: SUCCESS (4.725s)
[254.260452] [040/133] (765s left) kms_vblank (wait-idle)
[255.906365] Starting subtest: wait-idle
[255.908655] Starting dynamic subtest: pipe-A-eDP-1
[257.700475] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.793s)
[257.713835] Starting dynamic subtest: pipe-D-eDP-1
[260.101166] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.399s)
[260.103377] Subtest wait-idle: SUCCESS (4.195s)
[260.921372] [041/133] (759s left) i915_drm_fdinfo (virtual-busy-all)
[260.966262] Starting subtest: virtual-busy-all
[260.969857] Subtest virtual-busy-all: SKIP (0.000s)
[261.029273] [042/133] (758s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-pwrite)
[261.123956] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-pwrite
[261.127967] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[261.217738] [043/133] (758s left) kms_psr (psr2-primary-mmap-cpu)
[261.318997] Starting subtest: psr2-primary-mmap-cpu
[261.321742] Starting dynamic subtest: eDP-1
[263.003221] Dynamic subtest eDP-1: SUCCESS (1.684s)
[263.005518] Subtest psr2-primary-mmap-cpu: SUCCESS (1.685s)
[263.886743] [044/133] (756s left) i915_pm_freq_mult (media-freq)
[263.946760] Starting subtest: media-freq
[263.949089] Starting dynamic subtest: gt0
[263.953674] Dynamic subtest gt0: SKIP (0.000s)
[263.966920] Starting dynamic subtest: gt1
[263.971169] Dynamic subtest gt1: SKIP (0.000s)
[263.975483] Subtest media-freq: SKIP (0.001s)
[264.041855] [045/133] (756s left) kms_ccs (random-ccs-data-yf-tiled-ccs)
[264.120362] Starting subtest: random-ccs-data-yf-tiled-ccs
[264.122572] Starting dynamic subtest: pipe-A-eDP-1
[264.147569] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[264.158763] Starting dynamic subtest: pipe-B-eDP-1
[264.188241] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[264.197452] Starting dynamic subtest: pipe-C-eDP-1
[264.221143] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[264.228443] Starting dynamic subtest: pipe-D-eDP-1
[264.252370] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[264.256427] Subtest random-ccs-data-yf-tiled-ccs: SKIP (0.004s)
[266.291180] [046/133] (753s left) gem_exec_balancer (parallel-ordering)
[266.537222] Starting subtest: parallel-ordering
[267.488343] Subtest parallel-ordering: SUCCESS (0.950s)
[267.594308] [047/133] (752s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-plflip-blt)
[267.687820] Starting subtest: fbc-1p-primscrn-shrfb-plflip-blt
[272.344721] Subtest fbc-1p-primscrn-shrfb-plflip-blt: SUCCESS (4.660s)
[273.498370] [048/133] (746s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-onoff)
[273.617942] Starting subtest: psr-2p-primscrn-cur-indfb-onoff
[273.622401] Subtest psr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[273.715906] [049/133] (746s left) gem_exec_reloc (basic-write-cpu-noreloc)
[273.773313] Subtest basic-write-cpu-noreloc: SKIP (0.000s)
[273.844896] [050/133] (746s left) core_debugfs (read-all-entries)
[273.901085] Starting subtest: read-all-entries
[273.982748] Subtest read-all-entries: SUCCESS (0.082s)
[274.044969] [051/133] (746s left) gem_exec_gttfill (basic)
[274.109385] Starting subtest: basic
[276.756638] Subtest basic: SUCCESS (2.646s)
[276.941924] [052/133] (743s left) gem_ctx_bad_destroy (invalid-pad)
[277.038278] Starting subtest: invalid-pad
[277.040487] Subtest invalid-pad: SUCCESS (0.000s)
[277.109695] [053/133] (743s left) gem_lmem_swapping (heavy-verify-multi-ccs)
[277.166666] Subtest heavy-verify-multi-ccs: SKIP (0.000s)
[277.217570] [054/133] (743s left) syncobj_timeline (invalid-query-zero-handles)
[277.277094] Starting subtest: invalid-query-zero-handles
[277.279245] Subtest invalid-query-zero-handles: SUCCESS (0.000s)
[277.404822] [055/133] (743s left) gem_exec_schedule (implicit-write-read)
[277.475588] Starting subtest: implicit-write-read
[277.477770] Starting dynamic subtest: rcs0
[277.637963] Dynamic subtest rcs0: SUCCESS (0.170s)
[277.648242] Starting dynamic subtest: vcs0
[277.759845] Dynamic subtest vcs0: SUCCESS (0.121s)
[277.769212] Starting dynamic subtest: vcs1
[277.867422] Dynamic subtest vcs1: SUCCESS (0.105s)
[277.879033] Starting dynamic subtest: vecs0
[277.973034] Dynamic subtest vecs0: SUCCESS (0.106s)
[277.985489] Starting dynamic subtest: ccs0
[278.092028] Dynamic subtest ccs0: SUCCESS (0.117s)
[278.094577] Subtest implicit-write-read: SUCCESS (0.625s)
[279.027587] [056/133] (741s left) api_intel_allocator (simple-allocator)
[279.084941] Starting subtest: simple-allocator
[279.086823] Starting dynamic subtest: basic
[279.091344] Dynamic subtest basic: SUCCESS (0.007s)
[279.100462] Starting dynamic subtest: parallel-one
[279.274033] Dynamic subtest parallel-one: SUCCESS (0.183s)
[279.281739] Starting dynamic subtest: print
[279.284053] Dynamic subtest print: SUCCESS (0.000s)
[279.292071] Starting dynamic subtest: reuse
[279.294065] Dynamic subtest reuse: SUCCESS (0.000s)
[279.301619] Starting dynamic subtest: reserve
[279.303585] Dynamic subtest reserve: SUCCESS (0.000s)
[279.310706] Starting dynamic subtest: fork-reopen-allocator
[279.312629] Dynamic subtest fork-reopen-allocator: SUCCESS (0.012s)
[279.314520] Subtest simple-allocator: SUCCESS (0.205s)
[279.426999] [057/133] (741s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-gtt)
[279.536618] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-gtt
[279.541044] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[279.636411] [058/133] (740s left) kms_rotation_crc (cursor-rotation-180)
[279.731560] Starting subtest: cursor-rotation-180
[281.238644] Subtest cursor-rotation-180: SUCCESS (1.508s)
[282.446680] [059/133] (738s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-move)
[282.552051] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-move
[289.900988] Subtest fbcpsr-1p-primscrn-cur-indfb-move: SUCCESS (7.352s)
[290.026968] [060/133] (730s left) vgem_basic (sysfs)
[290.078817] Starting subtest: sysfs
[290.081425] Subtest sysfs: SUCCESS (0.001s)
[290.147744] [061/133] (730s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc)
[290.240516] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc
[290.242728] Starting dynamic subtest: pipe-A-eDP-1
[290.262132] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[290.272674] Starting dynamic subtest: pipe-B-eDP-1
[290.291404] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[290.299303] Starting dynamic subtest: pipe-C-eDP-1
[290.317991] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[290.325918] Starting dynamic subtest: pipe-D-eDP-1
[290.344895] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[290.347071] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.007s)
[292.495804] [062/133] (728s left) gem_close_race (basic-process)
[292.557447] Starting subtest: basic-process
[292.624233] Subtest basic-process: SUCCESS (0.066s)
[292.805932] [063/133] (728s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[292.919397] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu
[292.923635] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[293.017486] [064/133] (727s left) kms_cursor_crc (cursor-sliding-512x512)
[293.287892] Starting subtest: cursor-sliding-512x512
[293.292292] Subtest cursor-sliding-512x512: SKIP (0.001s)
[293.475910] [065/133] (727s left) kms_big_fb (y-tiled-8bpp-rotate-90)
[293.584356] Starting subtest: y-tiled-8bpp-rotate-90
[293.588762] Subtest y-tiled-8bpp-rotate-90: SKIP (0.000s)
[293.689328] [066/133] (727s left) kms_psr (pr-sprite-mmap-cpu)
[293.784618] Starting subtest: pr-sprite-mmap-cpu
[293.788274] Subtest pr-sprite-mmap-cpu: SKIP (0.000s)
[293.855267] [067/133] (727s left) kms_sequence (get-forked)
[293.947608] Starting subtest: get-forked
[293.949832] Starting dynamic subtest: pipe-A-eDP-1
[295.828644] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.880s)
[295.838218] Starting dynamic subtest: pipe-B-eDP-1
[298.352327] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.519s)
[298.361117] Starting dynamic subtest: pipe-C-eDP-1
[300.881290] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.530s)
[300.890802] Starting dynamic subtest: pipe-D-eDP-1
[303.382685] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.500s)
[303.385067] Subtest get-forked: SUCCESS (9.436s)
[304.248753] [068/133] (716s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted)
[304.303806] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted
[304.408898] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.105s)
[304.498569] [069/133] (716s left) gem_pwrite (basic-exhaustion)
[304.556374] Subtest basic-exhaustion: SKIP (0.000s)
[304.608810] [070/133] (716s left) kms_content_protection (atomic-dpms-hdcp14)
[304.754356] Starting subtest: atomic-dpms-hdcp14
[304.758798] Subtest atomic-dpms-hdcp14: SKIP (0.000s)
[304.882600] [071/133] (716s left) gem_ctx_param (invalid-size-get)
[304.930851] Starting subtest: invalid-size-get
[304.933087] Subtest invalid-size-get: SUCCESS (0.001s)
[305.017922] [072/133] (716s left) gem_exec_whisper (basic-contexts-forked)
[305.077616] Starting subtest: basic-contexts-forked
[328.493712] Subtest basic-contexts-forked: SUCCESS (23.411s)
[328.674257] [073/133] (692s left) kms_big_fb (4-tiled-32bpp-rotate-90)
[328.784354] Starting subtest: 4-tiled-32bpp-rotate-90
[328.804482] Subtest 4-tiled-32bpp-rotate-90: SKIP (0.019s)
[328.917779] [074/133] (692s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move)
[329.003624] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move
[329.008012] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[329.094391] [075/133] (692s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs)
[329.185913] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs
[329.188169] Starting dynamic subtest: pipe-A-eDP-1
[329.207514] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[329.218779] Starting dynamic subtest: pipe-B-eDP-1
[329.236960] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[329.244897] Starting dynamic subtest: pipe-C-eDP-1
[329.263404] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[329.271706] Starting dynamic subtest: pipe-D-eDP-1
[329.290942] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[329.292781] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs: SUCCESS (0.007s)
[331.485940] [076/133] (689s left) kms_cursor_crc (cursor-sliding-128x128)
[331.689940] Starting subtest: cursor-sliding-128x128
[331.694730] Starting dynamic subtest: pipe-A-eDP-1
[335.022165] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.326s)
[335.047933] Starting dynamic subtest: pipe-D-eDP-1
[338.914094] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.873s)
[338.916439] Subtest cursor-sliding-128x128: SUCCESS (7.225s)
[339.784601] [077/133] (681s left) kms_plane_cursor (primary)
[339.880181] Starting subtest: primary
[339.884233] Starting dynamic subtest: pipe-A-eDP-1-size-64
[342.421630] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.543s)
[342.446156] Starting dynamic subtest: pipe-A-eDP-1-size-128
[344.990154] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.549s)
[345.013366] Starting dynamic subtest: pipe-A-eDP-1-size-256
[347.547517] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.538s)
[347.862520] Starting dynamic subtest: pipe-B-eDP-1-size-64
[351.179057] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.327s)
[351.203729] Starting dynamic subtest: pipe-B-eDP-1-size-128
[353.746998] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.549s)
[353.771056] Starting dynamic subtest: pipe-B-eDP-1-size-256
[356.304054] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.538s)
[356.619854] Starting dynamic subtest: pipe-C-eDP-1-size-64
[359.556211] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.946s)
[359.582444] Starting dynamic subtest: pipe-C-eDP-1-size-128
[361.779316] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.203s)
[361.806270] Starting dynamic subtest: pipe-C-eDP-1-size-256
[363.990268] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.191s)
[364.312394] Starting dynamic subtest: pipe-D-eDP-1-size-64
[367.245102] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.943s)
[367.271974] Starting dynamic subtest: pipe-D-eDP-1-size-128
[369.434366] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.169s)
[369.459964] Starting dynamic subtest: pipe-D-eDP-1-size-256
[371.657797] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.204s)
[371.969062] Subtest primary: SUCCESS (32.088s)
[372.794956] [078/133] (648s left) kms_hdr (bpc-switch)
[372.893436] Starting subtest: bpc-switch
[373.950062] Starting dynamic subtest: pipe-A-eDP-1
[377.446784] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.496s)
[377.449155] Subtest bpc-switch: SUCCESS (4.557s)
[377.550497] [079/133] (643s left) kms_feature_discovery (display-1x)
[377.641193] Starting subtest: display-1x
[377.643540] Subtest display-1x: SUCCESS (0.000s)
[377.712718] [080/133] (643s left) gem_watchdog (default-physical)
[377.778782] Starting subtest: default-physical
[379.534230] Subtest default-physical: SUCCESS (1.766s)
[379.653092] [081/133] (641s left) kms_flip (dpms-vs-vblank-race-interruptible)
[379.749353] Starting subtest: dpms-vs-vblank-race-interruptible
[379.751644] Starting dynamic subtest: A-eDP1
[383.588825] Dynamic subtest A-eDP1: SUCCESS (3.838s)
[383.599763] Starting dynamic subtest: B-eDP1
[388.212471] Dynamic subtest B-eDP1: SUCCESS (4.622s)
[388.221261] Starting dynamic subtest: C-eDP1
[392.850394] Dynamic subtest C-eDP1: SUCCESS (4.637s)
[392.864252] Starting dynamic subtest: D-eDP1
[397.491267] Dynamic subtest D-eDP1: SUCCESS (4.638s)
[397.493539] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (17.743s)
[398.373872] [082/133] (623s left) i915_query (query-topology-unsupported)
[398.445706] Starting subtest: query-topology-unsupported
[398.450449] Subtest query-topology-unsupported: SKIP (0.000s)
[398.548628] [083/133] (623s left) kms_psr (fbc-psr2-sprite-mmap-cpu)
[398.635760] Starting subtest: fbc-psr2-sprite-mmap-cpu
[398.637987] Starting dynamic subtest: eDP-1
[398.642140] Dynamic subtest eDP-1: SKIP (0.000s)
[398.646252] Subtest fbc-psr2-sprite-mmap-cpu: SKIP (0.001s)
[398.708608] [084/133] (622s left) kms_psr (fbc-pr-sprite-plane-onoff)
[398.801111] Starting subtest: fbc-pr-sprite-plane-onoff
[398.805564] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s)
[398.874785] [085/133] (622s left) kms_psr (psr-no-drrs)
[398.968062] Starting subtest: psr-no-drrs
[398.970565] Starting dynamic subtest: eDP-1
[400.557076] Dynamic subtest eDP-1: SUCCESS (1.591s)
[400.559273] Subtest psr-no-drrs: SUCCESS (1.592s)
[401.421305] [086/133] (620s left) gem_ctx_persistence (legacy-engines-hostile)
[401.473715] Starting subtest: legacy-engines-hostile
[401.476045] Starting dynamic subtest: render
[401.543854] Dynamic subtest render: SUCCESS (0.069s)
[401.557371] Starting dynamic subtest: bsd1
[401.631466] Dynamic subtest bsd1: SUCCESS (0.084s)
[401.643080] Starting dynamic subtest: bsd2
[401.719044] Dynamic subtest bsd2: SUCCESS (0.085s)
[401.729872] Starting dynamic subtest: blt
[401.808728] Dynamic subtest blt: SUCCESS (0.087s)
[401.821113] Starting dynamic subtest: vebox
[401.901192] Dynamic subtest vebox: SUCCESS (0.089s)
[401.903804] Subtest legacy-engines-hostile: SUCCESS (0.428s)
[401.981646] [087/133] (619s left) gem_exec_fence (syncobj-repeat)
[402.483830] Starting subtest: syncobj-repeat
[402.665711] Subtest syncobj-repeat: SUCCESS (0.182s)
[404.040835] [088/133] (617s left) kms_color (legacy-gamma-reset)
[404.142419] Starting subtest: legacy-gamma-reset
[404.144315] Starting dynamic subtest: pipe-A-eDP-1
[404.516588] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.375s)
[404.525956] Starting dynamic subtest: pipe-B-eDP-1
[404.530813] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.012s)
[404.539586] Starting dynamic subtest: pipe-C-eDP-1
[404.541900] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.011s)
[404.550825] Starting dynamic subtest: pipe-D-eDP-1
[404.553130] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.012s)
[404.555414] Subtest legacy-gamma-reset: SUCCESS (0.413s)
[405.359341] [089/133] (616s left) gem_ctx_param (basic-default)
[405.426050] Starting subtest: basic-default
[405.428434] Subtest basic-default: SUCCESS (0.000s)
[405.500416] [090/133] (616s left) kms_joiner (invalid-modeset-big-joiner)
[405.600587] Starting subtest: invalid-modeset-big-joiner
[405.604816] Subtest invalid-modeset-big-joiner: SKIP (0.000s)
[405.671348] [091/133] (616s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-render)
[405.773959] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-render
[405.778501] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[405.894182] [092/133] (616s left) gem_exec_async (forked-writes)
[405.952968] Starting subtest: forked-writes
[405.955348] Starting dynamic subtest: rcs0
[405.979990] Dynamic subtest rcs0: SUCCESS (0.027s)
[405.990588] Starting dynamic subtest: bcs0
[406.006519] Dynamic subtest bcs0: SUCCESS (0.026s)
[406.016518] Starting dynamic subtest: vcs0
[406.028634] Dynamic subtest vcs0: SUCCESS (0.022s)
[406.037933] Starting dynamic subtest: vcs1
[406.050683] Dynamic subtest vcs1: SUCCESS (0.021s)
[406.060228] Starting dynamic subtest: vecs0
[406.072203] Dynamic subtest vecs0: SUCCESS (0.021s)
[406.081447] Starting dynamic subtest: ccs0
[406.094732] Dynamic subtest ccs0: SUCCESS (0.021s)
[406.096555] Subtest forked-writes: SUCCESS (0.143s)
[406.318434] [093/133] (615s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-cpu)
[406.413157] Starting subtest: fbc-rgb565-draw-mmap-cpu
[410.465828] Subtest fbc-rgb565-draw-mmap-cpu: SUCCESS (4.055s)
[411.646702] [094/133] (610s left) drm_read (short-buffer-wakeup)
[411.784945] Starting subtest: short-buffer-wakeup
[444.000996] Subtest short-buffer-wakeup: SUCCESS (32.215s)
[444.132404] [095/133] (578s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions)
[444.251601] Starting subtest: cursorA-vs-flipB-atomic-transitions
[444.256176] Subtest cursorA-vs-flipB-atomic-transitions: SKIP (0.001s)
[444.406825] [096/133] (577s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[444.511415] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu
[444.515750] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[444.611094] [097/133] (577s left) kms_rmfb (close-fd)
[444.711359] Starting subtest: close-fd
[444.713676] Starting dynamic subtest: pipe-A-eDP-1
[444.817908] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.106s)
[444.828205] Starting dynamic subtest: pipe-B-eDP-1
[445.997742] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.178s)
[446.007945] Starting dynamic subtest: pipe-C-eDP-1
[447.131026] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.134s)
[447.145260] Starting dynamic subtest: pipe-D-eDP-1
[448.256889] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.124s)
[448.259207] Subtest close-fd: SUCCESS (3.548s)
[449.485963] [098/133] (572s left) gem_mmap_offset (partial-remap)
[449.541532] Starting subtest: partial-remap
[449.543849] Starting dynamic subtest: smem0
[449.552934] Dynamic subtest smem0: SUCCESS (0.006s)
[449.555301] Subtest partial-remap: SUCCESS (0.008s)
[449.663465] [099/133] (572s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[449.757093] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[456.401462] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.646s)
[456.543854] [100/133] (565s left) gem_render_copy_redux (flink-interruptible)
[456.600323] Starting subtest: flink-interruptible
[457.383464] Subtest flink-interruptible: SUCCESS (0.783s)
[457.511894] [101/133] (564s left) kms_atomic_transition (plane-all-modeset-transition-fencing)
[457.609378] Starting subtest: plane-all-modeset-transition-fencing
[457.613230] Subtest plane-all-modeset-transition-fencing: SKIP (0.000s)
[457.684577] [102/133] (564s left) gem_exec_reloc (basic-wc-read-active)
[457.757580] Subtest basic-wc-read-active: SKIP (0.000s)
[457.833398] [103/133] (564s left) prime_mmap (test_map_unmap)
[457.897246] Starting subtest: test_map_unmap
[457.899116] Starting dynamic subtest: test_map_unmap-smem
[457.927767] Dynamic subtest test_map_unmap-smem: SUCCESS (0.030s)
[457.929794] Subtest test_map_unmap: SUCCESS (0.031s)
[458.028410] [104/133] (564s left) intel_hwmon (hwmon-read)
[458.092231] Subtest hwmon-read: SKIP (0.000s)
[458.151432] [105/133] (564s left) kms_chamelium_edid (hdmi-edid-stress-resolution-non-4k)
[458.540294] Subtest hdmi-edid-stress-resolution-non-4k: SKIP (0.000s)
[459.396400] [106/133] (563s left) kms_addfb_basic (bad-pitch-999)
[459.444165] Starting subtest: bad-pitch-999
[459.446020] Subtest bad-pitch-999: SUCCESS (0.000s)
[459.584790] [107/133] (563s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-msflip-blt)
[459.683572] Starting subtest: fbc-2p-primscrn-indfb-msflip-blt
[459.687731] Subtest fbc-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[459.778552] [108/133] (562s left) kms_legacy_colorkey (invalid-plane)
[459.862453] Starting subtest: invalid-plane
[459.864781] Starting dynamic subtest: zero-id
[459.867191] Dynamic subtest zero-id: SUCCESS (0.000s)
[459.877066] Starting dynamic subtest: outrange-id
[459.879164] Dynamic subtest outrange-id: SUCCESS (0.000s)
[459.881018] Subtest invalid-plane: SUCCESS (0.001s)
[459.933854] [109/133] (562s left) kms_big_fb (linear-32bpp-rotate-180)
[460.042465] Starting subtest: linear-32bpp-rotate-180
[461.665219] Subtest linear-32bpp-rotate-180: SUCCESS (1.623s)
[461.797699] [110/133] (560s left) kms_big_fb (x-tiled-addfb-size-offset-overflow)
[461.887083] Starting subtest: x-tiled-addfb-size-offset-overflow
[461.889095] Subtest x-tiled-addfb-size-offset-overflow: SUCCESS (0.000s)
[461.990269] [111/133] (560s left) perf (mi-rpc)
[462.113425] Starting subtest: mi-rpc
[462.116879] Subtest mi-rpc: SKIP (0.000s)
[462.155271] [112/133] (560s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-render)
[462.249020] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-render
[465.939992] Subtest fbc-1p-primscrn-spr-indfb-draw-render: SUCCESS (3.695s)
[467.113495] [113/133] (555s left) gem_eio (wait-1us)
[467.335571] Starting subtest: wait-1us
[467.679427] Subtest wait-1us: SUCCESS (0.343s)
[467.823763] [114/133] (555s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[467.905182] Starting subtest: read-crc-frame-sequence
[467.907131] Starting dynamic subtest: pipe-A-eDP-1
[468.621689] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.716s)
[468.631560] Starting dynamic subtest: pipe-B-eDP-1
[469.973878] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.349s)
[469.983639] Starting dynamic subtest: pipe-C-eDP-1
[471.268457] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.294s)
[471.277514] Starting dynamic subtest: pipe-D-eDP-1
[472.591942] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.322s)
[472.594348] Subtest read-crc-frame-sequence: SUCCESS (4.687s)
[473.434539] [115/133] (549s left) gem_exec_balancer (nop)
[473.495629] Starting subtest: nop
[520.156038] Subtest nop: SUCCESS (46.659s)
[520.444479] [116/133] (502s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[520.549422] Starting subtest: yf-tiled-8bpp-rotate-270
[520.554166] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[520.668456] [117/133] (502s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-pgflip-blt)
[520.776534] Starting subtest: fbc-2p-scndscrn-shrfb-pgflip-blt
[520.780800] Subtest fbc-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[520.864433] [118/133] (502s left) syncobj_timeline (wait-all-delayed-signal)
[520.922454] Starting subtest: wait-all-delayed-signal
[521.021447] Subtest wait-all-delayed-signal: SUCCESS (0.102s)
[521.098710] [119/133] (502s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[521.519045] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[522.341951] [120/133] (500s left) kms_atomic (atomic-invalid-params)
[522.447150] Starting subtest: atomic-invalid-params
[522.449282] Starting dynamic subtest: pipe-A-eDP-1
[522.867469] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.422s)
[522.869655] Subtest atomic-invalid-params: SUCCESS (0.423s)
[523.693465] [121/133] (499s left) kms_cursor_crc (cursor-offscreen-64x64)
[523.886398] Starting subtest: cursor-offscreen-64x64
[523.892434] Starting dynamic subtest: pipe-A-eDP-1
[525.809274] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.918s)
[525.837518] Starting dynamic subtest: pipe-D-eDP-1
[528.401447] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.571s)
[528.403915] Subtest cursor-offscreen-64x64: SUCCESS (4.514s)
[529.270262] [122/133] (494s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[529.374562] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[529.378998] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[529.483823] [123/133] (493s left) gem_exec_parallel (basic)
[529.543628] Starting subtest: basic
[529.546110] Starting dynamic subtest: rcs0
[530.966165] Dynamic subtest rcs0: SUCCESS (1.422s)
[530.976737] Starting dynamic subtest: bcs0
[532.458596] Dynamic subtest bcs0: SUCCESS (1.491s)
[532.471333] Starting dynamic subtest: vcs0
[533.969049] Dynamic subtest vcs0: SUCCESS (1.507s)
[533.984995] Starting dynamic subtest: vcs1
[535.893241] Dynamic subtest vcs1: SUCCESS (1.922s)
[535.904718] Starting dynamic subtest: vecs0
[537.877513] Dynamic subtest vecs0: SUCCESS (1.983s)
[537.889644] Starting dynamic subtest: ccs0
[539.346781] Dynamic subtest ccs0: SUCCESS (1.469s)
[539.349970] Subtest basic: SUCCESS (9.804s)
[539.549014] [124/133] (483s left) perf_pmu (busy-hang)
[539.589015] Starting subtest: busy-hang
[539.591645] Starting dynamic subtest: rcs0
[540.874200] Dynamic subtest rcs0: SUCCESS (1.286s)
[540.885252] Starting dynamic subtest: bcs0
[542.124904] Dynamic subtest bcs0: SUCCESS (1.246s)
[542.134071] Starting dynamic subtest: vcs0
[544.400232] Dynamic subtest vcs0: SUCCESS (2.276s)
[544.409212] Starting dynamic subtest: vcs1
[546.389291] Dynamic subtest vcs1: SUCCESS (1.984s)
[546.400203] Starting dynamic subtest: vecs0
[548.439182] Dynamic subtest vecs0: SUCCESS (2.052s)
[548.450426] Starting dynamic subtest: ccs0
[549.673205] Dynamic subtest ccs0: SUCCESS (1.232s)
[549.675748] Subtest busy-hang: SUCCESS (10.086s)
[549.773666] [125/133] (473s left) perf (oa-formats)
[549.864039] Starting subtest: oa-formats
[549.866562] Starting dynamic subtest: 0-rcs0
[549.882901] Dynamic subtest 0-rcs0: SUCCESS (0.019s)
[549.893346] Starting dynamic subtest: 1-vcs1
[549.904640] Dynamic subtest 1-vcs1: SUCCESS (0.021s)
[549.906957] Subtest oa-formats: SUCCESS (0.042s)
[549.949897] [126/133] (473s left) kms_cursor_legacy (flip-vs-cursor-varying-size)
[550.079535] Starting subtest: flip-vs-cursor-varying-size
[558.708560] Subtest flip-vs-cursor-varying-size: SUCCESS (8.626s)
[559.589304] [127/133] (463s left) gem_spin_batch (legacy-resubmit-new)
[559.658295] Starting subtest: legacy-resubmit-new
[559.660746] Starting dynamic subtest: default
[559.665948] Dynamic subtest default: SUCCESS (0.007s)
[559.677357] Starting dynamic subtest: render
[559.679597] Dynamic subtest render: SUCCESS (0.003s)
[559.688727] Starting dynamic subtest: bsd
[559.690851] Dynamic subtest bsd: SUCCESS (0.004s)
[559.699794] Starting dynamic subtest: bsd1
[559.701633] Dynamic subtest bsd1: SUCCESS (0.004s)
[559.710082] Starting dynamic subtest: bsd2
[559.712166] Dynamic subtest bsd2: SUCCESS (0.002s)
[559.720491] Starting dynamic subtest: blt
[559.722408] Dynamic subtest blt: SUCCESS (0.004s)
[559.731184] Starting dynamic subtest: vebox
[559.733314] Dynamic subtest vebox: SUCCESS (0.007s)
[559.735325] Subtest legacy-resubmit-new: SUCCESS (0.036s)
[560.955026] [128/133] (462s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions-varying-s
[561.068372] Starting subtest: short-busy-flip-before-cursor-atomic-transitions-varying-size
[561.072720] Subtest short-busy-flip-before-cursor-atomic-transitions-varying-size: SKIP (0.000s)
[561.212548] [129/133] (462s left) gem_exec_schedule (deep)
[561.391853] Starting subtest: deep
[561.394237] Starting dynamic subtest: rcs0
[567.295729] Dynamic subtest rcs0: SKIP (5.902s)
[567.308536] Starting dynamic subtest: vcs0
[578.339156] Dynamic subtest vcs0: SUCCESS (11.045s)
[578.349071] Starting dynamic subtest: vcs1
[590.001850] Dynamic subtest vcs1: SUCCESS (11.660s)
[590.018115] Starting dynamic subtest: vecs0
[602.110985] Dynamic subtest vecs0: SUCCESS (12.108s)
[602.124785] Starting dynamic subtest: ccs0
[614.889572] Dynamic subtest ccs0: SUCCESS (12.777s)
[614.892376] Subtest deep: SUCCESS (53.496s)
[615.907478] [130/133] (407s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted-signaled)
[615.963130] Starting subtest: multi-wait-available-unsubmitted-submitted-signaled
[615.965456] Subtest multi-wait-available-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[616.075872] [131/133] (407s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping)
[616.168112] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping
[616.172247] Subtest pixel-format-y-tiled-gen12-rc-ccs-modifier-source-clamping: SKIP (0.000s)
[616.241098] [132/133] (407s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-mc-ccs)
[616.325226] Starting subtest: crc-primary-suspend-y-tiled-gen12-mc-ccs
[616.327570] Starting dynamic subtest: pipe-A-eDP-1
[616.336691] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[616.350303] Starting dynamic subtest: pipe-B-eDP-1
[616.359287] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[616.370225] Starting dynamic subtest: pipe-C-eDP-1
[616.378866] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[616.387481] Starting dynamic subtest: pipe-D-eDP-1
[616.395920] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[616.400055] Subtest crc-primary-suspend-y-tiled-gen12-mc-ccs: SKIP (0.005s)
[618.556685] [133/133] (405s left) kms_plane (pixel-format-yf-tiled-ccs-modifier)
[618.655352] Starting subtest: pixel-format-yf-tiled-ccs-modifier
[618.659678] Subtest pixel-format-yf-tiled-ccs-modifier: SKIP (0.000s)
[618.724276] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: gen9_exec_parse
results: parsing output: 3/ for test: kms_ccs
results: parsing output: 4/ for test: kms_pm_rpm
results: parsing output: 5/ for test: kms_feature_discovery
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: fbdev
results: parsing output: 8/ for test: kms_flip_scaled_crc
results: parsing output: 9/ for test: kms_ccs
results: parsing output: 10/ for test: kms_prime
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: kms_big_fb
results: parsing output: 13/ for test: gem_exec_schedule
results: parsing output: 14/ for test: kms_pipe_b_c_ivb
results: parsing output: 15/ for test: prime_vgem
results: parsing output: 16/ for test: gem_pxp
results: parsing output: 17/ for test: kms_psr2_sf
results: parsing output: 18/ for test: gem_ctx_exec
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: kms_flip
results: parsing output: 21/ for test: kms_plane_scaling
results: parsing output: 22/ for test: gem_ctx_persistence
results: parsing output: 23/ for test: perf
results: parsing output: 24/ for test: gem_exec_reloc
results: parsing output: 25/ for test: perf
results: parsing output: 26/ for test: syncobj_wait
results: parsing output: 27/ for test: i915_selftest
results: parsing output: 28/ for test: vgem_basic
results: parsing output: 29/ for test: kms_frontbuffer_tracking
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: kms_flip
results: parsing output: 32/ for test: gem_mmap_gtt
results: parsing output: 33/ for test: gem_lmem_swapping
results: parsing output: 34/ for test: gem_render_copy
results: parsing output: 35/ for test: kms_psr2_sf
results: parsing output: 36/ for test: kms_properties
results: parsing output: 37/ for test: gem_ctx_param
results: parsing output: 38/ for test: i915_module_load
results: parsing output: 39/ for test: kms_vblank
results: parsing output: 40/ for test: i915_drm_fdinfo
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_psr
results: parsing output: 43/ for test: i915_pm_freq_mult
results: parsing output: 44/ for test: kms_ccs
results: parsing output: 45/ for test: gem_exec_balancer
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: gem_exec_reloc
results: parsing output: 49/ for test: core_debugfs
results: parsing output: 50/ for test: gem_exec_gttfill
results: parsing output: 51/ for test: gem_ctx_bad_destroy
results: parsing output: 52/ for test: gem_lmem_swapping
results: parsing output: 53/ for test: syncobj_timeline
results: parsing output: 54/ for test: gem_exec_schedule
results: parsing output: 55/ for test: api_intel_allocator
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_rotation_crc
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: vgem_basic
results: parsing output: 60/ for test: kms_ccs
results: parsing output: 61/ for test: gem_close_race
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_cursor_crc
results: parsing output: 64/ for test: kms_big_fb
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: kms_sequence
results: parsing output: 67/ for test: syncobj_timeline
results: parsing output: 68/ for test: gem_pwrite
results: parsing output: 69/ for test: kms_content_protection
results: parsing output: 70/ for test: gem_ctx_param
results: parsing output: 71/ for test: gem_exec_whisper
results: parsing output: 72/ for test: kms_big_fb
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_ccs
results: parsing output: 75/ for test: kms_cursor_crc
results: parsing output: 76/ for test: kms_plane_cursor
results: parsing output: 77/ for test: kms_hdr
results: parsing output: 78/ for test: kms_feature_discovery
results: parsing output: 79/ for test: gem_watchdog
results: parsing output: 80/ for test: kms_flip
results: parsing output: 81/ for test: i915_query
results: parsing output: 82/ for test: kms_psr
results: parsing output: 83/ for test: kms_psr
results: parsing output: 84/ for test: kms_psr
results: parsing output: 85/ for test: gem_ctx_persistence
results: parsing output: 86/ for test: gem_exec_fence
results: parsing output: 87/ for test: kms_color
results: parsing output: 88/ for test: gem_ctx_param
results: parsing output: 89/ for test: kms_joiner
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: gem_exec_async
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: drm_read
results: parsing output: 94/ for test: kms_cursor_legacy
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_rmfb
results: parsing output: 97/ for test: gem_mmap_offset
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: gem_render_copy_redux
results: parsing output: 100/ for test: kms_atomic_transition
results: parsing output: 101/ for test: gem_exec_reloc
results: parsing output: 102/ for test: prime_mmap
results: parsing output: 103/ for test: intel_hwmon
results: parsing output: 104/ for test: kms_chamelium_edid
results: parsing output: 105/ for test: kms_addfb_basic
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: kms_legacy_colorkey
results: parsing output: 108/ for test: kms_big_fb
results: parsing output: 109/ for test: kms_big_fb
results: parsing output: 110/ for test: perf
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: gem_eio
results: parsing output: 113/ for test: kms_pipe_crc_basic
results: parsing output: 114/ for test: gem_exec_balancer
results: parsing output: 115/ for test: kms_big_fb
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: syncobj_timeline
results: parsing output: 118/ for test: kms_chamelium_hpd
results: parsing output: 119/ for test: kms_atomic
results: parsing output: 120/ for test: kms_cursor_crc
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: gem_exec_parallel
results: parsing output: 123/ for test: perf_pmu
results: parsing output: 124/ for test: perf
results: parsing output: 125/ for test: kms_cursor_legacy
results: parsing output: 126/ for test: gem_spin_batch
results: parsing output: 127/ for test: kms_cursor_legacy
results: parsing output: 128/ for test: gem_exec_schedule
results: parsing output: 129/ for test: syncobj_timeline
results: parsing output: 130/ for test: kms_plane
results: parsing output: 131/ for test: kms_ccs
results: parsing output: 132/ for test: kms_plane
Done.