[58.552441] Initializing watchdogs
[58.552547]   /dev/watchdog0
[58.566661] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[58.570969] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.573276] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.576598] [001/133] (960s left) kms_sequence (get-idle)
[58.700235] Starting subtest: get-idle
[58.702744] Starting dynamic subtest: pipe-A-eDP-1
[61.310020] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.618s)
[61.322788] Starting dynamic subtest: pipe-B-eDP-1
[63.328753] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.024s)
[63.337056] Starting dynamic subtest: pipe-C-eDP-1
[65.828794] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.507s)
[65.840157] Starting dynamic subtest: pipe-D-eDP-1
[68.262557] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.437s)
[68.264847] Subtest get-idle: SUCCESS (9.592s)
[69.058470] [002/133] (950s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc)
[69.171965] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc
[69.176313] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[69.257169] [003/133] (949s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[69.361040] Starting subtest: fbc-psr2-cursor-plane-update-sf
[69.363388] Starting dynamic subtest: pipe-A-eDP-1
[69.436451] Dynamic subtest pipe-A-eDP-1: SKIP (0.078s)
[69.443801] Starting dynamic subtest: pipe-B-eDP-1
[70.536674] Dynamic subtest pipe-B-eDP-1: SKIP (1.100s)
[70.541074] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (1.180s)
[71.723114] [004/133] (947s left) perf (gen12-unprivileged-single-ctx-counters)
[71.864138] Starting subtest: gen12-unprivileged-single-ctx-counters
[71.866257] Starting dynamic subtest: rcs0
[72.047536] Dynamic subtest rcs0: SUCCESS (0.184s)
[72.050098] Subtest gen12-unprivileged-single-ctx-counters: SUCCESS (0.185s)
[72.091353] [005/133] (947s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-blt)
[72.210581] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-blt
[79.082357] Subtest psr-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (6.876s)
[79.239423] [006/133] (940s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-cc-modifier)
[79.326587] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-cc-modifier
[79.352835] Starting dynamic subtest: pipe-A-plane-0
[79.643901] Dynamic subtest pipe-A-plane-0: SUCCESS (0.289s)
[79.652089] Starting dynamic subtest: pipe-A-plane-3
[79.864142] Dynamic subtest pipe-A-plane-3: SUCCESS (0.222s)
[79.872698] Starting dynamic subtest: pipe-A-plane-5
[79.876910] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[80.950063] Starting dynamic subtest: pipe-B-plane-0
[81.255910] Dynamic subtest pipe-B-plane-0: SUCCESS (0.311s)
[81.264941] Starting dynamic subtest: pipe-B-plane-3
[81.478156] Dynamic subtest pipe-B-plane-3: SUCCESS (0.222s)
[81.487237] Starting dynamic subtest: pipe-B-plane-5
[81.492572] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[81.790099] Subtest pixel-format-4-tiled-mtl-rc-ccs-cc-modifier: SUCCESS (2.462s)
[82.622111] [007/133] (936s left) kms_psr (fbc-psr2-primary-mmap-gtt)
[82.723152] Starting subtest: fbc-psr2-primary-mmap-gtt
[82.725144] Starting dynamic subtest: eDP-1
[82.729327] Dynamic subtest eDP-1: SKIP (0.000s)
[82.733533] Subtest fbc-psr2-primary-mmap-gtt: SKIP (0.000s)
[82.826105] [008/133] (936s left) gem_render_copy (y-tiled-ccs-to-y-tiled)
[82.885022] Starting subtest: y-tiled-ccs-to-y-tiled
[82.889548] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s)
[83.063923] [009/133] (936s left) api_intel_allocator (two-level-inception-interruptible)
[83.115082] Starting subtest: two-level-inception-interruptible
[88.576048] Subtest two-level-inception-interruptible: SUCCESS (5.407s)
[88.647602] [010/133] (930s left) kms_flip (plain-flip-interruptible)
[88.782746] Starting subtest: plain-flip-interruptible
[88.787331] Starting dynamic subtest: A-eDP1
[90.537274] Dynamic subtest A-eDP1: SUCCESS (1.751s)
[90.551532] Starting dynamic subtest: B-eDP1
[92.268966] Dynamic subtest B-eDP1: SUCCESS (1.730s)
[92.280089] Starting dynamic subtest: C-eDP1
[93.877816] Dynamic subtest C-eDP1: SUCCESS (1.607s)
[93.885666] Starting dynamic subtest: D-eDP1
[95.525225] Dynamic subtest D-eDP1: SUCCESS (1.647s)
[95.529955] Subtest plain-flip-interruptible: SUCCESS (6.746s)
[96.678993] [011/133] (922s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs)
[96.767333] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs
[96.771808] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[97.913409] [012/133] (921s left) kms_flip (2x-flip-vs-fences)
[98.013157] Starting subtest: 2x-flip-vs-fences
[98.017833] Subtest 2x-flip-vs-fences: SKIP (0.000s)
[98.125507] [013/133] (921s left) kms_chamelium_hpd (vga-hpd-after-suspend)
[98.506431] Subtest vga-hpd-after-suspend: SKIP (0.000s)
[99.317562] [014/133] (920s left) gem_mmap_gtt (basic-small-copy-xy)
[99.370504] Subtest basic-small-copy-XY: SKIP (0.000s)
[99.423199] [015/133] (920s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-gtt)
[99.529071] Starting subtest: psr-rgb101010-draw-mmap-gtt
[99.533663] Subtest psr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[99.622698] [016/133] (920s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-signa
[99.681786] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-signaled
[99.785820] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-signaled: SUCCESS (0.103s)
[99.871369] [017/133] (919s left) gem_exec_schedule (submit-golden-slice)
[99.930886] Starting subtest: submit-golden-slice
[99.932860] Starting dynamic subtest: rcs0
[99.987373] Dynamic subtest rcs0: SUCCESS (0.062s)
[99.999019] Starting dynamic subtest: bcs0
[100.015278] Dynamic subtest bcs0: SUCCESS (0.028s)
[100.023395] Starting dynamic subtest: vcs0
[100.049896] Dynamic subtest vcs0: SUCCESS (0.034s)
[100.061786] Starting dynamic subtest: vcs1
[100.085184] Dynamic subtest vcs1: SUCCESS (0.035s)
[100.093780] Starting dynamic subtest: vecs0
[100.116942] Dynamic subtest vecs0: SUCCESS (0.032s)
[100.125277] Starting dynamic subtest: ccs0
[100.157061] Dynamic subtest ccs0: SUCCESS (0.040s)
[100.159303] Subtest submit-golden-slice: SUCCESS (0.233s)
[101.924093] [018/133] (917s left) kms_psr (psr-cursor-mmap-cpu)
[102.021962] Starting subtest: psr-cursor-mmap-cpu
[102.024360] Starting dynamic subtest: eDP-1
[103.734546] Dynamic subtest eDP-1: SUCCESS (1.713s)
[103.736583] Subtest psr-cursor-mmap-cpu: SUCCESS (1.713s)
[104.589352] [019/133] (915s left) kms_big_fb (x-tiled-32bpp-rotate-270)
[104.693906] Starting subtest: x-tiled-32bpp-rotate-270
[104.716325] Subtest x-tiled-32bpp-rotate-270: SKIP (0.019s)
[104.840078] [020/133] (914s left) kms_flip (flip-vs-blocking-wf-vblank)
[104.943919] Starting subtest: flip-vs-blocking-wf-vblank
[104.946282] Starting dynamic subtest: A-eDP1
[113.842854] Dynamic subtest A-eDP1: SUCCESS (8.901s)
[113.851759] Starting dynamic subtest: B-eDP1
[122.770160] Dynamic subtest B-eDP1: SUCCESS (8.926s)
[122.777273] Starting dynamic subtest: C-eDP1
[131.734085] Dynamic subtest C-eDP1: SUCCESS (8.915s)
[131.744330] Starting dynamic subtest: D-eDP1
[140.674884] Dynamic subtest D-eDP1: SUCCESS (8.938s)
[140.676993] Subtest flip-vs-blocking-wf-vblank: SUCCESS (35.690s)
[141.840398] [021/133] (878s left) gem_mmap_gtt (isolation)
[141.889470] Subtest isolation: SKIP (0.000s)
[141.950795] [022/133] (877s left) kms_atomic_transition (plane-all-modeset-transition-internal-panels)
[142.044830] Starting subtest: plane-all-modeset-transition-internal-panels
[142.047039] Starting dynamic subtest: pipe-A-eDP-1
[143.386717] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.341s)
[143.670933] Starting dynamic subtest: pipe-B-eDP-1
[144.715359] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.053s)
[144.985606] Subtest plane-all-modeset-transition-internal-panels: SUCCESS (2.942s)
[145.828132] [023/133] (874s left) syncobj_timeline (single-wait-for-submit-available-submitted)
[145.894954] Starting subtest: single-wait-for-submit-available-submitted
[145.897265] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.000s)
[145.973296] [024/133] (873s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen)
[146.070788] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen
[146.074843] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[146.179017] [025/133] (873s left) vgem_basic (setversion)
[146.258356] Starting subtest: setversion
[146.262445] Subtest setversion: SUCCESS (0.000s)
[146.307032] [FACT vgem_basic (setversion)] new: kernel.kmod_is_loaded.vgem: true
[146.310160] [026/133] (873s left) syncobj_timeline (invalid-query-illegal-handle)
[146.367981] Starting subtest: invalid-query-illegal-handle
[146.370189] Subtest invalid-query-illegal-handle: SUCCESS (0.000s)
[146.466982] [027/133] (873s left) gem_ctx_persistence (engines-persistence)
[146.531875] Starting subtest: engines-persistence
[146.534150] Starting dynamic subtest: rcs0
[147.347076] Dynamic subtest rcs0: SUCCESS (0.814s)
[147.357972] Starting dynamic subtest: bcs0
[148.110967] Dynamic subtest bcs0: SUCCESS (0.763s)
[148.120450] Starting dynamic subtest: vcs0
[148.885797] Dynamic subtest vcs0: SUCCESS (0.774s)
[148.896536] Starting dynamic subtest: vcs1
[149.649831] Dynamic subtest vcs1: SUCCESS (0.762s)
[149.664944] Starting dynamic subtest: vecs0
[150.399810] Dynamic subtest vecs0: SUCCESS (0.748s)
[150.408834] Starting dynamic subtest: ccs0
[151.175538] Dynamic subtest ccs0: SUCCESS (0.775s)
[151.177984] Subtest engines-persistence: SUCCESS (4.644s)
[151.297997] [028/133] (868s left) gem_request_retire (retire-vma-not-inactive)
[151.354322] Starting subtest: retire-vma-not-inactive
[151.417339] Subtest retire-vma-not-inactive: SUCCESS (0.060s)
[151.527144] [029/133] (868s left) kms_cursor_crc (cursor-onscreen-128x128)
[151.734897] Starting subtest: cursor-onscreen-128x128
[151.737266] Starting dynamic subtest: pipe-A-eDP-1
[153.834667] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.096s)
[153.863788] Starting dynamic subtest: pipe-D-eDP-1
[156.601124] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.743s)
[156.603497] Subtest cursor-onscreen-128x128: SUCCESS (4.865s)
[157.420505] [030/133] (862s left) kms_color (invalid-ctm-matrix-sizes)
[157.509500] Starting subtest: invalid-ctm-matrix-sizes
[157.511765] Starting dynamic subtest: pipe-A
[157.514072] Dynamic subtest pipe-A: SUCCESS (0.002s)
[157.525413] Starting dynamic subtest: pipe-B
[157.527316] Dynamic subtest pipe-B: SUCCESS (0.003s)
[157.538121] Starting dynamic subtest: pipe-C
[157.540401] Dynamic subtest pipe-C: SUCCESS (0.003s)
[157.547338] Starting dynamic subtest: pipe-D
[157.549193] Dynamic subtest pipe-D: SUCCESS (0.004s)
[157.551068] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.013s)
[157.603853] [031/133] (862s left) kms_pipe_crc_basic (bad-source)
[157.696897] Starting subtest: bad-source
[157.698917] Subtest bad-source: SUCCESS (0.000s)
[157.781414] [032/133] (862s left) kms_dirtyfb (psr-dirtyfb-ioctl)
[157.872194] Starting subtest: psr-dirtyfb-ioctl
[157.874582] Starting dynamic subtest: A-eDP-1
[161.828098] Dynamic subtest A-eDP-1: SUCCESS (3.954s)
[161.830115] Subtest psr-dirtyfb-ioctl: SUCCESS (3.955s)
[162.700791] [033/133] (857s left) kms_rotation_crc (primary-y-tiled-reflect-x-90)
[162.798641] Starting subtest: primary-y-tiled-reflect-x-90
[162.803164] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s)
[162.871238] [034/133] (857s left) gem_exec_reloc (basic-gtt-active)
[162.934808] Subtest basic-gtt-active: SKIP (0.000s)
[162.990518] [035/133] (857s left) kms_rotation_crc (bad-tiling)
[163.083620] Starting subtest: bad-tiling
[163.087814] Subtest bad-tiling: SKIP (0.001s)
[163.153346] [036/133] (857s left) kms_async_flips (invalid-async-flip)
[163.244687] Starting subtest: invalid-async-flip
[163.627939] Starting dynamic subtest: pipe-A-eDP-1
[164.425430] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.797s)
[164.789591] Starting dynamic subtest: pipe-B-eDP-1
[165.567311] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.786s)
[165.924581] Starting dynamic subtest: pipe-C-eDP-1
[166.677182] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.758s)
[167.028062] Starting dynamic subtest: pipe-D-eDP-1
[167.805728] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.785s)
[167.808301] Subtest invalid-async-flip: SUCCESS (4.563s)
[168.957716] [037/133] (851s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[169.054344] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[169.058982] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[169.171481] [038/133] (851s left) gem_mmap_gtt (basic-small-bo-tiledx)
[169.227102] Subtest basic-small-bo-tiledX: SKIP (0.000s)
[169.290806] [039/133] (851s left) gem_mmap_wc (coherency)
[169.338647] Subtest coherency: SKIP (0.000s)
[169.398119] [040/133] (851s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-downscaling)
[169.481935] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-downscaling
[169.486047] Subtest flip-64bpp-ytile-to-32bpp-ytile-downscaling: SKIP (0.000s)
[169.549140] [041/133] (851s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[169.634042] Starting subtest: plane-upscale-20x20-with-rotation
[169.636343] Starting dynamic subtest: pipe-A
[169.858294] Dynamic subtest pipe-A: SUCCESS (0.227s)
[169.866731] Starting dynamic subtest: pipe-B
[171.143902] Dynamic subtest pipe-B: SUCCESS (1.284s)
[171.155704] Starting dynamic subtest: pipe-C
[172.475320] Dynamic subtest pipe-C: SUCCESS (1.330s)
[172.483834] Starting dynamic subtest: pipe-D
[173.808171] Dynamic subtest pipe-D: SUCCESS (1.331s)
[173.810633] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.177s)
[174.992697] [042/133] (845s left) kms_content_protection (atomic-dpms)
[175.128425] Starting subtest: atomic-dpms
[175.133263] Subtest atomic-dpms: SKIP (0.000s)
[175.257737] [043/133] (845s left) gem_basic (multigpu-create-close)
[175.311832] Starting subtest: multigpu-create-close
[175.316145] Subtest multigpu-create-close: SKIP (0.000s)
[175.405576] [044/133] (845s left) gem_exec_flush (basic-wb-ro-before-default)
[175.477346] Starting subtest: basic-wb-ro-before-default
[180.965867] Subtest basic-wb-ro-before-default: SUCCESS (5.465s)
[181.131956] [045/133] (839s left) kms_atomic_interruptible (universal-setplane-cursor)
[181.233717] Starting subtest: universal-setplane-cursor
[181.236140] Starting dynamic subtest: pipe-A-eDP-1
[188.600763] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.367s)
[188.603057] Subtest universal-setplane-cursor: SUCCESS (7.368s)
[189.445728] [046/133] (831s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs)
[189.540315] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs
[189.542611] Starting dynamic subtest: pipe-A-eDP-1
[189.680417] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.131s)
[189.689099] Starting dynamic subtest: pipe-B-eDP-1
[189.708378] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[189.715575] Starting dynamic subtest: pipe-C-eDP-1
[189.734085] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.002s)
[189.740849] Starting dynamic subtest: pipe-D-eDP-1
[189.759293] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.002s)
[189.761434] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs: SUCCESS (0.139s)
[191.917360] [047/133] (828s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-render)
[192.007380] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-render
[196.576715] Subtest fbc-1p-primscrn-pri-indfb-draw-render: SUCCESS (4.572s)
[197.736759] [048/133] (823s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-rc-ccs)
[197.832924] Starting subtest: crc-primary-suspend-y-tiled-gen12-rc-ccs
[197.835765] Starting dynamic subtest: pipe-A-eDP-1
[197.845908] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[197.858953] Starting dynamic subtest: pipe-B-eDP-1
[197.867664] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[197.878563] Starting dynamic subtest: pipe-C-eDP-1
[197.887217] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[197.894175] Starting dynamic subtest: pipe-D-eDP-1
[197.902499] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[197.906664] Subtest crc-primary-suspend-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[200.079953] [049/133] (820s left) kms_big_fb (yf-tiled-8bpp-rotate-90)
[200.180171] Starting subtest: yf-tiled-8bpp-rotate-90
[200.184665] Subtest yf-tiled-8bpp-rotate-90: SKIP (0.000s)
[200.281955] [050/133] (820s left) i915_drm_fdinfo (virtual-busy)
[200.318965] Starting subtest: virtual-busy
[200.323256] Subtest virtual-busy: SKIP (0.000s)
[200.381418] [051/133] (820s left) syncobj_timeline (etime-single-wait-all-for-submit-unsubmitted)
[200.438418] Starting subtest: etime-single-wait-all-for-submit-unsubmitted
[200.544890] Subtest etime-single-wait-all-for-submit-unsubmitted: SUCCESS (0.106s)
[200.633228] [052/133] (820s left) gem_pxp (protected-raw-src-copy-not-readible)
[200.757820] Starting subtest: protected-raw-src-copy-not-readible
[200.824152] Subtest protected-raw-src-copy-not-readible: SUCCESS (0.068s)
[200.942216] [053/133] (820s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[201.496166] Starting subtest: syncobj-timeline-multiple-ext-nodes
[201.498837] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.003s)
[202.967316] [054/133] (818s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[203.031937] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[203.036776] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[203.228743] [055/133] (817s left) gem_tiled_pread_pwrite
[203.346931] [056/133] (817s left) gem_exec_whisper (basic-queues-priority-all)
[203.400302] Starting subtest: basic-queues-priority-all
[227.084713] Subtest basic-queues-priority-all: SUCCESS (23.683s)
[227.282562] [057/133] (793s left) gem_render_copy_redux (flink)
[227.328256] Starting subtest: flink
[228.433597] Subtest flink: SUCCESS (1.104s)
[228.559143] [058/133] (792s left) kms_cursor_crc (cursor-random-64x64)
[228.743896] Starting subtest: cursor-random-64x64
[228.748015] Starting dynamic subtest: pipe-A-eDP-1
[232.088341] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.338s)
[232.114262] Starting dynamic subtest: pipe-D-eDP-1
[236.117620] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.010s)
[236.119947] Subtest cursor-random-64x64: SUCCESS (7.375s)
[236.934278] [059/133] (784s left) gem_ctx_persistence (legacy-engines-mixed-process)
[237.001210] Starting subtest: legacy-engines-mixed-process
[237.003341] Starting dynamic subtest: render
[238.876753] Dynamic subtest render: SUCCESS (1.877s)
[238.887199] Starting dynamic subtest: bsd1
[240.898201] Dynamic subtest bsd1: SUCCESS (2.019s)
[240.908375] Starting dynamic subtest: bsd2
[242.885317] Dynamic subtest bsd2: SUCCESS (1.982s)
[242.894598] Starting dynamic subtest: blt
[244.882695] Dynamic subtest blt: SUCCESS (1.999s)
[244.891326] Starting dynamic subtest: vebox
[246.942757] Dynamic subtest vebox: SUCCESS (2.059s)
[246.945130] Subtest legacy-engines-mixed-process: SUCCESS (9.945s)
[247.021169] [060/133] (774s left) syncobj_wait (invalid-signal-zero-handles)
[247.078291] Starting subtest: invalid-signal-zero-handles
[247.080507] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[247.198702] [061/133] (774s left) vgem_basic (sysfs)
[247.241367] Starting subtest: sysfs
[247.243618] Subtest sysfs: SUCCESS (0.000s)
[247.294060] [062/133] (774s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-render)
[247.392217] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-render
[254.118229] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-render: SUCCESS (6.729s)
[254.263173] [063/133] (767s left) gem_workarounds (suspend-resume-fd)
[254.335058] Starting subtest: suspend-resume-fd
[270.229947] Subtest suspend-resume-fd: SUCCESS (1.289s)
[270.349091] [064/133] (751s left) gen9_exec_parse (bb-start-out)
[270.420849] Subtest bb-start-out: SKIP (0.000s)
[270.487120] [065/133] (751s left) kms_psr2_sf (psr2-plane-move-sf-dmg-area)
[270.585492] Starting subtest: psr2-plane-move-sf-dmg-area
[270.587671] Starting dynamic subtest: pipe-A-eDP-1
[275.073445] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.595s)
[275.082537] Starting dynamic subtest: pipe-B-eDP-1
[280.334853] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.326s)
[280.337149] Subtest psr2-plane-move-sf-dmg-area: SUCCESS (9.924s)
[281.192021] [066/133] (740s left) kms_psr (fbc-psr-sprite-render)
[281.291403] Starting subtest: fbc-psr-sprite-render
[281.293444] Starting dynamic subtest: eDP-1
[281.297264] Dynamic subtest eDP-1: SKIP (0.000s)
[281.300984] Subtest fbc-psr-sprite-render: SKIP (0.001s)
[281.376283] [067/133] (740s left) kms_cursor_legacy (cursorb-vs-flipb-toggle)
[281.485267] Starting subtest: cursorB-vs-flipB-toggle
[281.489449] Subtest cursorB-vs-flipB-toggle: SKIP (0.002s)
[281.629822] [068/133] (740s left) gem_ctx_shared (q-in-order)
[281.688129] Starting subtest: Q-in-order
[281.690431] Starting dynamic subtest: rcs0
[281.798894] Dynamic subtest rcs0: SUCCESS (0.112s)
[281.809180] Starting dynamic subtest: vcs0
[281.887676] Dynamic subtest vcs0: SUCCESS (0.090s)
[281.902405] Starting dynamic subtest: vcs1
[281.975246] Dynamic subtest vcs1: SUCCESS (0.087s)
[281.992422] Starting dynamic subtest: vecs0
[282.053616] Dynamic subtest vecs0: SUCCESS (0.077s)
[282.070795] Starting dynamic subtest: ccs0
[282.136955] Dynamic subtest ccs0: SUCCESS (0.083s)
[282.139551] Subtest Q-in-order: SUCCESS (0.456s)
[283.580764] [069/133] (738s left) gem_media_fill (media-fill)
[283.651718] Subtest media-fill: SKIP (0.000s)
[283.804527] [070/133] (738s left) api_intel_bb (render-ccs)
[283.863716] Starting subtest: render-ccs
[284.205962] Subtest render-ccs: SUCCESS (0.345s)
[284.315500] [071/133] (737s left) gem_userptr_blits (unsync-unmap-after-close)
[284.387396] Subtest unsync-unmap-after-close: SKIP (0.000s)
[284.523949] [072/133] (737s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[284.617259] Starting subtest: addfb25-y-tiled-small-legacy
[284.621268] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s)
[284.723897] [073/133] (737s left) kms_pm_rpm (modeset-non-lpsp)
[286.653342] Starting subtest: modeset-non-lpsp
[287.815811] Subtest modeset-non-lpsp: SKIP (1.162s)
[288.192066] [074/133] (733s left) kms_frontbuffer_tracking (fbcpsr-tiling-4)
[288.288515] Starting subtest: fbcpsr-tiling-4
[295.330774] Subtest fbcpsr-tiling-4: SUCCESS (7.062s)
[295.461344] [075/133] (726s left) gem_spin_batch (spin-each)
[295.518716] Starting subtest: spin-each
[298.786995] Subtest spin-each: SUCCESS (3.264s)
[299.592002] [076/133] (722s left) kms_invalid_mode (bad-htotal)
[299.696226] Starting subtest: bad-htotal
[299.698418] Starting dynamic subtest: pipe-A-eDP-1
[299.984100] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.288s)
[299.995761] Starting dynamic subtest: pipe-B-eDP-1
[299.997961] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[300.007120] Starting dynamic subtest: pipe-C-eDP-1
[300.009424] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[300.017852] Starting dynamic subtest: pipe-D-eDP-1
[300.020200] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[300.022426] Subtest bad-htotal: SUCCESS (0.294s)
[300.810780] [077/133] (721s left) gem_unfence_active_buffers
[300.971635] [078/133] (721s left) kms_ccs (missing-ccs-buffer-y-tiled-gen12-mc-ccs)
[301.060384] Starting subtest: missing-ccs-buffer-y-tiled-gen12-mc-ccs
[301.062572] Starting dynamic subtest: pipe-A-eDP-1
[301.088975] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[301.099019] Starting dynamic subtest: pipe-B-eDP-1
[301.120373] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[301.128661] Starting dynamic subtest: pipe-C-eDP-1
[301.150129] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[301.158697] Starting dynamic subtest: pipe-D-eDP-1
[301.180401] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[301.184763] Subtest missing-ccs-buffer-y-tiled-gen12-mc-ccs: SKIP (0.005s)
[303.365615] [079/133] (718s left) kms_plane_alpha_blend (alpha-7efc)
[303.465237] Starting subtest: alpha-7efc
[303.756879] Starting dynamic subtest: pipe-A-eDP-1
[304.415080] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.655s)
[304.439896] Starting dynamic subtest: pipe-D-eDP-1
[305.815683] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.383s)
[305.818063] Subtest alpha-7efc: SUCCESS (2.352s)
[306.656719] [080/133] (715s left) gem_vm_create (isolation)
[306.720013] Starting subtest: isolation
[306.728243] Subtest isolation: SUCCESS (0.009s)
[306.853764] [081/133] (715s left) kms_chamelium_frames (hdmi-aspect-ratio)
[307.245184] Subtest hdmi-aspect-ratio: SKIP (0.000s)
[308.057498] [082/133] (714s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[308.120427] Subtest no-spare-fences-interruptible: SKIP (0.000s)
[308.197757] [083/133] (714s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-pgflip-blt)
[308.303335] Starting subtest: psr-1p-primscrn-indfb-pgflip-blt
[315.626182] Subtest psr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.325s)
[315.738320] [084/133] (706s left) kms_vblank (ts-continuation-idle)
[315.839197] Starting subtest: ts-continuation-idle
[315.841010] Starting dynamic subtest: pipe-A-eDP-1
[316.235485] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.397s)
[316.253223] Starting dynamic subtest: pipe-D-eDP-1
[317.291214] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.054s)
[317.293660] Subtest ts-continuation-idle: SUCCESS (1.454s)
[318.170682] [085/133] (704s left) gem_exec_reloc (basic-range)
[318.229932] Subtest basic-range: SKIP (0.000s)
[318.297504] [086/133] (704s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[318.391639] Starting subtest: fbc-rgb565-draw-mmap-gtt
[318.395744] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[318.507080] [087/133] (704s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-pwrite)
[318.595442] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-pwrite
[326.249982] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (7.658s)
[326.387473] [088/133] (696s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-pwrite)
[326.495275] Starting subtest: fbcpsr-rgb101010-draw-pwrite
[333.512204] Subtest fbcpsr-rgb101010-draw-pwrite: SUCCESS (7.021s)
[333.620786] [089/133] (688s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-onoff)
[333.704426] Starting subtest: psr-2p-primscrn-spr-indfb-onoff
[333.708717] Subtest psr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[333.801234] [090/133] (688s left) gem_exec_balancer (parallel)
[334.069390] Starting subtest: parallel
[334.994273] Subtest parallel: SUCCESS (0.928s)
[335.560161] [091/133] (687s left) gem_ctx_param (invalid-size-get)
[335.606055] Starting subtest: invalid-size-get
[335.608498] Subtest invalid-size-get: SUCCESS (0.001s)
[335.701886] [092/133] (687s left) sysfs_timeslice_duration (timeout)
[335.757079] Starting subtest: timeout
[335.759252] Starting dynamic subtest: vecs0
[345.501119] Dynamic subtest vecs0: SUCCESS (9.746s)
[345.512939] Starting dynamic subtest: ccs0
[346.711286] Dynamic subtest ccs0: SUCCESS (1.209s)
[346.723413] Starting dynamic subtest: vcs0
[356.509566] Dynamic subtest vcs0: SUCCESS (9.800s)
[356.520587] Starting dynamic subtest: bcs0
[357.144792] Dynamic subtest bcs0: SUCCESS (0.636s)
[357.156870] Starting dynamic subtest: rcs0
[358.411657] Dynamic subtest rcs0: SUCCESS (1.263s)
[358.425059] Starting dynamic subtest: vcs1
[367.515890] Dynamic subtest vcs1: SUCCESS (9.105s)
[367.518419] Subtest timeout: SUCCESS (31.770s)
[367.591266] [093/133] (655s left) syncobj_wait (multi-wait-all-submitted-signaled)
[367.667691] Starting subtest: multi-wait-all-submitted-signaled
[367.771904] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.103s)
[367.854428] [094/133] (654s left) gem_exec_parallel (userptr)
[367.914025] Starting subtest: userptr
[367.916440] Starting dynamic subtest: rcs0
[369.451639] Dynamic subtest rcs0: SUCCESS (1.536s)
[369.464814] Starting dynamic subtest: bcs0
[370.937593] Dynamic subtest bcs0: SUCCESS (1.482s)
[370.949812] Starting dynamic subtest: vcs0
[372.535430] Dynamic subtest vcs0: SUCCESS (1.593s)
[372.546154] Starting dynamic subtest: vcs1
[374.496823] Dynamic subtest vcs1: SUCCESS (1.958s)
[374.509007] Starting dynamic subtest: vecs0
[376.479248] Dynamic subtest vecs0: SUCCESS (1.979s)
[376.491183] Starting dynamic subtest: ccs0
[377.960742] Dynamic subtest ccs0: SUCCESS (1.480s)
[377.963124] Subtest userptr: SUCCESS (10.044s)
[378.149473] [095/133] (644s left) kms_cdclk (mode-transition)
[378.241955] Starting subtest: mode-transition
[378.244303] Starting dynamic subtest: pipe-A-eDP-1
[378.532214] Dynamic subtest pipe-A-eDP-1: SKIP (0.288s)
[378.541929] Starting dynamic subtest: pipe-B-eDP-1
[378.546648] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[378.556897] Starting dynamic subtest: pipe-C-eDP-1
[378.561450] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[378.569952] Starting dynamic subtest: pipe-D-eDP-1
[378.573899] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[378.577852] Subtest mode-transition: SKIP (0.296s)
[379.351453] [096/133] (643s left) kms_psr (psr-dpms)
[379.440817] Starting subtest: psr-dpms
[379.443219] Starting dynamic subtest: eDP-1
[382.374644] Dynamic subtest eDP-1: SUCCESS (2.934s)
[382.376895] Subtest psr-dpms: SUCCESS (2.935s)
[383.236451] [097/133] (639s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-sf)
[383.339778] Starting subtest: fbc-pr-cursor-plane-move-continuous-sf
[383.344423] Subtest fbc-pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[383.406762] [098/133] (639s left) gem_exec_schedule (wide)
[383.596384] Starting subtest: wide
[383.598895] Starting dynamic subtest: rcs0
[393.494231] Dynamic subtest rcs0: SUCCESS (9.847s)
[393.506313] Starting dynamic subtest: vcs0
[404.421080] Dynamic subtest vcs0: SUCCESS (10.977s)
[404.429961] Starting dynamic subtest: vcs1
[413.971612] Dynamic subtest vcs1: SUCCESS (9.549s)
[413.983809] Starting dynamic subtest: vecs0
[425.469827] Dynamic subtest vecs0: SUCCESS (11.499s)
[425.481622] Starting dynamic subtest: ccs0
[439.900417] Dynamic subtest ccs0: SUCCESS (14.380s)
[439.902688] Subtest wide: SUCCESS (56.258s)
[441.647474] [099/133] (581s left) kms_big_fb (4-tiled-8bpp-rotate-180)
[441.770603] Starting subtest: 4-tiled-8bpp-rotate-180
[442.952434] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (1.183s)
[443.080012] [100/133] (579s left) syncobj_basic (bad-destroy)
[443.137097] Starting subtest: bad-destroy
[443.139089] Subtest bad-destroy: SUCCESS (0.000s)
[443.231100] [101/133] (579s left) gem_exec_balancer (sequential)
[443.288436] Starting subtest: sequential
[446.355069] Subtest sequential: SUCCESS (3.067s)
[446.692942] [102/133] (576s left) kms_rotation_crc (primary-rotation-90)
[446.795164] Starting subtest: primary-rotation-90
[446.799624] Subtest primary-rotation-90: SKIP (0.001s)
[446.881447] [103/133] (576s left) perf_pmu (most-busy-check-all)
[446.917554] Starting subtest: most-busy-check-all
[446.919500] Starting dynamic subtest: rcs0
[448.543645] Dynamic subtest rcs0: SUCCESS (1.626s)
[448.556037] Starting dynamic subtest: bcs0
[450.529021] Dynamic subtest bcs0: SUCCESS (1.982s)
[450.542558] Starting dynamic subtest: vcs0
[452.512610] Dynamic subtest vcs0: SUCCESS (1.981s)
[452.525968] Starting dynamic subtest: vcs1
[454.495675] Dynamic subtest vcs1: SUCCESS (1.980s)
[454.508981] Starting dynamic subtest: vecs0
[456.543710] Dynamic subtest vecs0: SUCCESS (2.046s)
[456.557001] Starting dynamic subtest: ccs0
[458.528802] Dynamic subtest ccs0: SUCCESS (1.983s)
[458.531793] Subtest most-busy-check-all: SUCCESS (11.616s)
[458.631667] [104/133] (564s left) i915_getparams_basic (basic-eu-total)
[458.704101] Starting subtest: basic-eu-total
[458.708454] Subtest basic-eu-total: SUCCESS (0.000s)
[458.795379] [105/133] (564s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-blt)
[458.896415] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-blt
[458.900785] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[458.992352] [106/133] (564s left) gem_create (create-massive)
[459.045863] Starting subtest: create-massive
[459.048200] Subtest create-massive: SUCCESS (0.000s)
[459.234019] [107/133] (564s left) kms_flip (nonexisting-fb)
[459.328369] Starting subtest: nonexisting-fb
[459.330764] Starting dynamic subtest: A-eDP1
[460.515174] Dynamic subtest A-eDP1: SUCCESS (1.186s)
[460.525004] Starting dynamic subtest: B-eDP1
[461.642292] Dynamic subtest B-eDP1: SUCCESS (1.126s)
[461.652415] Starting dynamic subtest: C-eDP1
[462.783319] Dynamic subtest C-eDP1: SUCCESS (1.140s)
[462.793540] Starting dynamic subtest: D-eDP1
[463.912193] Dynamic subtest D-eDP1: SUCCESS (1.128s)
[463.917151] Subtest nonexisting-fb: SUCCESS (4.590s)
[465.093408] [108/133] (558s left) i915_pm_rpm (debugfs-read)
[466.718582] Starting subtest: debugfs-read
[467.863184] Subtest debugfs-read: SUCCESS (1.147s)
[468.252288] [109/133] (555s left) kms_feature_discovery (dp-mst)
[468.347457] Starting subtest: dp-mst
[468.351567] Subtest dp-mst: SKIP (0.000s)
[468.434416] [110/133] (555s left) kms_psr (fbc-psr-cursor-plane-onoff)
[468.526788] Starting subtest: fbc-psr-cursor-plane-onoff
[468.529027] Starting dynamic subtest: eDP-1
[468.533114] Dynamic subtest eDP-1: SKIP (0.000s)
[468.537229] Subtest fbc-psr-cursor-plane-onoff: SKIP (0.001s)
[468.612551] [111/133] (554s left) syncobj_timeline (multi-wait-available-submitted)
[468.672786] Starting subtest: multi-wait-available-submitted
[468.674781] Subtest multi-wait-available-submitted: SUCCESS (0.000s)
[468.760937] [112/133] (554s left) i915_suspend (debugfs-reader)
[468.821314] Starting subtest: debugfs-reader
[487.213707] Subtest debugfs-reader: SUCCESS (3.157s)
[487.301605] [113/133] (536s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[487.398922] Starting subtest: plane-downscale-factor-0-75-with-rotation
[487.400933] Starting dynamic subtest: pipe-A
[487.622138] Dynamic subtest pipe-A: SUCCESS (0.230s)
[487.639213] Starting dynamic subtest: pipe-B
[488.917890] Dynamic subtest pipe-B: SUCCESS (1.327s)
[488.927976] Starting dynamic subtest: pipe-C
[490.223400] Dynamic subtest pipe-C: SUCCESS (1.331s)
[490.233003] Starting dynamic subtest: pipe-D
[491.536651] Dynamic subtest pipe-D: SUCCESS (1.335s)
[491.538922] Subtest plane-downscale-factor-0-75-with-rotation: SUCCESS (4.229s)
[492.710878] [114/133] (530s left) kms_lease (lease-invalid-crtc)
[492.802606] Starting subtest: lease-invalid-crtc
[492.804843] Starting dynamic subtest: pipe-A-eDP-1
[492.807187] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[492.816936] Starting dynamic subtest: pipe-B-eDP-1
[492.819231] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[492.828944] Starting dynamic subtest: pipe-C-eDP-1
[492.831115] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[492.840641] Starting dynamic subtest: pipe-D-eDP-1
[492.842773] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[492.844928] Subtest lease-invalid-crtc: SUCCESS (0.004s)
[492.881845] [115/133] (530s left) kms_big_fb (yf-tiled-32bpp-rotate-270)
[492.983181] Starting subtest: yf-tiled-32bpp-rotate-270
[492.987697] Subtest yf-tiled-32bpp-rotate-270: SKIP (0.000s)
[493.076437] [116/133] (530s left) gem_tiling_max_stride
[493.189219] [117/133] (530s left) kms_flip (2x-flip-vs-suspend)
[493.275948] Starting subtest: 2x-flip-vs-suspend
[493.284583] Subtest 2x-flip-vs-suspend: SKIP (0.010s)
[493.384291] [118/133] (530s left) gem_mmap_wc (pf-nonblock)
[493.438267] Subtest pf-nonblock: SKIP (0.000s)
[493.503530] [119/133] (530s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[493.579039] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[493.581158] Starting dynamic subtest: pipe-A-default-mode
[496.329653] Dynamic subtest pipe-A-default-mode: SUCCESS (2.778s)
[496.331935] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (2.779s)
[497.167225] [120/133] (526s left) gem_ctx_exec (basic)
[497.235086] Starting subtest: basic
[497.239910] Subtest basic: SUCCESS (0.005s)
[497.372429] [121/133] (526s left) gem_exec_schedule (lateslice)
[497.441033] Starting subtest: lateslice
[497.443059] Starting dynamic subtest: rcs0
[497.450906] Dynamic subtest rcs0: SUCCESS (0.020s)
[497.462788] Starting dynamic subtest: bcs0
[497.468893] Dynamic subtest bcs0: SUCCESS (0.018s)
[497.478363] Starting dynamic subtest: vcs0
[497.488133] Dynamic subtest vcs0: SUCCESS (0.019s)
[497.497587] Starting dynamic subtest: vcs1
[497.506433] Dynamic subtest vcs1: SUCCESS (0.018s)
[497.515700] Starting dynamic subtest: vecs0
[497.527349] Dynamic subtest vecs0: SUCCESS (0.020s)
[497.536648] Starting dynamic subtest: ccs0
[497.545127] Dynamic subtest ccs0: SUCCESS (0.018s)
[497.547403] Subtest lateslice: SUCCESS (0.117s)
[498.809988] [122/133] (525s left) kms_cursor_crc (cursor-suspend)
[498.935019] Starting subtest: cursor-suspend
[498.937269] Starting dynamic subtest: pipe-A-eDP-1
[531.682623] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.198s)
[531.691959] Starting dynamic subtest: pipe-D-eDP-1
[565.673769] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.767s)
[565.675612] Subtest cursor-suspend: SUCCESS (6.968s)
[566.462600] [123/133] (457s left) gem_exec_reloc (basic-write-wc-active)
[566.533374] Subtest basic-write-wc-active: SKIP (0.000s)
[566.606044] [124/133] (457s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[566.704671] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[567.466228] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.781s)
[567.640021] [125/133] (456s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-gtt)
[567.735171] Starting subtest: fbc-rgb101010-draw-mmap-gtt
[567.739498] Subtest fbc-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[567.820003] [126/133] (456s left) gem_create (create-valid-nonaligned)
[567.888248] Starting subtest: create-valid-nonaligned
[567.890468] Subtest create-valid-nonaligned: SUCCESS (0.000s)
[568.084960] [127/133] (456s left) gem_ctx_param (set-priority-range)
[568.133285] Starting subtest: set-priority-range
[568.148518] Subtest set-priority-range: SUCCESS (0.016s)
[568.261457] [128/133] (455s left) kms_big_fb (y-tiled-addfb-size-overflow)
[568.355182] Starting subtest: y-tiled-addfb-size-overflow
[568.359093] Subtest y-tiled-addfb-size-overflow: SKIP (0.000s)
[568.467159] [129/133] (455s left) prime_busy (hang)
[568.525098] Starting subtest: hang
[568.526965] Starting dynamic subtest: rcs0
[594.163191] Dynamic subtest rcs0: SUCCESS (25.780s)
[594.174956] Starting dynamic subtest: bcs0
[601.324626] Dynamic subtest bcs0: SUCCESS (7.161s)
[601.336230] Starting dynamic subtest: vcs0
[608.296596] Dynamic subtest vcs0: SUCCESS (6.965s)
[608.307942] Starting dynamic subtest: vcs1
[615.273448] Dynamic subtest vcs1: SUCCESS (6.975s)
[615.282266] Starting dynamic subtest: vecs0
[622.307061] Dynamic subtest vecs0: SUCCESS (7.033s)
[622.317186] Starting dynamic subtest: ccs0
[636.149442] Dynamic subtest ccs0: SUCCESS (13.842s)
[636.151884] Subtest hang: SUCCESS (67.763s)
[636.290751] [130/133] (388s left) device_reset (cold-reset-bound)
[636.339238] Starting subtest: cold-reset-bound
[636.343681] Subtest cold-reset-bound: SKIP (0.000s)
[636.416230] [131/133] (387s left) kms_plane_multiple (tiling-yf)
[636.513750] Starting subtest: tiling-yf
[636.518292] Subtest tiling-yf: SKIP (0.000s)
[636.588520] [132/133] (387s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[636.689432] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[643.983135] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.298s)
[644.093816] [133/133] (380s left) kms_pm_dc (dc6-dpms)
[645.185832] Starting subtest: dc6-dpms
[647.251932] Subtest dc6-dpms: SUCCESS (2.065s)
[647.323434] Closing watchdogs
results: parsing output: 0/ for test: kms_sequence
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_psr2_sf
results: parsing output: 3/ for test: perf
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_plane
results: parsing output: 6/ for test: kms_psr
results: parsing output: 7/ for test: gem_render_copy
results: parsing output: 8/ for test: api_intel_allocator
results: parsing output: 9/ for test: kms_flip
results: parsing output: 10/ for test: kms_ccs
results: parsing output: 11/ for test: kms_flip
results: parsing output: 12/ for test: kms_chamelium_hpd
results: parsing output: 13/ for test: gem_mmap_gtt
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: gem_exec_schedule
results: parsing output: 17/ for test: kms_psr
results: parsing output: 18/ for test: kms_big_fb
results: parsing output: 19/ for test: kms_flip
results: parsing output: 20/ for test: gem_mmap_gtt
results: parsing output: 21/ for test: kms_atomic_transition
results: parsing output: 22/ for test: syncobj_timeline
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: vgem_basic
results: parsing output: 25/ for test: syncobj_timeline
results: parsing output: 26/ for test: gem_ctx_persistence
results: parsing output: 27/ for test: gem_request_retire
results: parsing output: 28/ for test: kms_cursor_crc
results: parsing output: 29/ for test: kms_color
results: parsing output: 30/ for test: kms_pipe_crc_basic
results: parsing output: 31/ for test: kms_dirtyfb
results: parsing output: 32/ for test: kms_rotation_crc
results: parsing output: 33/ for test: gem_exec_reloc
results: parsing output: 34/ for test: kms_rotation_crc
results: parsing output: 35/ for test: kms_async_flips
results: parsing output: 36/ for test: kms_big_fb
results: parsing output: 37/ for test: gem_mmap_gtt
results: parsing output: 38/ for test: gem_mmap_wc
results: parsing output: 39/ for test: kms_flip_scaled_crc
results: parsing output: 40/ for test: kms_plane_scaling
results: parsing output: 41/ for test: kms_content_protection
results: parsing output: 42/ for test: gem_basic
results: parsing output: 43/ for test: gem_exec_flush
results: parsing output: 44/ for test: kms_atomic_interruptible
results: parsing output: 45/ for test: kms_ccs
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: kms_ccs
results: parsing output: 48/ for test: kms_big_fb
results: parsing output: 49/ for test: i915_drm_fdinfo
results: parsing output: 50/ for test: syncobj_timeline
results: parsing output: 51/ for test: gem_pxp
results: parsing output: 52/ for test: gem_exec_fence
results: parsing output: 53/ for test: gem_render_copy
results: parsing output: 54/ for test: gem_tiled_pread_pwrite
results: parsing output: 55/ for test: gem_exec_whisper
results: parsing output: 56/ for test: gem_render_copy_redux
results: parsing output: 57/ for test: kms_cursor_crc
results: parsing output: 58/ for test: gem_ctx_persistence
results: parsing output: 59/ for test: syncobj_wait
results: parsing output: 60/ for test: vgem_basic
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: gem_workarounds
results: parsing output: 63/ for test: gen9_exec_parse
results: parsing output: 64/ for test: kms_psr2_sf
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: kms_cursor_legacy
results: parsing output: 67/ for test: gem_ctx_shared
results: parsing output: 68/ for test: gem_media_fill
results: parsing output: 69/ for test: api_intel_bb
results: parsing output: 70/ for test: gem_userptr_blits
results: parsing output: 71/ for test: kms_addfb_basic
results: parsing output: 72/ for test: kms_pm_rpm
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: gem_spin_batch
results: parsing output: 75/ for test: kms_invalid_mode
results: parsing output: 76/ for test: gem_unfence_active_buffers
results: parsing output: 77/ for test: kms_ccs
results: parsing output: 78/ for test: kms_plane_alpha_blend
results: parsing output: 79/ for test: gem_vm_create
results: parsing output: 80/ for test: kms_chamelium_frames
results: parsing output: 81/ for test: gem_fenced_exec_thrash
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: kms_vblank
results: parsing output: 84/ for test: gem_exec_reloc
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: gem_exec_balancer
results: parsing output: 90/ for test: gem_ctx_param
results: parsing output: 91/ for test: sysfs_timeslice_duration
results: parsing output: 92/ for test: syncobj_wait
results: parsing output: 93/ for test: gem_exec_parallel
results: parsing output: 94/ for test: kms_cdclk
results: parsing output: 95/ for test: kms_psr
results: parsing output: 96/ for test: kms_psr2_sf
results: parsing output: 97/ for test: gem_exec_schedule
results: parsing output: 98/ for test: kms_big_fb
results: parsing output: 99/ for test: syncobj_basic
results: parsing output: 100/ for test: gem_exec_balancer
results: parsing output: 101/ for test: kms_rotation_crc
results: parsing output: 102/ for test: perf_pmu
results: parsing output: 103/ for test: i915_getparams_basic
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: gem_create
results: parsing output: 106/ for test: kms_flip
results: parsing output: 107/ for test: i915_pm_rpm
results: parsing output: 108/ for test: kms_feature_discovery
results: parsing output: 109/ for test: kms_psr
results: parsing output: 110/ for test: syncobj_timeline
results: parsing output: 111/ for test: i915_suspend
results: parsing output: 112/ for test: kms_plane_scaling
results: parsing output: 113/ for test: kms_lease
results: parsing output: 114/ for test: kms_big_fb
results: parsing output: 115/ for test: gem_tiling_max_stride
results: parsing output: 116/ for test: kms_flip
results: parsing output: 117/ for test: gem_mmap_wc
results: parsing output: 118/ for test: kms_flip_scaled_crc
results: parsing output: 119/ for test: gem_ctx_exec
results: parsing output: 120/ for test: gem_exec_schedule
results: parsing output: 121/ for test: kms_cursor_crc
results: parsing output: 122/ for test: gem_exec_reloc
results: parsing output: 123/ for test: kms_big_fb
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: gem_create
results: parsing output: 126/ for test: gem_ctx_param
results: parsing output: 127/ for test: kms_big_fb
results: parsing output: 128/ for test: prime_busy
results: parsing output: 129/ for test: device_reset
results: parsing output: 130/ for test: kms_plane_multiple
results: parsing output: 131/ for test: kms_frontbuffer_tracking
results: parsing output: 132/ for test: kms_pm_dc
Done.