[56.402918] Initializing watchdogs
[56.402965]   /dev/watchdog0
[56.416242] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[56.420410] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[56.422561] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[56.425976] [001/134] (960s left) gem_flink_basic (double-flink)
[56.500207] Starting subtest: double-flink
[56.502492] Subtest double-flink: SUCCESS (0.000s)
[56.598124] [002/134] (960s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[56.704819] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[56.709276] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[56.809908] [003/134] (960s left) gem_pxp (regular-baseline-src-copy-readible)
[56.932872] Starting subtest: regular-baseline-src-copy-readible
[56.993308] Subtest regular-baseline-src-copy-readible: SUCCESS (0.062s)
[57.132663] [004/134] (959s left) gem_create (create-size-update)
[57.188150] Starting subtest: create-size-update
[57.190474] Subtest create-size-update: SUCCESS (0.000s)
[57.405295] [005/134] (959s left) gem_mmap_gtt (close-race)
[57.456708] Subtest close-race: SKIP (0.000s)
[57.511518] [006/134] (959s left) syncobj_timeline (reset-signaled)
[57.566014] Starting subtest: reset-signaled
[57.568237] Subtest reset-signaled: SUCCESS (0.001s)
[57.690509] [007/134] (959s left) sw_sync (sync_multi_consumer)
[57.727914] Starting subtest: sync_multi_consumer
[58.171455] Subtest sync_multi_consumer: SUCCESS (0.443s)
[58.259261] [008/134] (958s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[58.357701] Starting subtest: fbc-rgb565-draw-mmap-gtt
[58.362289] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[58.467922] [009/134] (958s left) kms_cursor_crc (cursor-sliding-32x10)
[58.643743] Starting subtest: cursor-sliding-32x10
[58.696012] Subtest cursor-sliding-32x10: SKIP (0.046s)
[58.991845] [010/134] (958s left) kms_cursor_crc (cursor-onscreen-32x32)
[59.140828] Starting subtest: cursor-onscreen-32x32
[59.189728] Subtest cursor-onscreen-32x32: SKIP (0.046s)
[59.460131] [011/134] (957s left) kms_frontbuffer_tracking (psr-indfb-scaledprimary)
[59.558222] Starting subtest: psr-indfb-scaledprimary
[65.307359] Subtest psr-indfb-scaledprimary: SUCCESS (5.752s)
[65.472023] [012/134] (951s left) kms_pipe_crc_basic (bad-source)
[65.563318] Starting subtest: bad-source
[65.565359] Subtest bad-source: SUCCESS (0.000s)
[65.645605] [013/134] (951s left) kms_plane (plane-panning-bottom-right)
[65.740980] Starting subtest: plane-panning-bottom-right
[65.743398] Starting dynamic subtest: pipe-A
[67.461371] Dynamic subtest pipe-A: SUCCESS (1.720s)
[67.469729] Starting dynamic subtest: pipe-B
[69.892087] Dynamic subtest pipe-B: SUCCESS (2.431s)
[69.894511] Subtest plane-panning-bottom-right: SUCCESS (4.154s)
[70.724478] [014/134] (946s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted)
[70.781898] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[70.784195] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[70.887514] [015/134] (946s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-pwrite)
[70.991634] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-pwrite
[70.995763] Subtest fbc-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[71.111193] [016/134] (946s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-mc-ccs)
[71.216461] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-mc-ccs
[71.218886] Starting dynamic subtest: pipe-A-eDP-1
[71.242212] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[71.251918] Starting dynamic subtest: pipe-B-eDP-1
[71.274290] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[71.282666] Starting dynamic subtest: pipe-C-eDP-1
[71.305078] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[71.312753] Starting dynamic subtest: pipe-D-eDP-1
[71.334425] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[71.338769] Subtest crc-primary-rotation-180-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[73.385819] [017/134] (944s left) kms_multipipe_modeset (basic-max-pipe-crc-check)
[73.487110] Starting subtest: basic-max-pipe-crc-check
[73.491748] Subtest basic-max-pipe-crc-check: SKIP (0.000s)
[73.530917] [018/134] (944s left) gem_exec_reloc (basic-cpu)
[73.598648] Subtest basic-cpu: SKIP (0.000s)
[73.673650] [019/134] (943s left) kms_ccs (crc-primary-basic-4-tiled-dg2-mc-ccs)
[73.771892] Starting subtest: crc-primary-basic-4-tiled-dg2-mc-ccs
[73.774330] Starting dynamic subtest: pipe-A-eDP-1
[73.797567] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[73.806800] Starting dynamic subtest: pipe-B-eDP-1
[73.828568] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[73.835585] Starting dynamic subtest: pipe-C-eDP-1
[73.857559] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[73.865772] Starting dynamic subtest: pipe-D-eDP-1
[73.888058] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[73.892433] Subtest crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[76.037733] [020/134] (941s left) kms_chamelium_edid (dp-edid-change-during-suspend)
[76.438261] Subtest dp-edid-change-during-suspend: SKIP (0.000s)
[77.242849] [021/134] (940s left) gem_ctx_persistence (legacy-engines-hostile)
[77.299885] Starting subtest: legacy-engines-hostile
[77.302217] Starting dynamic subtest: render
[77.469474] Dynamic subtest render: SUCCESS (0.172s)
[77.479383] Starting dynamic subtest: bsd1
[77.593855] Dynamic subtest bsd1: SUCCESS (0.122s)
[77.604846] Starting dynamic subtest: bsd2
[77.713553] Dynamic subtest bsd2: SUCCESS (0.117s)
[77.724438] Starting dynamic subtest: blt
[77.831907] Dynamic subtest blt: SUCCESS (0.117s)
[77.841771] Starting dynamic subtest: vebox
[77.957768] Dynamic subtest vebox: SUCCESS (0.124s)
[77.960448] Subtest legacy-engines-hostile: SUCCESS (0.661s)
[78.046162] [022/134] (939s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs)
[78.140593] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs
[78.142787] Starting dynamic subtest: pipe-A-eDP-1
[78.164448] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[78.171533] Starting dynamic subtest: pipe-B-eDP-1
[78.189733] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[78.195868] Starting dynamic subtest: pipe-C-eDP-1
[78.212787] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[78.219109] Starting dynamic subtest: pipe-D-eDP-1
[78.236453] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[78.239826] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.003s)
[80.331390] [023/134] (937s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[80.445083] Starting subtest: plane-upscale-20x20-with-rotation
[80.447895] Starting dynamic subtest: pipe-A
[80.670056] Dynamic subtest pipe-A: SUCCESS (0.227s)
[80.679072] Starting dynamic subtest: pipe-B
[82.004086] Dynamic subtest pipe-B: SUCCESS (1.334s)
[82.012678] Starting dynamic subtest: pipe-C
[83.329574] Dynamic subtest pipe-C: SUCCESS (1.325s)
[83.342043] Starting dynamic subtest: pipe-D
[84.657537] Dynamic subtest pipe-D: SUCCESS (1.327s)
[84.660095] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.215s)
[85.838962] [024/134] (931s left) gem_exec_fence (syncobj-wait)
[86.269823] Starting subtest: syncobj-wait
[87.924090] Subtest syncobj-wait: SUCCESS (1.653s)
[88.291215] [FACT gem_exec_fence (syncobj-wait)] new: kernel.kmod_is_loaded.vgem: true
[88.294311] [025/134] (929s left) gem_exec_fence (keep-in-fence)
[88.479958] Starting subtest: keep-in-fence
[88.482566] Starting dynamic subtest: rcs0
[88.553824] Dynamic subtest rcs0: SUCCESS (0.074s)
[88.563961] Starting dynamic subtest: bcs0
[88.610580] Dynamic subtest bcs0: SUCCESS (0.056s)
[88.620877] Starting dynamic subtest: vcs0
[89.876473] Dynamic subtest vcs0: SUCCESS (1.263s)
[89.886683] Starting dynamic subtest: vcs1
[91.924858] Dynamic subtest vcs1: SUCCESS (2.048s)
[91.935253] Starting dynamic subtest: vecs0
[93.908960] Dynamic subtest vecs0: SUCCESS (1.983s)
[93.917832] Starting dynamic subtest: ccs0
[94.149809] Dynamic subtest ccs0: SUCCESS (0.241s)
[94.152702] Subtest keep-in-fence: SUCCESS (5.670s)
[95.992916] [026/134] (921s left) gem_exec_reloc (basic-wc-read)
[96.058965] Subtest basic-wc-read: SKIP (0.000s)
[96.140870] [027/134] (921s left) kms_content_protection (content-type-change)
[96.286342] Starting subtest: content-type-change
[96.291102] Subtest content-type-change: SKIP (0.000s)
[96.434531] [028/134] (921s left) gem_exec_schedule (preemptive-hang)
[96.606290] Starting subtest: preemptive-hang
[96.609046] Starting dynamic subtest: rcs0
[106.049566] Dynamic subtest rcs0: SUCCESS (9.443s)
[106.056704] Starting dynamic subtest: bcs0
[115.070506] Dynamic subtest bcs0: SUCCESS (9.018s)
[115.086340] Starting dynamic subtest: vcs0
[124.026793] Dynamic subtest vcs0: SUCCESS (8.956s)
[124.037509] Starting dynamic subtest: vcs1
[133.051692] Dynamic subtest vcs1: SUCCESS (9.026s)
[133.061822] Starting dynamic subtest: vecs0
[142.008061] Dynamic subtest vecs0: SUCCESS (8.955s)
[142.017912] Starting dynamic subtest: ccs0
[151.033693] Dynamic subtest ccs0: SUCCESS (9.023s)
[151.035774] Subtest preemptive-hang: SUCCESS (54.425s)
[151.299619] [029/134] (866s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling)
[151.405621] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling
[151.407730] Starting dynamic subtest: pipe-A-default-mode
[154.195635] Dynamic subtest pipe-A-default-mode: SUCCESS (2.789s)
[154.198067] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (2.790s)
[155.044251] [030/134] (862s left) syncobj_timeline (wait-for-submit-snapshot)
[155.093082] Starting subtest: wait-for-submit-snapshot
[155.174323] Subtest wait-for-submit-snapshot: SUCCESS (0.082s)
[155.270393] [031/134] (862s left) syncobj_wait (single-wait-all-submitted)
[155.334588] Starting subtest: single-wait-all-submitted
[155.441308] Subtest single-wait-all-submitted: SUCCESS (0.104s)
[155.526194] [032/134] (862s left) gen9_exec_parse (unaligned-access)
[155.588597] Subtest unaligned-access: SKIP (0.000s)
[155.670913] [033/134] (862s left) gem_userptr_blits (unsync-overlap)
[155.744160] Subtest unsync-overlap: SKIP (0.000s)
[155.883132] [034/134] (862s left) kms_flip (dpms-vs-vblank-race-interruptible)
[155.977348] Starting subtest: dpms-vs-vblank-race-interruptible
[155.979618] Starting dynamic subtest: A-eDP1
[160.935631] Dynamic subtest A-eDP1: SUCCESS (4.954s)
[160.944669] Starting dynamic subtest: B-eDP1
[164.442255] Dynamic subtest B-eDP1: SUCCESS (3.506s)
[164.451677] Starting dynamic subtest: C-eDP1
[169.058430] Dynamic subtest C-eDP1: SUCCESS (4.615s)
[169.067514] Starting dynamic subtest: D-eDP1
[173.685550] Dynamic subtest D-eDP1: SUCCESS (4.627s)
[173.688018] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (17.709s)
[174.585860] [035/134] (843s left) kms_vblank (wait-busy)
[174.687958] Starting subtest: wait-busy
[174.689928] Starting dynamic subtest: pipe-A-eDP-1
[176.562499] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.875s)
[176.575790] Starting dynamic subtest: pipe-D-eDP-1
[179.123530] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.558s)
[179.125561] Subtest wait-busy: SUCCESS (4.436s)
[179.954908] [036/134] (838s left) gen9_exec_parse (bb-start-out)
[180.020567] Subtest bb-start-out: SKIP (0.000s)
[180.104772] [037/134] (838s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[180.198980] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[180.203696] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[180.345109] [038/134] (838s left) i915_hangman (gt-engine-error)
[180.415213] Starting subtest: gt-engine-error
[180.417598] Starting dynamic subtest: rcs0
[181.876604] Dynamic subtest rcs0: SUCCESS (1.461s)
[181.888171] Starting dynamic subtest: bcs0
[183.858078] Dynamic subtest bcs0: SUCCESS (1.979s)
[183.870050] Starting dynamic subtest: vcs0
[185.843035] Dynamic subtest vcs0: SUCCESS (1.983s)
[185.853907] Starting dynamic subtest: vcs1
[187.892036] Dynamic subtest vcs1: SUCCESS (2.046s)
[187.903041] Starting dynamic subtest: vecs0
[189.874870] Dynamic subtest vecs0: SUCCESS (1.981s)
[189.885610] Starting dynamic subtest: ccs0
[191.860639] Dynamic subtest ccs0: SUCCESS (1.984s)
[191.863821] Subtest gt-engine-error: SUCCESS (11.446s)
[191.954424] [039/134] (826s left) perf (gen12-group-exclusive-stream-ctx-handle)
[192.087320] Starting subtest: gen12-group-exclusive-stream-ctx-handle
[192.111140] Subtest gen12-group-exclusive-stream-ctx-handle: SUCCESS (0.021s)
[192.150277] [040/134] (826s left) kms_big_fb (4-tiled-16bpp-rotate-270)
[193.964555] Starting subtest: 4-tiled-16bpp-rotate-270
[193.984997] Subtest 4-tiled-16bpp-rotate-270: SKIP (0.020s)
[194.143812] [041/134] (824s left) kms_frontbuffer_tracking (fbcpsr-suspend)
[194.239898] Starting subtest: fbcpsr-suspend
[235.182355] Subtest fbcpsr-suspend: SUCCESS (10.269s)
[235.330828] [042/134] (783s left) i915_suspend (fence-restore-tiled2untiled)
[235.394175] Starting subtest: fence-restore-tiled2untiled
[235.399346] Subtest fence-restore-tiled2untiled: SKIP (0.000s)
[235.526047] [043/134] (783s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[235.582271] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[235.683867] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.102s)
[235.771614] [044/134] (782s left) prime_self_import (basic-with_one_bo_two_files)
[235.807940] Starting subtest: basic-with_one_bo_two_files
[235.822299] Subtest basic-with_one_bo_two_files: SUCCESS (0.015s)
[235.920974] [045/134] (782s left) kms_pm_rpm (legacy-planes)
[237.772747] Starting subtest: legacy-planes
[237.776009] Starting dynamic subtest: plane-64
[246.185761] Dynamic subtest plane-64: SUCCESS (8.408s)
[246.197238] Starting dynamic subtest: plane-94
[254.786543] Dynamic subtest plane-94: SUCCESS (8.594s)
[254.796967] Starting dynamic subtest: plane-124
[263.094595] Dynamic subtest plane-124: SUCCESS (8.302s)
[263.106031] Starting dynamic subtest: plane-134
[271.410660] Dynamic subtest plane-134: SUCCESS (8.310s)
[271.413685] Subtest legacy-planes: SUCCESS (33.623s)
[271.799644] [046/134] (746s left) gem_mmap_gtt (fault-concurrent-y)
[271.865381] Subtest fault-concurrent-Y: SKIP (0.000s)
[271.930255] [047/134] (746s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[272.044336] Starting subtest: basic-busy-flip-before-cursor-atomic
[272.048932] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s)
[272.197011] [048/134] (746s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-wc)
[272.289788] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-wc
[278.901138] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (6.611s)
[279.039640] [049/134] (739s left) kms_psr (pr-sprite-blt)
[279.147878] Starting subtest: pr-sprite-blt
[279.152942] Subtest pr-sprite-blt: SKIP (0.000s)
[279.230970] [050/134] (739s left) kms_plane_multiple (tiling-y)
[279.317391] Starting subtest: tiling-y
[279.324248] Subtest tiling-y: SKIP (0.000s)
[279.399899] [051/134] (739s left) gem_exec_params (rel-constants-invalid)
[279.462367] Starting subtest: rel-constants-invalid
[279.465356] Subtest rel-constants-invalid: SUCCESS (0.000s)
[279.586106] [052/134] (739s left) dmabuf_sync_file (export-basic)
[279.634419] Starting subtest: export-basic
[279.637355] Subtest export-basic: SUCCESS (0.001s)
[279.704315] [053/134] (739s left) gem_madvise (dontneed-before-mmap)
[279.742282] Starting subtest: dontneed-before-mmap
[279.762146] Subtest dontneed-before-mmap: SUCCESS (0.019s)
[279.888718] [054/134] (739s left) kms_flip (2x-blocking-absolute-wf_vblank)
[279.986983] Starting subtest: 2x-blocking-absolute-wf_vblank
[279.997336] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.010s)
[280.086171] [055/134] (738s left) kms_psr (fbc-psr-primary-mmap-gtt)
[280.172395] Starting subtest: fbc-psr-primary-mmap-gtt
[280.174836] Starting dynamic subtest: eDP-1
[280.179169] Dynamic subtest eDP-1: SKIP (0.000s)
[280.183747] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.001s)
[280.256572] [056/134] (738s left) kms_fbcon_fbt (psr-suspend)
[280.321890] Starting subtest: psr-suspend
[329.559471] Subtest psr-suspend: SUCCESS (19.663s)
[329.642489] [057/134] (689s left) kms_plane (pixel-format-y-tiled-modifier-source-clamping)
[329.759522] Starting subtest: pixel-format-y-tiled-modifier-source-clamping
[329.786036] Starting dynamic subtest: pipe-A-plane-0
[329.791435] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[329.806483] Starting dynamic subtest: pipe-A-plane-3
[329.814883] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[329.823289] Starting dynamic subtest: pipe-A-plane-5
[329.828155] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[330.910406] Starting dynamic subtest: pipe-B-plane-0
[330.915336] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[330.923697] Starting dynamic subtest: pipe-B-plane-3
[330.929175] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[330.937641] Starting dynamic subtest: pipe-B-plane-5
[330.942880] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[331.215036] Subtest pixel-format-y-tiled-modifier-source-clamping: SKIP (1.451s)
[332.106356] [058/134] (687s left) api_intel_bb (object-noreloc-purge-cache-simple)
[332.161860] Starting subtest: object-noreloc-purge-cache-simple
[332.168972] Subtest object-noreloc-purge-cache-simple: SUCCESS (0.008s)
[332.333165] [059/134] (686s left) kms_dirtyfb (psr-dirtyfb-ioctl)
[332.446392] Starting subtest: psr-dirtyfb-ioctl
[332.449192] Starting dynamic subtest: A-eDP-1
[336.303108] Dynamic subtest A-eDP-1: SUCCESS (3.854s)
[336.306059] Subtest psr-dirtyfb-ioctl: SUCCESS (3.855s)
[337.110916] [060/134] (682s left) kms_flip (flip-vs-panning-vs-hang)
[337.222312] Starting subtest: flip-vs-panning-vs-hang
[337.224708] Starting dynamic subtest: A-eDP1
[388.603913] Dynamic subtest A-eDP1: SUCCESS (51.378s)
[388.614447] Starting dynamic subtest: D-eDP1
[428.604113] Dynamic subtest D-eDP1: SUCCESS (39.994s)
[428.607232] Subtest flip-vs-panning-vs-hang: SUCCESS (91.376s)
[429.805927] [061/134] (589s left) kms_big_fb (linear-64bpp-rotate-270)
[429.907956] Starting subtest: linear-64bpp-rotate-270
[429.927958] Subtest linear-64bpp-rotate-270: SKIP (0.020s)
[430.067636] [062/134] (589s left) gem_mmap_wc (copy)
[430.132366] Subtest copy: SKIP (0.000s)
[430.204732] [063/134] (589s left) kms_flip (flip-vs-absolute-wf_vblank)
[430.299594] Starting subtest: flip-vs-absolute-wf_vblank
[430.302427] Starting dynamic subtest: A-eDP1
[439.246884] Dynamic subtest A-eDP1: SUCCESS (8.948s)
[439.258720] Starting dynamic subtest: B-eDP1
[448.175686] Dynamic subtest B-eDP1: SUCCESS (8.927s)
[448.186767] Starting dynamic subtest: C-eDP1
[457.101269] Dynamic subtest C-eDP1: SUCCESS (8.921s)
[457.113261] Starting dynamic subtest: D-eDP1
[466.038243] Dynamic subtest D-eDP1: SUCCESS (8.937s)
[466.044262] Subtest flip-vs-absolute-wf_vblank: SUCCESS (35.746s)
[467.252810] [064/134] (552s left) gem_exec_nop (basic-sequential)
[467.331199] Starting subtest: basic-sequential
[485.079212] Subtest basic-sequential: SUCCESS (17.758s)
[485.336423] [065/134] (534s left) gem_workarounds (suspend-resume)
[485.413754] Starting subtest: suspend-resume
[501.545830] Subtest suspend-resume: SUCCESS (1.193s)
[501.663107] [066/134] (517s left) gem_exec_reloc (basic-cpu-gtt-active)
[501.736703] Subtest basic-cpu-gtt-active: SKIP (0.000s)
[501.828985] [067/134] (517s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[501.941673] Starting subtest: yf-tiled-8bpp-rotate-270
[501.946059] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[502.067569] [068/134] (517s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-pwrite)
[502.164570] Starting subtest: fbc-rgb101010-draw-pwrite
[507.456386] Subtest fbc-rgb101010-draw-pwrite: SUCCESS (5.284s)
[508.649662] [069/134] (511s left) gem_softpin (allocator-basic)
[508.715174] Starting subtest: allocator-basic
[508.783971] Subtest allocator-basic: SUCCESS (0.068s)
[508.907702] [070/134] (510s left) syncobj_basic (bad-fd-to-handle)
[508.973960] Starting subtest: bad-fd-to-handle
[508.976325] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[509.106758] [071/134] (510s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-pwrite)
[509.218463] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-pwrite
[509.222821] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[509.349525] [072/134] (510s left) gem_fenced_exec_thrash (2-spare-fences)
[509.401012] Subtest 2-spare-fences: SKIP (0.000s)
[509.490473] [073/134] (510s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[509.587294] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[509.591030] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[509.728956] [074/134] (510s left) gem_partial_pwrite_pread (reads)
[509.792514] Subtest reads: SKIP (0.000s)
[509.877747] [075/134] (510s left) kms_properties (invalid-properties-atomic)
[509.983948] Starting subtest: invalid-properties-atomic
[510.275278] Subtest invalid-properties-atomic: SUCCESS (0.290s)
[510.390655] [076/134] (509s left) kms_psr2_sf (pr-overlay-primary-update-sf-dmg-area)
[515.429303] Starting subtest: pr-overlay-primary-update-sf-dmg-area
[515.434044] Subtest pr-overlay-primary-update-sf-dmg-area: SKIP (0.002s)
[516.292977] [077/134] (503s left) i915_pm_rps (reset)
[516.359617] Starting subtest: reset
[524.803761] Subtest reset: SUCCESS (8.438s)
[524.957375] [078/134] (495s left) syncobj_timeline (multi-wait-all-available-submitted-signaled)
[525.021505] Starting subtest: multi-wait-all-available-submitted-signaled
[525.023834] Subtest multi-wait-all-available-submitted-signaled: SUCCESS (0.001s)
[525.143460] [079/134] (494s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite)
[525.245977] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite
[525.250381] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[525.362363] [080/134] (494s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[525.474868] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[525.479014] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[525.592778] [081/134] (494s left) gem_exec_balancer (hang)
[525.843918] Starting subtest: hang
[527.459815] Subtest hang: SUCCESS (1.620s)
[527.598119] [082/134] (492s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[527.689936] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[527.692258] Starting dynamic subtest: A-eDP1
[531.314166] Dynamic subtest A-eDP1: SUCCESS (3.617s)
[531.324438] Starting dynamic subtest: B-eDP1
[534.513141] Dynamic subtest B-eDP1: SUCCESS (3.197s)
[534.523109] Starting dynamic subtest: C-eDP1
[537.618487] Dynamic subtest C-eDP1: SUCCESS (3.105s)
[537.630135] Starting dynamic subtest: D-eDP1
[540.712836] Dynamic subtest D-eDP1: SUCCESS (3.094s)
[540.715040] Subtest single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (13.022s)
[541.528261] [083/134] (478s left) kms_big_fb (yf-tiled-16bpp-rotate-0)
[541.639640] Starting subtest: yf-tiled-16bpp-rotate-0
[541.644350] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s)
[541.763026] [084/134] (478s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[541.875944] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[541.880424] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[542.008893] [085/134] (478s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render)
[542.116075] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render
[542.120183] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[542.244776] [086/134] (478s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[542.332285] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[542.334554] Starting dynamic subtest: pipe-A-default-mode
[542.632540] Dynamic subtest pipe-A-default-mode: SKIP (0.298s)
[542.636964] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.299s)
[543.455463] [087/134] (476s left) kms_psr2_sf (fbc-pr-cursor-plane-update-sf)
[548.416619] Starting subtest: fbc-pr-cursor-plane-update-sf
[548.421227] Subtest fbc-pr-cursor-plane-update-sf: SKIP (0.002s)
[549.266976] [088/134] (471s left) gem_exec_await (wide-contexts)
[549.480976] Starting subtest: wide-contexts
[573.017984] Subtest wide-contexts: SUCCESS (23.536s)
[573.229834] [089/134] (447s left) perf_pmu (most-busy-idle-check-all)
[573.310555] Starting subtest: most-busy-idle-check-all
[573.313115] Starting dynamic subtest: rcs0
[575.088573] Dynamic subtest rcs0: SUCCESS (1.776s)
[575.099953] Starting dynamic subtest: bcs0
[577.072799] Dynamic subtest bcs0: SUCCESS (1.980s)
[577.085812] Starting dynamic subtest: vcs0
[579.056488] Dynamic subtest vcs0: SUCCESS (1.980s)
[579.069811] Starting dynamic subtest: vcs1
[581.105018] Dynamic subtest vcs1: SUCCESS (2.044s)
[581.117580] Starting dynamic subtest: vecs0
[583.088559] Dynamic subtest vecs0: SUCCESS (1.980s)
[583.101043] Starting dynamic subtest: ccs0
[585.073451] Dynamic subtest ccs0: SUCCESS (1.981s)
[585.076127] Subtest most-busy-idle-check-all: SUCCESS (11.760s)
[585.182136] [090/134] (435s left) kms_frontbuffer_tracking (psr-abgr161616f-draw-mmap-gtt)
[585.297305] Starting subtest: psr-abgr161616f-draw-mmap-gtt
[585.301852] Subtest psr-abgr161616f-draw-mmap-gtt: SKIP (0.000s)
[585.421694] [091/134] (435s left) kms_scaling_modes (scaling-mode-full-aspect)
[585.514528] Starting subtest: scaling-mode-full-aspect
[585.516868] Starting dynamic subtest: pipe-A-eDP-1
[585.613606] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.098s)
[585.625812] Starting dynamic subtest: pipe-B-eDP-1
[586.787943] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.170s)
[586.797608] Starting dynamic subtest: pipe-C-eDP-1
[587.994618] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.205s)
[588.004645] Starting dynamic subtest: pipe-D-eDP-1
[589.120917] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.124s)
[589.123262] Subtest scaling-mode-full-aspect: SUCCESS (3.606s)
[590.296541] [092/134] (430s left) kms_psr (fbc-pr-basic)
[590.400209] Starting subtest: fbc-pr-basic
[590.404680] Subtest fbc-pr-basic: SKIP (0.000s)
[590.504012] [093/134] (430s left) kms_psr (psr2-sprite-mmap-cpu)
[590.601314] Starting subtest: psr2-sprite-mmap-cpu
[590.603940] Starting dynamic subtest: eDP-1
[592.385765] Dynamic subtest eDP-1: SUCCESS (1.781s)
[592.388146] Subtest psr2-sprite-mmap-cpu: SUCCESS (1.783s)
[593.262052] [094/134] (427s left) kms_ccs (random-ccs-data-4-tiled-dg2-mc-ccs)
[593.368534] Starting subtest: random-ccs-data-4-tiled-dg2-mc-ccs
[593.371097] Starting dynamic subtest: pipe-A-eDP-1
[593.397276] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[593.409336] Starting dynamic subtest: pipe-B-eDP-1
[593.432794] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[593.442807] Starting dynamic subtest: pipe-C-eDP-1
[593.467022] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[593.478422] Starting dynamic subtest: pipe-D-eDP-1
[593.501912] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[593.505869] Subtest random-ccs-data-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[595.517089] [095/134] (425s left) gem_exec_reloc (basic-wc-cpu-noreloc)
[595.576963] Subtest basic-wc-cpu-noreloc: SKIP (0.000s)
[595.666193] [096/134] (425s left) gem_ctx_sseu (invalid-args)
[595.740664] Subtest invalid-args: SKIP (0.000s)
[595.813867] [097/134] (425s left) kms_prop_blob (blob-multiple)
[595.870621] Starting subtest: blob-multiple
[595.872974] Subtest blob-multiple: SUCCESS (0.002s)
[595.979860] [098/134] (424s left) gem_exec_schedule (thriceslice)
[596.060169] Starting subtest: thriceslice
[596.062413] Starting dynamic subtest: rcs0
[596.110295] Dynamic subtest rcs0: SUCCESS (0.055s)
[596.125041] Starting dynamic subtest: bcs0
[596.141456] Dynamic subtest bcs0: SUCCESS (0.029s)
[596.153738] Starting dynamic subtest: vcs0
[596.191957] Dynamic subtest vcs0: SUCCESS (0.050s)
[596.203503] Starting dynamic subtest: vcs1
[596.221905] Dynamic subtest vcs1: SUCCESS (0.028s)
[596.231036] Starting dynamic subtest: vecs0
[596.271977] Dynamic subtest vecs0: SUCCESS (0.049s)
[596.285135] Starting dynamic subtest: ccs0
[596.302898] Dynamic subtest ccs0: SUCCESS (0.029s)
[596.305114] Subtest thriceslice: SUCCESS (0.249s)
[596.624968] [099/134] (424s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[596.725676] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[596.730087] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[596.848239] [100/134] (424s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[596.959141] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip
[596.963765] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[597.086824] [101/134] (423s left) gem_exec_capture (pi)
[597.150127] Starting subtest: pi
[597.152417] Starting dynamic subtest: rcs0
[601.308408] Dynamic subtest rcs0: SUCCESS (4.158s)
[601.320098] Starting dynamic subtest: bcs0
[605.453909] Dynamic subtest bcs0: SUCCESS (4.146s)
[605.469039] Starting dynamic subtest: vcs0
[609.528966] Dynamic subtest vcs0: SUCCESS (4.073s)
[609.541582] Starting dynamic subtest: vcs1
[613.742296] Dynamic subtest vcs1: SUCCESS (4.212s)
[613.755026] Starting dynamic subtest: vecs0
[617.859562] Dynamic subtest vecs0: SUCCESS (4.115s)
[617.871639] Starting dynamic subtest: ccs0
[621.967939] Dynamic subtest ccs0: SUCCESS (4.107s)
[621.970389] Subtest pi: SUCCESS (24.823s)
[622.133499] [102/134] (398s left) gem_ctx_param (invalid-get-no-zeromap)
[622.245866] Starting subtest: invalid-get-no-zeromap
[622.248405] Subtest invalid-get-no-zeromap: SUCCESS (0.001s)
[622.370699] [103/134] (398s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-downscaling)
[622.478844] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-downscaling
[622.481144] Starting dynamic subtest: pipe-A-default-mode
[622.779773] Dynamic subtest pipe-A-default-mode: SKIP (0.300s)
[622.784518] Subtest flip-64bpp-ytile-to-16bpp-ytile-downscaling: SKIP (0.302s)
[623.648632] [104/134] (397s left) kms_feature_discovery (dp-mst)
[623.747894] Starting subtest: dp-mst
[623.752312] Subtest dp-mst: SKIP (0.000s)
[623.874730] [105/134] (397s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[624.162680] Starting subtest: cursor-rapid-movement-512x512
[624.167064] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[624.349854] [106/134] (396s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[624.442472] Starting subtest: addfb25-y-tiled-legacy
[624.444595] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[624.552946] [107/134] (396s left) kms_universal_plane (disable-primary-vs-flip)
[624.649500] Starting subtest: disable-primary-vs-flip
[624.651027] Starting dynamic subtest: pipe-A-eDP-1
[626.217195] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.566s)
[626.227403] Starting dynamic subtest: pipe-B-eDP-1
[628.504288] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.287s)
[628.515039] Starting dynamic subtest: pipe-C-eDP-1
[630.743723] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.237s)
[630.754100] Starting dynamic subtest: pipe-D-eDP-1
[632.916255] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.173s)
[632.918708] Subtest disable-primary-vs-flip: SUCCESS (8.269s)
[633.734065] [108/134] (387s left) gem_exec_reloc (basic-cpu-read)
[633.802468] Subtest basic-cpu-read: SKIP (0.000s)
[633.914295] [109/134] (387s left) gem_mmap_offset (ptrace)
[633.973310] Starting subtest: ptrace
[633.975654] Starting dynamic subtest: smem0-wb
[633.995338] Dynamic subtest smem0-wb: SUCCESS (0.021s)
[634.007121] Starting dynamic subtest: smem0-wc
[634.013525] Dynamic subtest smem0-wc: SUCCESS (0.018s)
[634.022488] Starting dynamic subtest: smem0-uc
[634.032671] Dynamic subtest smem0-uc: SUCCESS (0.019s)
[634.035003] Subtest ptrace: SUCCESS (0.062s)
[634.220211] [110/134] (387s left) gem_close_race (basic-threads)
[634.300247] Starting subtest: basic-threads
[635.621270] Subtest basic-threads: SUCCESS (1.321s)
[635.830989] [111/134] (385s left) syncobj_timeline (wait-all-for-submit-complex)
[635.887869] Starting subtest: wait-all-for-submit-complex
[636.100950] Subtest wait-all-for-submit-complex: SUCCESS (0.214s)
[636.201693] [112/134] (385s left) kms_addfb_basic (bad-pitch-128)
[636.261280] Starting subtest: bad-pitch-128
[636.263479] Subtest bad-pitch-128: SUCCESS (0.000s)
[636.417299] [113/134] (385s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs-cc)
[636.509269] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs-cc
[636.511072] Starting dynamic subtest: pipe-A-eDP-1
[637.226988] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.710s)
[637.237825] Starting dynamic subtest: pipe-B-eDP-1
[639.028408] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.800s)
[639.037502] Starting dynamic subtest: pipe-C-eDP-1
[640.791557] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.762s)
[640.801765] Starting dynamic subtest: pipe-D-eDP-1
[642.631280] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.839s)
[642.633411] Subtest random-ccs-data-4-tiled-mtl-rc-ccs-cc: SUCCESS (6.115s)
[643.877523] [114/134] (377s left) prime_busy (before)
[643.943782] Starting subtest: before
[643.946037] Starting dynamic subtest: rcs0
[643.996857] Dynamic subtest rcs0: SUCCESS (0.052s)
[644.008324] Starting dynamic subtest: bcs0
[644.059290] Dynamic subtest bcs0: SUCCESS (0.062s)
[644.069286] Starting dynamic subtest: vcs0
[644.099803] Dynamic subtest vcs0: SUCCESS (0.040s)
[644.109277] Starting dynamic subtest: vcs1
[644.141923] Dynamic subtest vcs1: SUCCESS (0.041s)
[644.157371] Starting dynamic subtest: vecs0
[644.183603] Dynamic subtest vecs0: SUCCESS (0.040s)
[644.192887] Starting dynamic subtest: ccs0
[644.225321] Dynamic subtest ccs0: SUCCESS (0.040s)
[644.333926] Subtest before: SUCCESS (0.390s)
[644.420359] [115/134] (377s left) gen7_exec_parse (basic-allowed)
[644.474427] Subtest basic-allowed: SKIP (0.000s)
[644.566829] [116/134] (377s left) gem_exec_params (no-blt)
[644.622566] Starting subtest: no-blt
[644.627798] Subtest no-blt: SUCCESS (0.003s)
[644.789807] [117/134] (376s left) kms_big_fb (x-tiled-16bpp-rotate-90)
[644.893482] Starting subtest: x-tiled-16bpp-rotate-90
[644.912685] Subtest x-tiled-16bpp-rotate-90: SKIP (0.018s)
[645.062796] [118/134] (376s left) kms_async_flips (invalid-async-flip)
[645.162117] Starting subtest: invalid-async-flip
[645.539482] Starting dynamic subtest: pipe-A-eDP-1
[646.382026] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.844s)
[646.750092] Starting dynamic subtest: pipe-B-eDP-1
[647.514131] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.772s)
[647.870477] Starting dynamic subtest: pipe-C-eDP-1
[648.640302] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.778s)
[648.998877] Starting dynamic subtest: pipe-D-eDP-1
[649.755546] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.763s)
[649.757984] Subtest invalid-async-flip: SUCCESS (4.593s)
[650.945135] [119/134] (370s left) kms_frontbuffer_tracking (fbcpsr-1p-shrfb-fliptrack-mmap-gtt)
[651.045363] Starting subtest: fbcpsr-1p-shrfb-fliptrack-mmap-gtt
[651.049631] Subtest fbcpsr-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[651.180664] [120/134] (370s left) api_intel_allocator (gem-pool)
[651.240456] Starting subtest: gem-pool
[651.247381] Subtest gem-pool: SUCCESS (0.008s)
[651.372444] [121/134] (370s left) gem_exec_whisper (basic-fds-priority-all)
[651.442300] Starting subtest: basic-fds-priority-all
[675.029468] Subtest basic-fds-priority-all: SUCCESS (23.578s)
[675.240404] [122/134] (346s left) gem_fence_thrash (bo-write-verify-y)
[675.272088] Starting subtest: bo-write-verify-y
[675.299005] Subtest bo-write-verify-y: SKIP (0.026s)
[675.370108] [123/134] (346s left) gem_lmem_swapping (heavy-verify-multi-ccs)
[675.415521] Subtest heavy-verify-multi-ccs: SKIP (0.000s)
[675.468187] [124/134] (346s left) gem_render_copy (yf-tiled-to-vebox-yf-tiled)
[675.541908] Starting subtest: yf-tiled-to-vebox-yf-tiled
[675.546856] Subtest yf-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[675.741462] [125/134] (346s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[676.123810] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[676.927993] [126/134] (345s left) kms_pipe_b_c_ivb (from-pipe-c-to-b-with-3-lanes)
[676.990998] Subtest from-pipe-C-to-B-with-3-lanes: SKIP (0.000s)
[677.071102] [127/134] (345s left) gem_busy (busy)
[677.141608] Starting subtest: busy
[677.143964] Starting dynamic subtest: all-engines
[677.216697] Dynamic subtest all-engines: SUCCESS (0.075s)
[677.227159] Starting dynamic subtest: rcs0
[679.032561] Dynamic subtest rcs0: SUCCESS (1.813s)
[679.044743] Starting dynamic subtest: bcs0
[679.087056] Dynamic subtest bcs0: SUCCESS (0.050s)
[679.097632] Starting dynamic subtest: vcs0
[679.124282] Dynamic subtest vcs0: SUCCESS (0.038s)
[679.133968] Starting dynamic subtest: vcs1
[681.077664] Dynamic subtest vcs1: SUCCESS (1.949s)
[681.089091] Starting dynamic subtest: vecs0
[683.062575] Dynamic subtest vecs0: SUCCESS (1.983s)
[683.074254] Starting dynamic subtest: ccs0
[685.046579] Dynamic subtest ccs0: SUCCESS (1.983s)
[685.049150] Subtest busy: SUCCESS (7.901s)
[685.450050] [128/134] (336s left) kms_color_pipeline (plane-lut1d-lut1d)
[685.556080] Starting subtest: plane-lut1d-lut1d
[685.572108] Starting dynamic subtest: pipe-A-eDP-1
[686.295930] Dynamic subtest pipe-A-eDP-1: FAIL (0.333s)
[687.028949] Starting dynamic subtest: pipe-B-eDP-1
[687.874954] Dynamic subtest pipe-B-eDP-1: FAIL (0.301s)
[688.369895] Starting dynamic subtest: pipe-C-eDP-1
[689.199577] Dynamic subtest pipe-C-eDP-1: FAIL (0.246s)
[689.708824] Starting dynamic subtest: pipe-D-eDP-1
[690.570362] Dynamic subtest pipe-D-eDP-1: FAIL (0.279s)
[690.572271] Subtest plane-lut1d-lut1d: FAIL (4.727s)
[691.100207] [129/134] (331s left) kms_plane_cursor (primary)
[691.205286] Starting subtest: primary
[691.209814] Starting dynamic subtest: pipe-A-eDP-1-size-64
[693.775282] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.567s)
[693.801123] Starting dynamic subtest: pipe-A-eDP-1-size-128
[696.376333] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.582s)
[696.403421] Starting dynamic subtest: pipe-A-eDP-1-size-256
[698.978683] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.583s)
[699.305966] Starting dynamic subtest: pipe-B-eDP-1-size-64
[702.599444] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.309s)
[702.623642] Starting dynamic subtest: pipe-B-eDP-1-size-128
[705.189330] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.571s)
[705.214764] Starting dynamic subtest: pipe-B-eDP-1-size-256
[707.746158] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.538s)
[708.071746] Starting dynamic subtest: pipe-C-eDP-1-size-64
[710.967781] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.911s)
[710.995024] Starting dynamic subtest: pipe-C-eDP-1-size-128
[713.178723] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.192s)
[713.206580] Starting dynamic subtest: pipe-C-eDP-1-size-256
[715.412884] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.213s)
[715.735819] Starting dynamic subtest: pipe-D-eDP-1-size-64
[718.615493] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.893s)
[718.644409] Starting dynamic subtest: pipe-D-eDP-1-size-128
[720.816362] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.180s)
[720.844943] Starting dynamic subtest: pipe-D-eDP-1-size-256
[723.018429] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.180s)
[723.326851] Subtest primary: SUCCESS (32.111s)
[724.132566] [130/134] (298s left) gem_tiled_swapping (non-threaded)
[724.208708] Subtest non-threaded: SKIP (0.000s)
[724.284261] [131/134] (298s left) syncobj_wait (invalid-signal-zero-handles)
[724.346657] Starting subtest: invalid-signal-zero-handles
[724.349020] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[724.480616] [132/134] (297s left) kms_joiner (basic-force-ultra-joiner)
[724.577774] Starting subtest: basic-force-ultra-joiner
[724.582203] Subtest basic-force-ultra-joiner: SKIP (0.000s)
[724.656734] [133/134] (297s left) kms_psr (fbc-psr2-sprite-blt)
[724.745470] Starting subtest: fbc-psr2-sprite-blt
[724.747768] Starting dynamic subtest: eDP-1
[724.752340] Dynamic subtest eDP-1: SKIP (0.000s)
[724.756789] Subtest fbc-psr2-sprite-blt: SKIP (0.002s)
[724.845597] [134/134] (297s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc)
[724.942661] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc
[724.946832] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[725.057609] Closing watchdogs
results: parsing output: 0/ for test: gem_flink_basic
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: gem_pxp
results: parsing output: 3/ for test: gem_create
results: parsing output: 4/ for test: gem_mmap_gtt
results: parsing output: 5/ for test: syncobj_timeline
results: parsing output: 6/ for test: sw_sync
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: kms_cursor_crc
results: parsing output: 9/ for test: kms_cursor_crc
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_pipe_crc_basic
results: parsing output: 12/ for test: kms_plane
results: parsing output: 13/ for test: syncobj_timeline
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_ccs
results: parsing output: 16/ for test: kms_multipipe_modeset
results: parsing output: 17/ for test: gem_exec_reloc
results: parsing output: 18/ for test: kms_ccs
results: parsing output: 19/ for test: kms_chamelium_edid
results: parsing output: 20/ for test: gem_ctx_persistence
results: parsing output: 21/ for test: kms_ccs
results: parsing output: 22/ for test: kms_plane_scaling
results: parsing output: 23/ for test: gem_exec_fence
results: parsing output: 24/ for test: gem_exec_fence
results: parsing output: 25/ for test: gem_exec_reloc
results: parsing output: 26/ for test: kms_content_protection
results: parsing output: 27/ for test: gem_exec_schedule
results: parsing output: 28/ for test: kms_flip_scaled_crc
results: parsing output: 29/ for test: syncobj_timeline
results: parsing output: 30/ for test: syncobj_wait
results: parsing output: 31/ for test: gen9_exec_parse
results: parsing output: 32/ for test: gem_userptr_blits
results: parsing output: 33/ for test: kms_flip
results: parsing output: 34/ for test: kms_vblank
results: parsing output: 35/ for test: gen9_exec_parse
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: i915_hangman
results: parsing output: 38/ for test: perf
results: parsing output: 39/ for test: kms_big_fb
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: i915_suspend
results: parsing output: 42/ for test: syncobj_timeline
results: parsing output: 43/ for test: prime_self_import
results: parsing output: 44/ for test: kms_pm_rpm
results: parsing output: 45/ for test: gem_mmap_gtt
results: parsing output: 46/ for test: kms_cursor_legacy
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: kms_psr
results: parsing output: 49/ for test: kms_plane_multiple
results: parsing output: 50/ for test: gem_exec_params
results: parsing output: 51/ for test: dmabuf_sync_file
results: parsing output: 52/ for test: gem_madvise
results: parsing output: 53/ for test: kms_flip
results: parsing output: 54/ for test: kms_psr
results: parsing output: 55/ for test: kms_fbcon_fbt
results: parsing output: 56/ for test: kms_plane
results: parsing output: 57/ for test: api_intel_bb
results: parsing output: 58/ for test: kms_dirtyfb
results: parsing output: 59/ for test: kms_flip
results: parsing output: 60/ for test: kms_big_fb
results: parsing output: 61/ for test: gem_mmap_wc
results: parsing output: 62/ for test: kms_flip
results: parsing output: 63/ for test: gem_exec_nop
results: parsing output: 64/ for test: gem_workarounds
results: parsing output: 65/ for test: gem_exec_reloc
results: parsing output: 66/ for test: kms_big_fb
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: gem_softpin
results: parsing output: 69/ for test: syncobj_basic
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: gem_fenced_exec_thrash
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: gem_partial_pwrite_pread
results: parsing output: 74/ for test: kms_properties
results: parsing output: 75/ for test: kms_psr2_sf
results: parsing output: 76/ for test: i915_pm_rps
results: parsing output: 77/ for test: syncobj_timeline
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: gem_exec_balancer
results: parsing output: 81/ for test: kms_flip
results: parsing output: 82/ for test: kms_big_fb
results: parsing output: 83/ for test: kms_big_fb
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_flip_scaled_crc
results: parsing output: 86/ for test: kms_psr2_sf
results: parsing output: 87/ for test: gem_exec_await
results: parsing output: 88/ for test: perf_pmu
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_scaling_modes
results: parsing output: 91/ for test: kms_psr
results: parsing output: 92/ for test: kms_psr
results: parsing output: 93/ for test: kms_ccs
results: parsing output: 94/ for test: gem_exec_reloc
results: parsing output: 95/ for test: gem_ctx_sseu
results: parsing output: 96/ for test: kms_prop_blob
results: parsing output: 97/ for test: gem_exec_schedule
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: kms_big_fb
results: parsing output: 100/ for test: gem_exec_capture
results: parsing output: 101/ for test: gem_ctx_param
results: parsing output: 102/ for test: kms_flip_scaled_crc
results: parsing output: 103/ for test: kms_feature_discovery
results: parsing output: 104/ for test: kms_cursor_crc
results: parsing output: 105/ for test: kms_addfb_basic
results: parsing output: 106/ for test: kms_universal_plane
results: parsing output: 107/ for test: gem_exec_reloc
results: parsing output: 108/ for test: gem_mmap_offset
results: parsing output: 109/ for test: gem_close_race
results: parsing output: 110/ for test: syncobj_timeline
results: parsing output: 111/ for test: kms_addfb_basic
results: parsing output: 112/ for test: kms_ccs
results: parsing output: 113/ for test: prime_busy
results: parsing output: 114/ for test: gen7_exec_parse
results: parsing output: 115/ for test: gem_exec_params
results: parsing output: 116/ for test: kms_big_fb
results: parsing output: 117/ for test: kms_async_flips
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: api_intel_allocator
results: parsing output: 120/ for test: gem_exec_whisper
results: parsing output: 121/ for test: gem_fence_thrash
results: parsing output: 122/ for test: gem_lmem_swapping
results: parsing output: 123/ for test: gem_render_copy
results: parsing output: 124/ for test: kms_chamelium_hpd
results: parsing output: 125/ for test: kms_pipe_b_c_ivb
results: parsing output: 126/ for test: gem_busy
results: parsing output: 127/ for test: kms_color_pipeline
results: parsing output: 128/ for test: kms_plane_cursor
results: parsing output: 129/ for test: gem_tiled_swapping
results: parsing output: 130/ for test: syncobj_wait
results: parsing output: 131/ for test: kms_joiner
results: parsing output: 132/ for test: kms_psr
results: parsing output: 133/ for test: kms_frontbuffer_tracking
Done.