[59.640071] Initializing watchdogs
[59.640118]   /dev/watchdog0
[59.656007] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[59.660104] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.662330] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.665469] [001/133] (960s left) perf (stress-open-close)
[59.811291] Starting subtest: stress-open-close
[59.813541] Starting dynamic subtest: 0-rcs0
[61.966434] Dynamic subtest 0-rcs0: SUCCESS (2.171s)
[61.975349] Starting dynamic subtest: 1-vcs0
[64.122595] Dynamic subtest 1-vcs0: SUCCESS (2.167s)
[64.124555] Subtest stress-open-close: SUCCESS (4.339s)
[64.164409] [002/133] (956s left) kms_chamelium_color (ctm-green-to-red)
[64.262459] Subtest ctm-green-to-red: SKIP (0.000s)
[64.304153] [003/133] (955s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs)
[64.360812] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs
[64.364429] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s)
[64.548150] [004/133] (955s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic)
[64.666989] Starting subtest: 2x-flip-vs-cursor-atomic
[64.671391] Subtest 2x-flip-vs-cursor-atomic: SKIP (0.002s)
[64.821180] [005/133] (955s left) syncobj_wait (multi-wait-all-submitted-signaled)
[64.881911] Starting subtest: multi-wait-all-submitted-signaled
[64.986093] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.104s)
[65.071735] [006/133] (955s left) kms_ccs (crc-primary-basic-4-tiled-dg2-mc-ccs)
[65.183175] Starting subtest: crc-primary-basic-4-tiled-dg2-mc-ccs
[65.185625] Starting dynamic subtest: pipe-A-eDP-1
[65.209548] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[65.225268] Starting dynamic subtest: pipe-B-eDP-1
[65.246720] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[65.253229] Starting dynamic subtest: pipe-C-eDP-1
[65.274900] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[65.281512] Starting dynamic subtest: pipe-D-eDP-1
[65.303190] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[65.307510] Subtest crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[67.420579] [007/133] (952s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling)
[67.722467] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling
[67.726725] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SKIP (0.000s)
[67.812736] [008/133] (952s left) syncobj_timeline (wait-all-snapshot)
[67.946424] Starting subtest: wait-all-snapshot
[68.025900] Subtest wait-all-snapshot: SUCCESS (0.081s)
[68.120496] [009/133] (952s left) kms_dirtyfb (drrs-dirtyfb-ioctl)
[68.222805] Starting subtest: drrs-dirtyfb-ioctl
[68.235201] Subtest drrs-dirtyfb-ioctl: SKIP (0.001s)
[68.340727] [010/133] (952s left) kms_cursor_edge_walk (64x64-top-edge)
[68.436372] Starting subtest: 64x64-top-edge
[68.438721] Starting dynamic subtest: pipe-A-eDP-1
[71.918565] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.485s)
[71.927912] Starting dynamic subtest: pipe-D-eDP-1
[75.026055] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.113s)
[75.028441] Subtest 64x64-top-edge: SUCCESS (6.600s)
[75.846562] [011/133] (944s left) i915_pm_rps (thresholds-park)
[75.919919] Starting subtest: thresholds-park
[75.924494] Subtest thresholds-park: SKIP (0.001s)
[76.064658] [012/133] (944s left) kms_cursor_crc (cursor-offscreen-max-size)
[76.380604] Starting subtest: cursor-offscreen-max-size
[76.387214] Subtest cursor-offscreen-max-size: SKIP (0.000s)
[76.527920] [013/133] (944s left) kms_psr (fbc-psr-cursor-blt)
[76.615508] Starting subtest: fbc-psr-cursor-blt
[76.617387] Starting dynamic subtest: eDP-1
[76.621231] Dynamic subtest eDP-1: SKIP (0.000s)
[76.625062] Subtest fbc-psr-cursor-blt: SKIP (0.000s)
[76.696946] [014/133] (944s left) syncobj_timeline (etime-single-wait-for-submit-unsubmitted)
[76.747714] Starting subtest: etime-single-wait-for-submit-unsubmitted
[76.848613] Subtest etime-single-wait-for-submit-unsubmitted: SUCCESS (0.101s)
[76.932049] [015/133] (943s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc)
[77.030434] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc
[77.032612] Starting dynamic subtest: pipe-A-eDP-1
[77.091199] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[77.099333] Starting dynamic subtest: pipe-B-eDP-1
[77.157536] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[77.165958] Starting dynamic subtest: pipe-C-eDP-1
[77.220121] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[77.227423] Starting dynamic subtest: pipe-D-eDP-1
[77.281104] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[77.285384] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.007s)
[79.311147] [016/133] (941s left) kms_psr (psr2-cursor-plane-move)
[79.401162] Starting subtest: psr2-cursor-plane-move
[79.403590] Starting dynamic subtest: eDP-1
[81.065836] Dynamic subtest eDP-1: SUCCESS (1.665s)
[81.068193] Subtest psr2-cursor-plane-move: SUCCESS (1.666s)
[81.869985] [017/133] (938s left) kms_properties (invalid-properties-legacy)
[81.963179] Starting subtest: invalid-properties-legacy
[82.063058] Subtest invalid-properties-legacy: SUCCESS (0.101s)
[82.145793] [018/133] (938s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled)
[82.203296] Starting subtest: yf-tiled-ccs-to-yf-tiled
[82.207725] Subtest yf-tiled-ccs-to-yf-tiled: SKIP (0.000s)
[82.407081] [019/133] (938s left) gem_tiled_partial_pwrite_pread (reads)
[82.476944] Subtest reads: SKIP (0.000s)
[82.543639] [020/133] (938s left) kms_prime (d3hot)
[82.620493] Subtest D3hot: SKIP (0.000s)
[82.730269] [FACT kms_prime (d3hot)] new: kernel.kmod_is_loaded.vgem: true
[82.733449] [021/133] (938s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render)
[82.836570] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render
[82.840607] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[82.969085] [022/133] (938s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[83.071123] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc
[83.075398] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[83.185555] [023/133] (937s left) gem_lmem_swapping (heavy-random)
[83.230792] Subtest heavy-random: SKIP (0.000s)
[83.268686] [024/133] (937s left) kms_big_fb (4-tiled-64bpp-rotate-90)
[83.371559] Starting subtest: 4-tiled-64bpp-rotate-90
[83.390839] Subtest 4-tiled-64bpp-rotate-90: SKIP (0.019s)
[83.535704] [025/133] (937s left) gem_userptr_blits (sync-overlap)
[83.599924] Starting subtest: sync-overlap
[83.601643] Subtest sync-overlap: SUCCESS (0.000s)
[83.728184] [026/133] (937s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)
[83.827330] Starting subtest: pr-overlay-plane-move-continuous-exceed-sf
[83.830832] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[83.917795] [027/133] (937s left) syncobj_wait (multi-wait-all-signaled)
[83.974957] Starting subtest: multi-wait-all-signaled
[83.976527] Subtest multi-wait-all-signaled: SUCCESS (0.000s)
[84.099036] [028/133] (937s left) kms_frontbuffer_tracking (fbc-2p-shrfb-fliptrack-mmap-gtt)
[84.197850] Starting subtest: fbc-2p-shrfb-fliptrack-mmap-gtt
[84.201410] Subtest fbc-2p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[84.334706] [029/133] (936s left) gem_exec_fence (syncobj-import)
[84.752565] Starting subtest: syncobj-import
[84.757434] Subtest syncobj-import: SUCCESS (0.004s)
[86.029396] [030/133] (935s left) kms_psr2_sf (psr2-overlay-plane-update-continuous-sf)
[86.134299] Starting subtest: psr2-overlay-plane-update-continuous-sf
[86.136598] Starting dynamic subtest: pipe-A-eDP-1
[87.235729] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.104s)
[87.244824] Starting dynamic subtest: pipe-B-eDP-1
[88.999294] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.762s)
[89.001711] Subtest psr2-overlay-plane-update-continuous-sf: SUCCESS (2.869s)
[89.829649] [031/133] (931s left) gem_exec_alignment (pi-isolated)
[89.903626] Starting subtest: pi-isolated
[139.341074] Subtest pi-isolated: SUCCESS (49.425s)
[140.341846] [032/133] (881s left) gem_mmap_offset (bad-object)
[140.425088] Starting subtest: bad-object
[140.427527] Subtest bad-object: SUCCESS (0.001s)
[140.549523] [033/133] (880s left) gem_pxp (create-valid-protected-context)
[140.660245] Starting subtest: create-valid-protected-context
[140.662647] Subtest create-valid-protected-context: SUCCESS (0.002s)
[140.780964] [034/133] (880s left) gem_gtt_cpu_tlb
[140.907382] [035/133] (880s left) kms_universal_plane (universal-plane-functional)
[141.010919] Starting subtest: universal-plane-functional
[141.012936] Starting dynamic subtest: pipe-A-eDP-1
[144.916244] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.906s)
[144.927568] Starting dynamic subtest: pipe-B-eDP-1
[149.453461] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.538s)
[149.463199] Starting dynamic subtest: pipe-C-eDP-1
[153.707494] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.251s)
[153.717352] Starting dynamic subtest: pipe-D-eDP-1
[157.996155] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.288s)
[157.998372] Subtest universal-plane-functional: SUCCESS (16.988s)
[158.805969] [036/133] (862s left) kms_chamelium_frames (dp-crc-single)
[159.208450] Subtest dp-crc-single: SKIP (0.000s)
[160.004766] [037/133] (861s left) gem_ctx_isolation (dirty-create)
[160.065963] Starting subtest: dirty-create
[160.068301] Starting dynamic subtest: rcs0
[160.266337] Dynamic subtest rcs0: SUCCESS (0.200s)
[160.275988] Starting dynamic subtest: bcs0
[160.475394] Dynamic subtest bcs0: SUCCESS (0.208s)
[160.485055] Starting dynamic subtest: vcs0
[160.688874] Dynamic subtest vcs0: SUCCESS (0.213s)
[160.699288] Starting dynamic subtest: vcs1
[162.075831] Dynamic subtest vcs1: SUCCESS (1.386s)
[162.086231] Starting dynamic subtest: vecs0
[164.137342] Dynamic subtest vecs0: SUCCESS (2.061s)
[164.145108] Starting dynamic subtest: ccs0
[166.143649] Dynamic subtest ccs0: SUCCESS (2.006s)
[166.145924] Subtest dirty-create: SUCCESS (6.078s)
[166.389345] [038/133] (855s left) gem_eio (execbuf)
[166.626453] Starting subtest: execbuf
[166.963478] Subtest execbuf: SUCCESS (0.336s)
[167.147452] [039/133] (854s left) gem_lmem_swapping (random)
[167.199408] Subtest random: SKIP (0.000s)
[167.241247] [040/133] (854s left) gen9_exec_parse (basic-rejected-ctx-param)
[167.302389] Subtest basic-rejected-ctx-param: SKIP (0.000s)
[167.377270] [041/133] (854s left) gem_exec_parallel (engines)
[167.444946] Starting subtest: engines
[167.447035] Starting dynamic subtest: basic
[170.839345] Dynamic subtest basic: SUCCESS (3.392s)
[170.850528] Starting dynamic subtest: contexts
[175.308571] Dynamic subtest contexts: SUCCESS (4.468s)
[175.319890] Starting dynamic subtest: fds
[179.155234] Dynamic subtest fds: SUCCESS (3.846s)
[179.169544] Starting dynamic subtest: userptr
[180.917743] Dynamic subtest userptr: SUCCESS (1.761s)
[180.920550] Subtest engines: SUCCESS (13.472s)
[181.117870] [042/133] (840s left) gem_render_copy_redux (flink-interruptible)
[181.187014] Starting subtest: flink-interruptible
[182.366732] Subtest flink-interruptible: SUCCESS (1.181s)
[182.527241] [043/133] (839s left) kms_flip (2x-plain-flip)
[182.628580] Starting subtest: 2x-plain-flip
[182.639372] Subtest 2x-plain-flip: SKIP (0.010s)
[182.739993] [044/133] (839s left) api_intel_allocator (reopen-fork)
[182.800616] Starting subtest: reopen-fork
[186.450995] Subtest reopen-fork: SUCCESS (3.650s)
[186.535374] [045/133] (835s left) gem_userptr_blits (stress-mm-invalidate-close)
[186.609409] Starting subtest: stress-mm-invalidate-close
[188.755436] Subtest stress-mm-invalidate-close: SUCCESS (2.148s)
[188.893744] [046/133] (833s left) kms_flip (flip-vs-dpms-on-nop)
[188.988080] Starting subtest: flip-vs-dpms-on-nop
[188.989922] Starting dynamic subtest: A-eDP1
[190.925660] Dynamic subtest A-eDP1: SUCCESS (1.940s)
[190.935028] Starting dynamic subtest: B-eDP1
[192.760392] Dynamic subtest B-eDP1: SUCCESS (1.834s)
[192.772501] Starting dynamic subtest: C-eDP1
[194.578434] Dynamic subtest C-eDP1: SUCCESS (1.816s)
[194.587085] Starting dynamic subtest: D-eDP1
[196.401055] Dynamic subtest D-eDP1: SUCCESS (1.820s)
[196.403804] Subtest flip-vs-dpms-on-nop: SUCCESS (7.418s)
[197.585350] [047/133] (824s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render)
[197.700445] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render
[197.704677] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[197.826312] [048/133] (824s left) kms_flip (2x-nonexisting-fb-interruptible)
[197.924842] Starting subtest: 2x-nonexisting-fb-interruptible
[197.935427] Subtest 2x-nonexisting-fb-interruptible: SKIP (0.010s)
[198.062883] [049/133] (824s left) api_intel_bb (render)
[198.127118] Starting subtest: render
[198.129434] Starting dynamic subtest: render-none-512
[198.223571] Dynamic subtest render-none-512: SUCCESS (0.098s)
[198.239872] Starting dynamic subtest: render-none-1024
[198.602998] Dynamic subtest render-none-1024: SUCCESS (0.378s)
[198.613867] Starting dynamic subtest: render-x-512
[198.686699] Dynamic subtest render-x-512: SUCCESS (0.084s)
[198.697600] Starting dynamic subtest: render-x-1024
[199.018766] Dynamic subtest render-x-1024: SUCCESS (0.332s)
[199.029981] Starting dynamic subtest: render-y-512
[199.103533] Dynamic subtest render-y-512: SUCCESS (0.083s)
[199.113910] Starting dynamic subtest: render-y-1024
[199.441348] Dynamic subtest render-y-1024: SUCCESS (0.336s)
[199.444101] Subtest render: SUCCESS (1.316s)
[199.590858] [050/133] (822s left) i915_hangman (engine-engine-error)
[199.668736] Starting subtest: engine-engine-error
[199.671026] Starting dynamic subtest: rcs0
[200.884439] Dynamic subtest rcs0: SUCCESS (1.216s)
[200.896065] Starting dynamic subtest: bcs0
[202.869201] Dynamic subtest bcs0: SUCCESS (1.983s)
[202.880839] Starting dynamic subtest: vcs0
[204.916246] Dynamic subtest vcs0: SUCCESS (2.045s)
[204.927668] Starting dynamic subtest: vcs1
[206.900050] Dynamic subtest vcs1: SUCCESS (1.982s)
[206.911951] Starting dynamic subtest: vecs0
[208.883345] Dynamic subtest vecs0: SUCCESS (1.981s)
[208.894915] Starting dynamic subtest: ccs0
[210.867816] Dynamic subtest ccs0: SUCCESS (1.982s)
[210.870711] Subtest engine-engine-error: SUCCESS (11.201s)
[210.959621] [051/133] (811s left) gem_workarounds (reset)
[211.033813] Starting subtest: reset
[211.189392] Subtest reset: SUCCESS (0.155s)
[211.349160] [052/133] (810s left) gem_sync (basic-many-each)
[211.428273] Starting subtest: basic-many-each
[213.728767] Subtest basic-many-each: SUCCESS (2.311s)
[213.934393] [053/133] (808s left) gem_partial_pwrite_pread (writes-after-reads-uncached)
[213.996190] Subtest writes-after-reads-uncached: SKIP (0.000s)
[214.071863] [054/133] (808s left) kms_fbcon_fbt (psr-suspend)
[214.132457] Starting subtest: psr-suspend
[264.071216] Subtest psr-suspend: SUCCESS (21.224s)
[264.168973] [055/133] (758s left) perf (blocking)
[264.298250] Starting subtest: blocking
[264.300595] Starting dynamic subtest: 0-rcs0
[274.382595] Dynamic subtest 0-rcs0: FAIL (10.177s)
[274.394190] Starting dynamic subtest: 1-vcs0
[284.345117] Dynamic subtest 1-vcs0: SUCCESS (10.048s)
[284.347880] Subtest blocking: FAIL (20.227s)
[284.396011] [056/133] (737s left) gem_exec_schedule (u-submit-golden-slice)
[284.465728] Starting subtest: u-submit-golden-slice
[284.467948] Starting dynamic subtest: rcs0
[284.496182] Dynamic subtest rcs0: SUCCESS (0.038s)
[284.505295] Starting dynamic subtest: bcs0
[284.542469] Dynamic subtest bcs0: SUCCESS (0.044s)
[284.552269] Starting dynamic subtest: vcs0
[284.591566] Dynamic subtest vcs0: SUCCESS (0.049s)
[284.600573] Starting dynamic subtest: vcs1
[284.641421] Dynamic subtest vcs1: SUCCESS (0.049s)
[284.650487] Starting dynamic subtest: vecs0
[284.688189] Dynamic subtest vecs0: SUCCESS (0.046s)
[284.699558] Starting dynamic subtest: ccs0
[284.740209] Dynamic subtest ccs0: SUCCESS (0.052s)
[284.742440] Subtest u-submit-golden-slice: SUCCESS (0.283s)
[286.204456] [057/133] (736s left) syncobj_timeline (reset-signaled)
[286.266082] Starting subtest: reset-signaled
[286.268372] Subtest reset-signaled: SUCCESS (0.000s)
[286.387140] [058/133] (736s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-onoff)
[286.482369] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-onoff
[286.486516] Subtest fbcpsr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[286.578762] [059/133] (735s left) kms_flip (2x-flip-vs-wf_vblank-interruptible)
[286.680245] Starting subtest: 2x-flip-vs-wf_vblank-interruptible
[286.691333] Subtest 2x-flip-vs-wf_vblank-interruptible: SKIP (0.010s)
[286.797041] [060/133] (735s left) gem_basic (bad-close)
[286.851269] Starting subtest: bad-close
[286.855461] Subtest bad-close: SUCCESS (0.000s)
[287.004573] [061/133] (735s left) kms_ccs (crc-primary-suspend-yf-tiled-ccs)
[287.100262] Starting subtest: crc-primary-suspend-yf-tiled-ccs
[287.102499] Starting dynamic subtest: pipe-A-eDP-1
[287.111895] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[287.121645] Starting dynamic subtest: pipe-B-eDP-1
[287.130224] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[287.139538] Starting dynamic subtest: pipe-C-eDP-1
[287.146216] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[287.154508] Starting dynamic subtest: pipe-D-eDP-1
[287.161099] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[287.164314] Subtest crc-primary-suspend-yf-tiled-ccs: SKIP (0.004s)
[289.349200] [062/133] (733s left) gem_vm_create (invalid-create)
[289.406680] Starting subtest: invalid-create
[289.411693] Subtest invalid-create: SUCCESS (0.004s)
[289.534398] [063/133] (733s left) gem_softpin (zero)
[289.604169] Starting subtest: zero
[289.611355] Subtest zero: SUCCESS (0.006s)
[289.739844] [064/133] (732s left) perf_pmu (most-busy-check-all)
[289.777190] Starting subtest: most-busy-check-all
[289.779457] Starting dynamic subtest: rcs0
[291.074645] Dynamic subtest rcs0: SUCCESS (1.299s)
[291.088339] Starting dynamic subtest: bcs0
[293.058829] Dynamic subtest bcs0: SUCCESS (1.982s)
[293.072012] Starting dynamic subtest: vcs0
[295.041476] Dynamic subtest vcs0: SUCCESS (1.978s)
[295.054563] Starting dynamic subtest: vcs1
[297.090356] Dynamic subtest vcs1: SUCCESS (2.044s)
[297.103703] Starting dynamic subtest: vecs0
[299.074404] Dynamic subtest vecs0: SUCCESS (1.979s)
[299.087855] Starting dynamic subtest: ccs0
[301.057575] Dynamic subtest ccs0: SUCCESS (1.979s)
[301.060384] Subtest most-busy-check-all: SUCCESS (11.278s)
[301.167490] [065/133] (721s left) kms_flip (flip-vs-modeset-vs-hang)
[301.269324] Starting subtest: flip-vs-modeset-vs-hang
[301.271600] Starting dynamic subtest: A-eDP1
[352.539431] Dynamic subtest A-eDP1: SUCCESS (51.273s)
[352.549668] Starting dynamic subtest: D-eDP1
[402.523023] Dynamic subtest D-eDP1: SUCCESS (49.971s)
[402.525507] Subtest flip-vs-modeset-vs-hang: SUCCESS (101.249s)
[402.928260] [066/133] (619s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[403.054889] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[403.059254] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[403.193736] [067/133] (619s left) gem_mmap_gtt (basic-write-gtt)
[403.264532] Subtest basic-write-gtt: SKIP (0.000s)
[403.336975] [068/133] (619s left) kms_pm_dc (dc5-retention-flops)
[404.441827] Starting subtest: dc5-retention-flops
[404.446617] Subtest dc5-retention-flops: SKIP (0.000s)
[404.526018] [069/133] (618s left) kms_psr (psr-suspend)
[404.619456] Starting subtest: psr-suspend
[404.621802] Starting dynamic subtest: eDP-1
[422.488035] Dynamic subtest eDP-1: SUCCESS (2.890s)
[422.490325] Subtest psr-suspend: SUCCESS (2.891s)
[423.337862] [070/133] (599s left) kms_big_fb (yf-tiled-addfb-size-offset-overflow)
[423.456338] Starting subtest: yf-tiled-addfb-size-offset-overflow
[423.460520] Subtest yf-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[423.588258] [071/133] (599s left) kms_vblank (query-forked-busy-hang)
[423.692523] Starting subtest: query-forked-busy-hang
[423.694703] Starting dynamic subtest: pipe-A-eDP-1
[449.781972] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.411s)
[449.798457] Starting dynamic subtest: pipe-D-eDP-1
[473.798093] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.002s)
[473.800066] Subtest query-forked-busy-hang: SUCCESS (50.418s)
[474.649711] [072/133] (548s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted-signal
[474.713656] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted-signaled
[474.817164] Subtest etime-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.103s)
[474.902452] [073/133] (548s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-fullscreen)
[475.009415] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-fullscreen
[481.645957] Subtest fbcpsr-1p-primscrn-spr-indfb-fullscreen: SUCCESS (6.639s)
[481.806381] [074/133] (541s left) kms_big_fb (linear-64bpp-rotate-0)
[481.908196] Starting subtest: linear-64bpp-rotate-0
[483.410286] Subtest linear-64bpp-rotate-0: SUCCESS (1.502s)
[483.591767] [075/133] (539s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc)
[483.683680] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc
[483.687682] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[483.778641] [076/133] (539s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-msflip-blt)
[483.873120] Starting subtest: psr-2p-scndscrn-shrfb-msflip-blt
[483.876642] Subtest psr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[484.007294] [077/133] (539s left) kms_ccs (bad-rotation-90-4-tiled-dg2-mc-ccs)
[484.090516] Starting subtest: bad-rotation-90-4-tiled-dg2-mc-ccs
[484.092404] Starting dynamic subtest: pipe-A-eDP-1
[484.111293] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[484.122000] Starting dynamic subtest: pipe-B-eDP-1
[484.138840] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[484.148458] Starting dynamic subtest: pipe-C-eDP-1
[484.165492] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[484.174914] Starting dynamic subtest: pipe-D-eDP-1
[484.192256] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[484.195526] Subtest bad-rotation-90-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[486.253915] [078/133] (537s left) kms_cursor_legacy (short-flip-before-cursor-atomic-transitions)
[486.379962] Starting subtest: short-flip-before-cursor-atomic-transitions
[487.316040] Subtest short-flip-before-cursor-atomic-transitions: SUCCESS (0.936s)
[488.183270] [079/133] (535s left) kms_rotation_crc (sprite-rotation-90-pos-100-0)
[488.281371] Starting subtest: sprite-rotation-90-pos-100-0
[488.285703] Subtest sprite-rotation-90-pos-100-0: SKIP (0.001s)
[488.367191] [080/133] (535s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[488.467171] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-hflip
[489.400685] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-hflip: SUCCESS (0.935s)
[489.567280] [081/133] (533s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[489.673965] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[489.678282] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[489.800759] [082/133] (533s left) kms_content_protection (atomic)
[489.944824] Starting subtest: atomic
[489.948153] Subtest atomic: SKIP (0.000s)
[490.098774] [083/133] (533s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-blt)
[490.197703] Starting subtest: psr-1p-offscreen-pri-indfb-draw-blt
[497.084474] Subtest psr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.889s)
[497.221682] [084/133] (526s left) kms_big_fb (x-tiled-32bpp-rotate-0)
[497.324488] Starting subtest: x-tiled-32bpp-rotate-0
[498.747875] Subtest x-tiled-32bpp-rotate-0: SUCCESS (1.426s)
[498.902113] [085/133] (524s left) gem_userptr_blits (unsync-unmap-cycles)
[498.971428] Subtest unsync-unmap-cycles: SKIP (0.000s)
[499.129270] [086/133] (524s left) syncobj_timeline (invalid-signal-illegal-handle)
[499.191891] Starting subtest: invalid-signal-illegal-handle
[499.193861] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[499.326149] [087/133] (524s left) i915_pm_rpm (gem-mmap-type)
[501.261512] Starting subtest: gem-mmap-type
[501.264213] Starting dynamic subtest: wb-smem0
[504.764277] Dynamic subtest wb-smem0: SUCCESS (3.506s)
[504.774705] Starting dynamic subtest: wc-smem0
[507.929360] Dynamic subtest wc-smem0: SUCCESS (3.166s)
[507.939538] Starting dynamic subtest: uc-smem0
[511.093365] Dynamic subtest uc-smem0: SUCCESS (3.162s)
[511.095668] Subtest gem-mmap-type: SUCCESS (9.838s)
[511.214927] [088/133] (512s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-signaled)
[511.287981] Starting subtest: multi-wait-all-for-submit-unsubmitted-signaled
[511.393161] Subtest multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.106s)
[511.478151] [089/133] (512s left) kms_chamelium_hpd (hdmi-hpd-enable-disable-mode)
[511.865779] Subtest hdmi-hpd-enable-disable-mode: SKIP (0.000s)
[512.652250] [090/133] (511s left) gem_set_tiling_vs_blt (tiled-to-untiled)
[512.712828] Subtest tiled-to-untiled: SKIP (0.000s)
[512.777914] [091/133] (511s left) kms_psr (fbc-pr-sprite-blt)
[512.873063] Starting subtest: fbc-pr-sprite-blt
[512.877186] Subtest fbc-pr-sprite-blt: SKIP (0.000s)
[512.959436] [092/133] (510s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-wc)
[513.057566] Starting subtest: fbc-rgb565-draw-mmap-wc
[517.082257] Subtest fbc-rgb565-draw-mmap-wc: SUCCESS (4.029s)
[518.289261] [093/133] (505s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[518.398517] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-gtt
[518.402785] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[518.530354] [094/133] (505s left) kms_frontbuffer_tracking (fbcpsr-2p-rte)
[518.624836] Starting subtest: fbcpsr-2p-rte
[518.629023] Subtest fbcpsr-2p-rte: SKIP (0.000s)
[518.742620] [095/133] (505s left) kms_cursor_crc (cursor-random-512x170)
[519.014646] Starting subtest: cursor-random-512x170
[519.019085] Subtest cursor-random-512x170: SKIP (0.001s)
[519.205588] [096/133] (504s left) gem_create (create-ext-cpu-access-big)
[519.380542] Starting subtest: create-ext-cpu-access-big
[519.385215] Subtest create-ext-cpu-access-big: SKIP (0.001s)
[519.479444] [097/133] (504s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[519.578070] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-gtt
[519.582092] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[519.706499] [098/133] (504s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-pgflip-blt)
[519.806217] Starting subtest: psr-2p-primscrn-indfb-pgflip-blt
[519.810599] Subtest psr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[519.917290] [099/133] (504s left) kms_lease (lease-uevent)
[520.013395] Starting subtest: lease-uevent
[521.020510] Subtest lease-uevent: SUCCESS (1.007s)
[521.121237] [100/133] (503s left) gem_exec_params (no-bsd)
[521.174344] Starting subtest: no-bsd
[521.176571] Subtest no-bsd: SUCCESS (0.002s)
[523.192282] [101/133] (501s left) prime_vgem (basic-read)
[523.286088] Starting subtest: basic-read
[523.309214] Subtest basic-read: SKIP (0.021s)
[523.468307] [102/133] (500s left) kms_color (deep-color)
[523.575615] Starting subtest: deep-color
[524.642546] Starting dynamic subtest: pipe-A-eDP-1-gamma
[525.346054] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.703s)
[525.356476] Starting dynamic subtest: pipe-A-eDP-1-degamma
[526.752670] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.404s)
[526.763282] Starting dynamic subtest: pipe-A-eDP-1-ctm
[528.180778] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.430s)
[528.948918] Starting dynamic subtest: pipe-B-eDP-1-gamma
[529.653520] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.711s)
[529.664147] Starting dynamic subtest: pipe-B-eDP-1-degamma
[531.107408] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.456s)
[531.118242] Starting dynamic subtest: pipe-B-eDP-1-ctm
[532.518999] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.410s)
[533.340702] Starting dynamic subtest: pipe-C-eDP-1-gamma
[533.987190] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.658s)
[533.997647] Starting dynamic subtest: pipe-C-eDP-1-degamma
[535.371340] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.384s)
[535.381766] Starting dynamic subtest: pipe-C-eDP-1-ctm
[536.810358] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.437s)
[537.610227] Starting dynamic subtest: pipe-D-eDP-1-gamma
[538.286031] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.683s)
[538.297381] Starting dynamic subtest: pipe-D-eDP-1-degamma
[539.663653] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.374s)
[539.673853] Starting dynamic subtest: pipe-D-eDP-1-ctm
[541.057748] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.394s)
[541.059959] Subtest deep-color: SUCCESS (17.479s)
[541.865147] [103/133] (482s left) core_sysfs (read-all-entries)
[541.923670] Starting subtest: read-all-entries
[541.930319] Subtest read-all-entries: SUCCESS (0.008s)
[542.056377] [104/133] (482s left) kms_plane (pixel-format-4-tiled-modifier)
[542.164646] Starting subtest: pixel-format-4-tiled-modifier
[542.190002] Starting dynamic subtest: pipe-A-plane-0
[542.823201] Dynamic subtest pipe-A-plane-0: SUCCESS (0.633s)
[542.839691] Starting dynamic subtest: pipe-A-plane-3
[543.234537] Dynamic subtest pipe-A-plane-3: SUCCESS (0.410s)
[543.244643] Starting dynamic subtest: pipe-A-plane-5
[543.248528] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[544.341611] Starting dynamic subtest: pipe-B-plane-0
[544.943642] Dynamic subtest pipe-B-plane-0: SUCCESS (0.611s)
[544.953982] Starting dynamic subtest: pipe-B-plane-3
[545.365362] Dynamic subtest pipe-B-plane-3: SUCCESS (0.421s)
[545.375058] Starting dynamic subtest: pipe-B-plane-5
[545.378622] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[545.674667] Subtest pixel-format-4-tiled-modifier: SUCCESS (3.510s)
[546.522939] [105/133] (477s left) gem_ctx_persistence (file)
[546.585616] Starting subtest: file
[546.703230] Subtest file: SUCCESS (0.118s)
[546.858727] [106/133] (477s left) fbdev (nullptr)
[546.899058] Starting subtest: nullptr
[546.901351] Subtest nullptr: SUCCESS (0.000s)
[546.978739] [107/133] (477s left) kms_plane (pixel-format-y-tiled-modifier-source-clamping)
[547.081483] Starting subtest: pixel-format-y-tiled-modifier-source-clamping
[547.107059] Starting dynamic subtest: pipe-A-plane-0
[547.111181] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[547.121955] Starting dynamic subtest: pipe-A-plane-3
[547.126466] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[547.135877] Starting dynamic subtest: pipe-A-plane-5
[547.140421] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[548.192055] Starting dynamic subtest: pipe-B-plane-0
[548.196412] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[548.206049] Starting dynamic subtest: pipe-B-plane-3
[548.210753] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[548.219865] Starting dynamic subtest: pipe-B-plane-5
[548.224479] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[548.497004] Subtest pixel-format-y-tiled-modifier-source-clamping: SKIP (1.414s)
[549.390054] [108/133] (475s left) gem_ctx_param (basic)
[549.451197] Starting subtest: basic
[549.453526] Subtest basic: SUCCESS (0.001s)
[549.571172] [109/133] (474s left) syncobj_basic (illegal-fd-to-handle)
[549.635570] Starting subtest: illegal-fd-to-handle
[549.637910] Subtest illegal-fd-to-handle: SUCCESS (0.000s)
[549.772343] [110/133] (474s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area)
[549.865408] Starting subtest: fbc-pr-overlay-plane-update-sf-dmg-area
[549.869798] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[549.947660] [111/133] (474s left) kms_addfb_basic (invalid-get-prop-any)
[550.008974] Starting subtest: invalid-get-prop-any
[550.010962] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[550.170433] [112/133] (474s left) kms_frontbuffer_tracking (psr-rgb565-draw-pwrite)
[550.274000] Starting subtest: psr-rgb565-draw-pwrite
[557.186879] Subtest psr-rgb565-draw-pwrite: SUCCESS (6.916s)
[557.325722] [113/133] (467s left) kms_plane_scaling (planes-upscale-20x20)
[557.433870] Starting subtest: planes-upscale-20x20
[557.436158] Starting dynamic subtest: pipe-A
[557.495956] Dynamic subtest pipe-A: SUCCESS (0.062s)
[557.507761] Starting dynamic subtest: pipe-B
[558.593708] Dynamic subtest pipe-B: SUCCESS (1.097s)
[558.605560] Starting dynamic subtest: pipe-C
[559.699915] Dynamic subtest pipe-C: SUCCESS (1.104s)
[559.710261] Starting dynamic subtest: pipe-D
[560.831178] Dynamic subtest pipe-D: SUCCESS (1.131s)
[560.833478] Subtest planes-upscale-20x20: SUCCESS (3.399s)
[562.000978] [114/133] (462s left) gem_softpin (evict-active)
[562.069086] Starting subtest: evict-active
[562.075592] Subtest evict-active: SUCCESS (0.007s)
[562.252807] [115/133] (462s left) gem_mmap_gtt (fault-concurrent)
[562.314830] Subtest fault-concurrent: SKIP (0.000s)
[562.394761] [116/133] (462s left) gem_mmap_wc (copy)
[562.462323] Subtest copy: SKIP (0.000s)
[562.534278] [117/133] (462s left) gem_exec_schedule (reorder-wide)
[562.710800] Subtest reorder-wide: SKIP (0.000s)
[562.902588] [118/133] (462s left) kms_joiner (basic-force-big-joiner)
[563.006896] Starting subtest: basic-force-big-joiner
[563.011142] Subtest basic-force-big-joiner: SKIP (0.000s)
[563.097898] [119/133] (461s left) perf_pmu (busy-hang)
[563.143939] Starting subtest: busy-hang
[563.146297] Starting dynamic subtest: rcs0
[564.436469] Dynamic subtest rcs0: SUCCESS (1.292s)
[564.448301] Starting dynamic subtest: bcs0
[565.686392] Dynamic subtest bcs0: SUCCESS (1.248s)
[565.698586] Starting dynamic subtest: vcs0
[567.566881] Dynamic subtest vcs0: SUCCESS (1.878s)
[567.578470] Starting dynamic subtest: vcs1
[569.549591] Dynamic subtest vcs1: SUCCESS (1.984s)
[569.562216] Starting dynamic subtest: vecs0
[571.594794] Dynamic subtest vecs0: SUCCESS (2.043s)
[571.607219] Starting dynamic subtest: ccs0
[572.845484] Dynamic subtest ccs0: SUCCESS (1.246s)
[572.847816] Subtest busy-hang: SUCCESS (9.704s)
[572.982782] [120/133] (452s left) kms_dsc (dsc-with-bpc-formats)
[573.087665] Starting subtest: dsc-with-bpc-formats
[573.197613] Subtest dsc-with-bpc-formats: SKIP (0.006s)
[573.238767] [121/133] (451s left) kms_psr (pr-primary-page-flip)
[573.336408] Starting subtest: pr-primary-page-flip
[573.341057] Subtest pr-primary-page-flip: SKIP (0.000s)
[573.428002] [122/133] (451s left) kms_atomic_transition (modeset-transition-nonblocking)
[573.524717] Starting subtest: modeset-transition-nonblocking
[573.526953] Starting dynamic subtest: 1x-outputs
[584.562252] Dynamic subtest 1x-outputs: SUCCESS (11.040s)
[584.564869] Subtest modeset-transition-nonblocking: SUCCESS (11.042s)
[585.430884] [123/133] (439s left) syncobj_timeline (wait-delayed-signal)
[585.484285] Starting subtest: wait-delayed-signal
[585.586425] Subtest wait-delayed-signal: SUCCESS (0.102s)
[585.676463] [124/133] (439s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[585.776482] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[585.780878] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[585.899992] [125/133] (439s left) gem_exec_balancer (hog)
[585.959850] Starting subtest: hog
[585.964117] Subtest hog: SKIP (0.000s)
[586.279529] [126/133] (439s left) kms_plane_multiple (tiling-4)
[586.369998] Starting subtest: tiling-4
[586.372398] Starting dynamic subtest: pipe-A-eDP-1
[590.038780] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.667s)
[590.059585] Starting dynamic subtest: pipe-B-eDP-1
[594.366625] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.330s)
[594.376890] Starting dynamic subtest: pipe-C-eDP-1
[598.683818] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.317s)
[598.696919] Starting dynamic subtest: pipe-D-eDP-1
[602.994883] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.311s)
[602.997170] Subtest tiling-4: SUCCESS (16.630s)
[603.820689] [127/133] (421s left) kms_getfb (getfb2-accept-nv12)
[603.920791] Starting subtest: getfb2-accept-nv12
[603.922977] Subtest getfb2-accept-nv12: SUCCESS (0.001s)
[604.026254] [128/133] (421s left) gen9_exec_parse (unaligned-access)
[604.092524] Subtest unaligned-access: SKIP (0.000s)
[604.161338] [129/133] (421s left) kms_addfb_basic (basic-y-tiled-legacy)
[604.224240] Starting subtest: basic-y-tiled-legacy
[604.228483] Subtest basic-y-tiled-legacy: SKIP (0.000s)
[604.408636] [130/133] (421s left) gem_exec_balancer (waits)
[604.471135] Starting subtest: waits
[610.920644] Subtest waits: SUCCESS (6.441s)
[611.232868] [131/133] (414s left) syncobj_wait (multi-wait-all-for-submit-submitted-signaled)
[611.300271] Starting subtest: multi-wait-all-for-submit-submitted-signaled
[611.400354] Subtest multi-wait-all-for-submit-submitted-signaled: SUCCESS (0.101s)
[611.492746] [132/133] (414s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[611.598697] Starting subtest: read-crc-frame-sequence
[611.600592] Starting dynamic subtest: pipe-A-eDP-1
[612.296449] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.699s)
[612.307374] Starting dynamic subtest: pipe-B-eDP-1
[613.685786] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.386s)
[613.697440] Starting dynamic subtest: pipe-C-eDP-1
[614.954329] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.269s)
[614.964365] Starting dynamic subtest: pipe-D-eDP-1
[616.313494] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.357s)
[616.315851] Subtest read-crc-frame-sequence: SUCCESS (4.717s)
[617.158011] [133/133] (408s left) gem_exec_schedule (pi-distinct-iova)
[617.345449] Starting subtest: pi-distinct-iova
[617.347657] Starting dynamic subtest: rcs0
[617.416149] Dynamic subtest rcs0: SUCCESS (0.073s)
[617.429305] Starting dynamic subtest: vcs0
[617.473504] Dynamic subtest vcs0: SUCCESS (0.057s)
[617.486238] Starting dynamic subtest: vcs1
[617.525337] Dynamic subtest vcs1: SUCCESS (0.051s)
[617.537951] Starting dynamic subtest: vecs0
[617.580581] Dynamic subtest vecs0: SUCCESS (0.054s)
[617.593177] Starting dynamic subtest: ccs0
[617.646907] Dynamic subtest ccs0: SUCCESS (0.065s)
[617.649748] Subtest pi-distinct-iova: SUCCESS (0.304s)
[619.201960] Closing watchdogs
results: parsing output: 0/ for test: perf
results: parsing output: 1/ for test: kms_chamelium_color
results: parsing output: 2/ for test: gem_render_copy
results: parsing output: 3/ for test: kms_cursor_legacy
results: parsing output: 4/ for test: syncobj_wait
results: parsing output: 5/ for test: kms_ccs
results: parsing output: 6/ for test: kms_flip_scaled_crc
results: parsing output: 7/ for test: syncobj_timeline
results: parsing output: 8/ for test: kms_dirtyfb
results: parsing output: 9/ for test: kms_cursor_edge_walk
results: parsing output: 10/ for test: i915_pm_rps
results: parsing output: 11/ for test: kms_cursor_crc
results: parsing output: 12/ for test: kms_psr
results: parsing output: 13/ for test: syncobj_timeline
results: parsing output: 14/ for test: kms_ccs
results: parsing output: 15/ for test: kms_psr
results: parsing output: 16/ for test: kms_properties
results: parsing output: 17/ for test: gem_render_copy
results: parsing output: 18/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 19/ for test: kms_prime
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: gem_lmem_swapping
results: parsing output: 23/ for test: kms_big_fb
results: parsing output: 24/ for test: gem_userptr_blits
results: parsing output: 25/ for test: kms_psr2_sf
results: parsing output: 26/ for test: syncobj_wait
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: gem_exec_fence
results: parsing output: 29/ for test: kms_psr2_sf
results: parsing output: 30/ for test: gem_exec_alignment
results: parsing output: 31/ for test: gem_mmap_offset
results: parsing output: 32/ for test: gem_pxp
results: parsing output: 33/ for test: gem_gtt_cpu_tlb
results: parsing output: 34/ for test: kms_universal_plane
results: parsing output: 35/ for test: kms_chamelium_frames
results: parsing output: 36/ for test: gem_ctx_isolation
results: parsing output: 37/ for test: gem_eio
results: parsing output: 38/ for test: gem_lmem_swapping
results: parsing output: 39/ for test: gen9_exec_parse
results: parsing output: 40/ for test: gem_exec_parallel
results: parsing output: 41/ for test: gem_render_copy_redux
results: parsing output: 42/ for test: kms_flip
results: parsing output: 43/ for test: api_intel_allocator
results: parsing output: 44/ for test: gem_userptr_blits
results: parsing output: 45/ for test: kms_flip
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: kms_flip
results: parsing output: 48/ for test: api_intel_bb
results: parsing output: 49/ for test: i915_hangman
results: parsing output: 50/ for test: gem_workarounds
results: parsing output: 51/ for test: gem_sync
results: parsing output: 52/ for test: gem_partial_pwrite_pread
results: parsing output: 53/ for test: kms_fbcon_fbt
results: parsing output: 54/ for test: perf
results: parsing output: 55/ for test: gem_exec_schedule
results: parsing output: 56/ for test: syncobj_timeline
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: kms_flip
results: parsing output: 59/ for test: gem_basic
results: parsing output: 60/ for test: kms_ccs
results: parsing output: 61/ for test: gem_vm_create
results: parsing output: 62/ for test: gem_softpin
results: parsing output: 63/ for test: perf_pmu
results: parsing output: 64/ for test: kms_flip
results: parsing output: 65/ for test: kms_big_fb
results: parsing output: 66/ for test: gem_mmap_gtt
results: parsing output: 67/ for test: kms_pm_dc
results: parsing output: 68/ for test: kms_psr
results: parsing output: 69/ for test: kms_big_fb
results: parsing output: 70/ for test: kms_vblank
results: parsing output: 71/ for test: syncobj_timeline
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_big_fb
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_ccs
results: parsing output: 77/ for test: kms_cursor_legacy
results: parsing output: 78/ for test: kms_rotation_crc
results: parsing output: 79/ for test: kms_big_fb
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: kms_content_protection
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: kms_big_fb
results: parsing output: 84/ for test: gem_userptr_blits
results: parsing output: 85/ for test: syncobj_timeline
results: parsing output: 86/ for test: i915_pm_rpm
results: parsing output: 87/ for test: syncobj_wait
results: parsing output: 88/ for test: kms_chamelium_hpd
results: parsing output: 89/ for test: gem_set_tiling_vs_blt
results: parsing output: 90/ for test: kms_psr
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: kms_cursor_crc
results: parsing output: 95/ for test: gem_create
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_lease
results: parsing output: 99/ for test: gem_exec_params
results: parsing output: 100/ for test: prime_vgem
results: parsing output: 101/ for test: kms_color
results: parsing output: 102/ for test: core_sysfs
results: parsing output: 103/ for test: kms_plane
results: parsing output: 104/ for test: gem_ctx_persistence
results: parsing output: 105/ for test: fbdev
results: parsing output: 106/ for test: kms_plane
results: parsing output: 107/ for test: gem_ctx_param
results: parsing output: 108/ for test: syncobj_basic
results: parsing output: 109/ for test: kms_psr2_sf
results: parsing output: 110/ for test: kms_addfb_basic
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_plane_scaling
results: parsing output: 113/ for test: gem_softpin
results: parsing output: 114/ for test: gem_mmap_gtt
results: parsing output: 115/ for test: gem_mmap_wc
results: parsing output: 116/ for test: gem_exec_schedule
results: parsing output: 117/ for test: kms_joiner
results: parsing output: 118/ for test: perf_pmu
results: parsing output: 119/ for test: kms_dsc
results: parsing output: 120/ for test: kms_psr
results: parsing output: 121/ for test: kms_atomic_transition
results: parsing output: 122/ for test: syncobj_timeline
results: parsing output: 123/ for test: kms_big_fb
results: parsing output: 124/ for test: gem_exec_balancer
results: parsing output: 125/ for test: kms_plane_multiple
results: parsing output: 126/ for test: kms_getfb
results: parsing output: 127/ for test: gen9_exec_parse
results: parsing output: 128/ for test: kms_addfb_basic
results: parsing output: 129/ for test: gem_exec_balancer
results: parsing output: 130/ for test: syncobj_wait
results: parsing output: 131/ for test: kms_pipe_crc_basic
results: parsing output: 132/ for test: gem_exec_schedule
Done.