[60.695362] Initializing watchdogs
[60.695407]   /dev/watchdog0
[60.708966] [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]
[60.713486] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[60.715702] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[60.718928] [001/134] (960s left) gem_flink_basic (double-flink)
[60.806493] Starting subtest: double-flink
[60.808759] Subtest double-flink: SUCCESS (0.000s)
[60.924776] [002/134] (960s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[61.038268] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[61.042395] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[61.145182] [003/134] (960s left) gem_pxp (regular-baseline-src-copy-readible)
[61.290123] Starting subtest: regular-baseline-src-copy-readible
[61.349071] Subtest regular-baseline-src-copy-readible: SUCCESS (0.061s)
[61.505180] [004/134] (959s left) gem_create (create-size-update)
[61.562015] Starting subtest: create-size-update
[61.563637] Subtest create-size-update: SUCCESS (0.000s)
[61.799467] [005/134] (959s left) gem_mmap_gtt (close-race)
[61.864379] Subtest close-race: SKIP (0.000s)
[61.929209] [006/134] (959s left) syncobj_timeline (reset-signaled)
[61.992695] Starting subtest: reset-signaled
[61.994907] Subtest reset-signaled: SUCCESS (0.000s)
[62.100043] [007/134] (959s left) sw_sync (sync_multi_consumer)
[62.130964] Starting subtest: sync_multi_consumer
[62.542163] Subtest sync_multi_consumer: SUCCESS (0.412s)
[62.610304] [008/134] (958s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[62.714572] Starting subtest: fbc-rgb565-draw-mmap-gtt
[62.719057] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[62.833515] [009/134] (958s left) kms_cursor_crc (cursor-sliding-32x10)
[63.004284] Starting subtest: cursor-sliding-32x10
[63.055076] Subtest cursor-sliding-32x10: SKIP (0.049s)
[63.341073] [010/134] (958s left) kms_cursor_crc (cursor-onscreen-32x32)
[63.492223] Starting subtest: cursor-onscreen-32x32
[63.549638] Subtest cursor-onscreen-32x32: SKIP (0.051s)
[63.854214] [011/134] (957s left) kms_frontbuffer_tracking (psr-indfb-scaledprimary)
[63.964584] Starting subtest: psr-indfb-scaledprimary
[69.760963] Subtest psr-indfb-scaledprimary: SUCCESS (5.810s)
[69.904501] [012/134] (951s left) kms_pipe_crc_basic (bad-source)
[70.017275] Starting subtest: bad-source
[70.019193] Subtest bad-source: SUCCESS (0.000s)
[70.095943] [013/134] (951s left) kms_plane (plane-panning-bottom-right)
[70.191355] Starting subtest: plane-panning-bottom-right
[70.193786] Starting dynamic subtest: pipe-A
[71.861893] Dynamic subtest pipe-A: SUCCESS (1.673s)
[71.870612] Starting dynamic subtest: pipe-B
[74.203480] Dynamic subtest pipe-B: SUCCESS (2.343s)
[74.205655] Subtest plane-panning-bottom-right: SUCCESS (4.017s)
[75.051230] [014/134] (946s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted)
[75.116537] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[75.119245] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.001s)
[75.243808] [015/134] (946s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-pwrite)
[75.344458] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-pwrite
[75.348691] Subtest fbc-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[75.450713] [016/134] (946s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-mc-ccs)
[75.544203] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-mc-ccs
[75.546573] Starting dynamic subtest: pipe-A-eDP-1
[75.569069] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[75.578579] Starting dynamic subtest: pipe-B-eDP-1
[75.599938] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[75.607162] Starting dynamic subtest: pipe-C-eDP-1
[75.629517] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[75.637285] Starting dynamic subtest: pipe-D-eDP-1
[75.658815] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[75.663165] Subtest crc-primary-rotation-180-y-tiled-gen12-mc-ccs: SKIP (0.005s)
[77.784314] [017/134] (944s left) kms_multipipe_modeset (basic-max-pipe-crc-check)
[77.883310] Starting subtest: basic-max-pipe-crc-check
[77.887754] Subtest basic-max-pipe-crc-check: SKIP (0.000s)
[77.927890] [018/134] (943s left) gem_exec_reloc (basic-cpu)
[77.996046] Subtest basic-cpu: SKIP (0.000s)
[78.078573] [019/134] (943s left) kms_ccs (crc-primary-basic-4-tiled-dg2-mc-ccs)
[78.171860] Starting subtest: crc-primary-basic-4-tiled-dg2-mc-ccs
[78.174216] Starting dynamic subtest: pipe-A-eDP-1
[78.197329] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[78.205108] Starting dynamic subtest: pipe-B-eDP-1
[78.226969] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[78.234116] Starting dynamic subtest: pipe-C-eDP-1
[78.255661] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[78.262718] Starting dynamic subtest: pipe-D-eDP-1
[78.285490] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[78.289838] Subtest crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[80.461413] [020/134] (941s left) kms_chamelium_edid (dp-edid-change-during-suspend)
[80.852724] Subtest dp-edid-change-during-suspend: SKIP (0.000s)
[81.677642] [021/134] (940s left) gem_ctx_persistence (legacy-engines-hostile)
[81.742740] Starting subtest: legacy-engines-hostile
[81.744786] Starting dynamic subtest: render
[81.896938] Dynamic subtest render: SUCCESS (0.156s)
[81.907094] Starting dynamic subtest: bsd1
[82.028892] Dynamic subtest bsd1: SUCCESS (0.130s)
[82.038830] Starting dynamic subtest: bsd2
[82.146854] Dynamic subtest bsd2: SUCCESS (0.116s)
[82.157068] Starting dynamic subtest: blt
[82.270454] Dynamic subtest blt: SUCCESS (0.123s)
[82.280396] Starting dynamic subtest: vebox
[82.388053] Dynamic subtest vebox: SUCCESS (0.115s)
[82.390835] Subtest legacy-engines-hostile: SUCCESS (0.648s)
[82.473535] [022/134] (939s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs)
[82.567249] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs
[82.569499] Starting dynamic subtest: pipe-A-eDP-1
[82.592214] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[82.600534] Starting dynamic subtest: pipe-B-eDP-1
[82.619879] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[82.626792] Starting dynamic subtest: pipe-C-eDP-1
[82.644766] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[82.651394] Starting dynamic subtest: pipe-D-eDP-1
[82.669982] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[82.673638] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.003s)
[84.869225] [023/134] (937s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[84.972627] Starting subtest: plane-upscale-20x20-with-rotation
[84.974913] Starting dynamic subtest: pipe-A
[85.197070] Dynamic subtest pipe-A: SUCCESS (0.226s)
[85.205774] Starting dynamic subtest: pipe-B
[86.465481] Dynamic subtest pipe-B: SUCCESS (1.268s)
[86.474615] Starting dynamic subtest: pipe-C
[87.793515] Dynamic subtest pipe-C: SUCCESS (1.328s)
[87.802379] Starting dynamic subtest: pipe-D
[89.126746] Dynamic subtest pipe-D: SUCCESS (1.333s)
[89.129228] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.156s)
[90.338157] [024/134] (931s left) gem_exec_fence (syncobj-wait)
[90.784254] Starting subtest: syncobj-wait
[91.894300] Subtest syncobj-wait: SUCCESS (1.109s)
[92.233268] [FACT gem_exec_fence (syncobj-wait)] new: kernel.kmod_is_loaded.vgem: true
[92.236359] [025/134] (929s left) gem_exec_fence (keep-in-fence)
[92.421070] Starting subtest: keep-in-fence
[92.423579] Starting dynamic subtest: rcs0
[92.491419] Dynamic subtest rcs0: SUCCESS (0.070s)
[92.501366] Starting dynamic subtest: bcs0
[92.543830] Dynamic subtest bcs0: SUCCESS (0.052s)
[92.553903] Starting dynamic subtest: vcs0
[93.914888] Dynamic subtest vcs0: SUCCESS (1.367s)
[93.925489] Starting dynamic subtest: vcs1
[95.897572] Dynamic subtest vcs1: SUCCESS (1.983s)
[95.906890] Starting dynamic subtest: vecs0
[97.881320] Dynamic subtest vecs0: SUCCESS (1.982s)
[97.892373] Starting dynamic subtest: ccs0
[98.117411] Dynamic subtest ccs0: SUCCESS (0.237s)
[98.120116] Subtest keep-in-fence: SUCCESS (5.697s)
[100.049046] [026/134] (922s left) gem_exec_reloc (basic-wc-read)
[100.114625] Subtest basic-wc-read: SKIP (0.000s)
[100.197987] [027/134] (922s left) kms_content_protection (content-type-change)
[100.340473] Starting subtest: content-type-change
[100.345339] Subtest content-type-change: SKIP (0.000s)
[100.512241] [028/134] (921s left) gem_exec_schedule (preemptive-hang)
[100.690630] Starting subtest: preemptive-hang
[100.693124] Starting dynamic subtest: rcs0
[110.020510] Dynamic subtest rcs0: SUCCESS (9.329s)
[110.030240] Starting dynamic subtest: bcs0
[119.044358] Dynamic subtest bcs0: SUCCESS (9.021s)
[119.057986] Starting dynamic subtest: vcs0
[128.002814] Dynamic subtest vcs0: SUCCESS (8.958s)
[128.012279] Starting dynamic subtest: vcs1
[137.022712] Dynamic subtest vcs1: SUCCESS (9.021s)
[137.032967] Starting dynamic subtest: vecs0
[146.046423] Dynamic subtest vecs0: SUCCESS (9.020s)
[146.056777] Starting dynamic subtest: ccs0
[155.013417] Dynamic subtest ccs0: SUCCESS (8.967s)
[155.015987] Subtest preemptive-hang: SUCCESS (54.321s)
[155.297530] [029/134] (866s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling)
[155.407674] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling
[155.409850] Starting dynamic subtest: pipe-A-default-mode
[158.151088] Dynamic subtest pipe-A-default-mode: SUCCESS (2.743s)
[158.153368] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (2.744s)
[158.992718] [030/134] (863s left) syncobj_timeline (wait-for-submit-snapshot)
[159.050150] Starting subtest: wait-for-submit-snapshot
[159.130458] Subtest wait-for-submit-snapshot: SUCCESS (0.082s)
[159.216908] [031/134] (863s left) syncobj_wait (single-wait-all-submitted)
[159.276287] Starting subtest: single-wait-all-submitted
[159.381213] Subtest single-wait-all-submitted: SUCCESS (0.105s)
[159.470246] [032/134] (862s left) gen9_exec_parse (unaligned-access)
[159.541094] Subtest unaligned-access: SKIP (0.000s)
[159.605557] [033/134] (862s left) gem_userptr_blits (unsync-overlap)
[159.677112] Subtest unsync-overlap: SKIP (0.000s)
[159.834716] [034/134] (862s left) kms_flip (dpms-vs-vblank-race-interruptible)
[159.949575] Starting subtest: dpms-vs-vblank-race-interruptible
[159.952067] Starting dynamic subtest: A-eDP1
[163.855538] Dynamic subtest A-eDP1: SUCCESS (3.904s)
[163.865545] Starting dynamic subtest: B-eDP1
[168.447120] Dynamic subtest B-eDP1: SUCCESS (4.591s)
[168.455744] Starting dynamic subtest: C-eDP1
[173.070804] Dynamic subtest C-eDP1: SUCCESS (4.622s)
[173.087729] Starting dynamic subtest: D-eDP1
[177.714020] Dynamic subtest D-eDP1: SUCCESS (4.640s)
[177.716465] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (17.765s)
[178.596800] [035/134] (843s left) kms_vblank (wait-busy)
[178.708367] Starting subtest: wait-busy
[178.710675] Starting dynamic subtest: pipe-A-eDP-1
[180.585858] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.875s)
[180.600304] Starting dynamic subtest: pipe-D-eDP-1
[183.154113] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.564s)
[183.156417] Subtest wait-busy: SUCCESS (4.443s)
[183.958139] [036/134] (838s left) gen9_exec_parse (bb-start-out)
[184.029643] Subtest bb-start-out: SKIP (0.000s)
[184.135673] [037/134] (838s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[184.225318] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[184.229724] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[184.346342] [038/134] (838s left) i915_hangman (gt-engine-error)
[184.418659] Starting subtest: gt-engine-error
[184.420609] Starting dynamic subtest: rcs0
[185.913381] Dynamic subtest rcs0: SUCCESS (1.494s)
[185.924441] Starting dynamic subtest: bcs0
[187.895107] Dynamic subtest bcs0: SUCCESS (1.980s)
[187.905618] Starting dynamic subtest: vcs0
[189.879359] Dynamic subtest vcs0: SUCCESS (1.982s)
[189.890019] Starting dynamic subtest: vcs1
[191.863393] Dynamic subtest vcs1: SUCCESS (1.982s)
[191.874124] Starting dynamic subtest: vecs0
[193.910027] Dynamic subtest vecs0: SUCCESS (2.045s)
[193.920673] Starting dynamic subtest: ccs0
[195.895031] Dynamic subtest ccs0: SUCCESS (1.983s)
[195.897658] Subtest gt-engine-error: SUCCESS (11.477s)
[195.986324] [039/134] (826s left) perf (gen12-group-exclusive-stream-ctx-handle)
[196.128320] Starting subtest: gen12-group-exclusive-stream-ctx-handle
[196.152735] Subtest gen12-group-exclusive-stream-ctx-handle: SUCCESS (0.025s)
[196.203844] [040/134] (826s left) kms_big_fb (4-tiled-16bpp-rotate-270)
[197.934373] Starting subtest: 4-tiled-16bpp-rotate-270
[197.953556] Subtest 4-tiled-16bpp-rotate-270: SKIP (0.019s)
[198.148296] [041/134] (824s left) kms_frontbuffer_tracking (fbcpsr-suspend)
[198.251408] Starting subtest: fbcpsr-suspend
[238.580349] Subtest fbcpsr-suspend: SUCCESS (10.299s)
[238.724607] [042/134] (784s left) i915_suspend (fence-restore-tiled2untiled)
[238.802227] Starting subtest: fence-restore-tiled2untiled
[238.807483] Subtest fence-restore-tiled2untiled: SKIP (0.000s)
[238.923806] [043/134] (783s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[238.975238] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[239.084229] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.111s)
[239.171951] [044/134] (783s left) prime_self_import (basic-with_one_bo_two_files)
[239.208243] Starting subtest: basic-with_one_bo_two_files
[239.234478] Subtest basic-with_one_bo_two_files: SUCCESS (0.025s)
[239.341063] [045/134] (783s left) kms_pm_rpm (legacy-planes)
[241.164769] Starting subtest: legacy-planes
[241.167587] Starting dynamic subtest: plane-64
[249.466769] Dynamic subtest plane-64: SUCCESS (8.382s)
[249.478386] Starting dynamic subtest: plane-94
[257.742061] Dynamic subtest plane-94: SUCCESS (8.302s)
[257.751732] Starting dynamic subtest: plane-124
[266.059264] Dynamic subtest plane-124: SUCCESS (8.328s)
[266.070688] Starting dynamic subtest: plane-134
[274.358293] Dynamic subtest plane-134: SUCCESS (8.289s)
[274.361215] Subtest legacy-planes: SUCCESS (33.310s)
[274.761811] [046/134] (748s left) gem_mmap_gtt (fault-concurrent-y)
[274.825336] Subtest fault-concurrent-Y: SKIP (0.000s)
[274.884382] [047/134] (748s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[275.000698] Starting subtest: basic-busy-flip-before-cursor-atomic
[275.005409] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s)
[275.159247] [048/134] (747s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-wc)
[275.265921] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-wc
[281.830274] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (6.565s)
[281.991712] [049/134] (741s left) kms_psr (pr-sprite-blt)
[282.103877] Starting subtest: pr-sprite-blt
[282.109076] Subtest pr-sprite-blt: SKIP (0.000s)
[282.187825] [050/134] (741s left) kms_plane_multiple (tiling-y)
[282.290160] Starting subtest: tiling-y
[282.295325] Subtest tiling-y: SKIP (0.000s)
[282.381042] [051/134] (740s left) gem_exec_params (rel-constants-invalid)
[282.451495] Starting subtest: rel-constants-invalid
[282.454479] Subtest rel-constants-invalid: SUCCESS (0.000s)
[282.575866] [052/134] (740s left) dmabuf_sync_file (export-basic)
[282.627513] Starting subtest: export-basic
[282.630342] Subtest export-basic: SUCCESS (0.002s)
[282.699198] [053/134] (740s left) gem_madvise (dontneed-before-mmap)
[282.741466] Starting subtest: dontneed-before-mmap
[282.763427] Subtest dontneed-before-mmap: SUCCESS (0.025s)
[282.879704] [054/134] (740s left) kms_flip (2x-blocking-absolute-wf_vblank)
[282.986972] Starting subtest: 2x-blocking-absolute-wf_vblank
[282.998123] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.011s)
[283.121965] [055/134] (740s left) kms_psr (fbc-psr-primary-mmap-gtt)
[283.221994] Starting subtest: fbc-psr-primary-mmap-gtt
[283.223938] Starting dynamic subtest: eDP-1
[283.227520] Dynamic subtest eDP-1: SKIP (0.000s)
[283.231471] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.001s)
[283.303847] [056/134] (740s left) kms_fbcon_fbt (psr-suspend)
[283.368426] Starting subtest: psr-suspend
[333.003780] Subtest psr-suspend: SUCCESS (19.975s)
[333.100202] [057/134] (690s left) kms_plane (pixel-format-y-tiled-modifier-source-clamping)
[333.215482] Starting subtest: pixel-format-y-tiled-modifier-source-clamping
[333.241062] Starting dynamic subtest: pipe-A-plane-0
[333.246489] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[333.256835] Starting dynamic subtest: pipe-A-plane-3
[333.261482] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[333.270246] Starting dynamic subtest: pipe-A-plane-5
[333.275051] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[334.294371] Starting dynamic subtest: pipe-B-plane-0
[334.299149] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[334.309345] Starting dynamic subtest: pipe-B-plane-3
[334.314199] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[334.324930] Starting dynamic subtest: pipe-B-plane-5
[334.330146] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[334.598101] Subtest pixel-format-y-tiled-modifier-source-clamping: SKIP (1.402s)
[335.463707] [058/134] (688s left) api_intel_bb (object-noreloc-purge-cache-simple)
[335.522401] Starting subtest: object-noreloc-purge-cache-simple
[335.525884] Subtest object-noreloc-purge-cache-simple: SUCCESS (0.007s)
[335.672810] [059/134] (687s left) kms_dirtyfb (psr-dirtyfb-ioctl)
[335.785298] Starting subtest: psr-dirtyfb-ioctl
[335.787895] Starting dynamic subtest: A-eDP-1
[339.738310] Dynamic subtest A-eDP-1: SUCCESS (3.992s)
[339.740885] Subtest psr-dirtyfb-ioctl: SUCCESS (3.994s)
[340.619381] [060/134] (682s left) kms_flip (flip-vs-panning-vs-hang)
[340.719896] Starting subtest: flip-vs-panning-vs-hang
[340.721878] Starting dynamic subtest: A-eDP1
[391.480300] Dynamic subtest A-eDP1: SUCCESS (50.807s)
[391.490755] Starting dynamic subtest: D-eDP1
[431.485013] Dynamic subtest D-eDP1: SUCCESS (40.010s)
[431.488153] Subtest flip-vs-panning-vs-hang: SUCCESS (90.821s)
[432.750758] [061/134] (590s left) kms_big_fb (linear-64bpp-rotate-270)
[432.851985] Starting subtest: linear-64bpp-rotate-270
[432.872484] Subtest linear-64bpp-rotate-270: SKIP (0.020s)
[433.053025] [062/134] (590s left) gem_mmap_wc (copy)
[433.118932] Subtest copy: SKIP (0.000s)
[433.188647] [063/134] (590s left) kms_flip (flip-vs-absolute-wf_vblank)
[433.285284] Starting subtest: flip-vs-absolute-wf_vblank
[433.287880] Starting dynamic subtest: A-eDP1
[442.188180] Dynamic subtest A-eDP1: SUCCESS (8.900s)
[442.198162] Starting dynamic subtest: B-eDP1
[451.119465] Dynamic subtest B-eDP1: SUCCESS (8.928s)
[451.129121] Starting dynamic subtest: C-eDP1
[460.035765] Dynamic subtest C-eDP1: SUCCESS (8.913s)
[460.046513] Starting dynamic subtest: D-eDP1
[468.973972] Dynamic subtest D-eDP1: SUCCESS (8.936s)
[468.976682] Subtest flip-vs-absolute-wf_vblank: SUCCESS (35.686s)
[470.208957] [064/134] (553s left) gem_exec_nop (basic-sequential)
[470.295633] Starting subtest: basic-sequential
[485.509709] Subtest basic-sequential: SUCCESS (15.226s)
[485.771937] [065/134] (538s left) gem_workarounds (suspend-resume)
[485.840520] Starting subtest: suspend-resume
[501.988228] Subtest suspend-resume: SUCCESS (1.206s)
[502.155343] [066/134] (521s left) gem_exec_reloc (basic-cpu-gtt-active)
[502.227667] Subtest basic-cpu-gtt-active: SKIP (0.000s)
[502.319960] [067/134] (521s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[502.426119] Starting subtest: yf-tiled-8bpp-rotate-270
[502.430488] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[502.530594] [068/134] (521s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-pwrite)
[502.635178] Starting subtest: fbc-rgb101010-draw-pwrite
[507.898796] Subtest fbc-rgb101010-draw-pwrite: SUCCESS (5.385s)
[509.065272] [069/134] (514s left) gem_softpin (allocator-basic)
[509.124179] Starting subtest: allocator-basic
[509.193343] Subtest allocator-basic: SUCCESS (0.070s)
[509.352831] [070/134] (514s left) syncobj_basic (bad-fd-to-handle)
[509.407055] Starting subtest: bad-fd-to-handle
[509.409159] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[509.529746] [071/134] (514s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-pwrite)
[509.638213] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-pwrite
[509.642207] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[509.764984] [072/134] (514s left) gem_fenced_exec_thrash (2-spare-fences)
[509.823372] Subtest 2-spare-fences: SKIP (0.000s)
[509.884847] [073/134] (514s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[509.983467] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[509.986924] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[510.106429] [074/134] (514s left) gem_partial_pwrite_pread (reads)
[510.165015] Subtest reads: SKIP (0.000s)
[510.244559] [075/134] (513s left) kms_properties (invalid-properties-atomic)
[510.335735] Starting subtest: invalid-properties-atomic
[510.630432] Subtest invalid-properties-atomic: SUCCESS (0.297s)
[510.715860] [076/134] (513s left) kms_psr2_sf (pr-overlay-primary-update-sf-dmg-area)
[515.691250] Starting subtest: pr-overlay-primary-update-sf-dmg-area
[515.695847] Subtest pr-overlay-primary-update-sf-dmg-area: SKIP (0.002s)
[516.539378] [077/134] (507s left) i915_pm_rps (reset)
[516.608720] Starting subtest: reset
[525.166339] Subtest reset: SUCCESS (8.587s)
[525.330288] [078/134] (499s left) syncobj_timeline (multi-wait-all-available-submitted-signaled)
[525.390625] Starting subtest: multi-wait-all-available-submitted-signaled
[525.392766] Subtest multi-wait-all-available-submitted-signaled: SUCCESS (0.000s)
[525.530524] [079/134] (498s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite)
[525.640699] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite
[525.644777] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[525.793432] [080/134] (498s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[525.909168] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[525.913473] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[526.023381] [081/134] (498s left) gem_exec_balancer (hang)
[526.270242] Starting subtest: hang
[527.944372] Subtest hang: SUCCESS (1.681s)
[528.079945] [082/134] (496s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[528.188769] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[528.191003] Starting dynamic subtest: A-eDP1
[531.749911] Dynamic subtest A-eDP1: SUCCESS (3.561s)
[531.759554] Starting dynamic subtest: B-eDP1
[534.924309] Dynamic subtest B-eDP1: SUCCESS (3.174s)
[534.933709] Starting dynamic subtest: C-eDP1
[538.036507] Dynamic subtest C-eDP1: SUCCESS (3.112s)
[538.045671] Starting dynamic subtest: D-eDP1
[541.132640] Dynamic subtest D-eDP1: SUCCESS (3.093s)
[541.134889] Subtest single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (12.948s)
[541.940129] [083/134] (482s left) kms_big_fb (yf-tiled-16bpp-rotate-0)
[542.052173] Starting subtest: yf-tiled-16bpp-rotate-0
[542.056667] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s)
[542.189068] [084/134] (482s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[542.292530] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[542.296772] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[542.429057] [085/134] (482s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render)
[542.521702] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render
[542.525856] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[542.634331] [086/134] (482s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[542.731813] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[542.733992] Starting dynamic subtest: pipe-A-default-mode
[543.034141] Dynamic subtest pipe-A-default-mode: SKIP (0.301s)
[543.038663] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.303s)
[543.899706] [087/134] (480s left) kms_psr2_sf (fbc-pr-cursor-plane-update-sf)
[548.924401] Starting subtest: fbc-pr-cursor-plane-update-sf
[548.928956] Subtest fbc-pr-cursor-plane-update-sf: SKIP (0.002s)
[549.793750] [088/134] (475s left) gem_exec_await (wide-contexts)
[550.020521] Starting subtest: wide-contexts
[573.850459] Subtest wide-contexts: SUCCESS (23.837s)
[574.061388] [089/134] (450s left) perf_pmu (most-busy-idle-check-all)
[574.147346] Starting subtest: most-busy-idle-check-all
[574.149945] Starting dynamic subtest: rcs0
[575.920389] Dynamic subtest rcs0: SUCCESS (1.772s)
[575.933456] Starting dynamic subtest: bcs0
[577.905771] Dynamic subtest bcs0: SUCCESS (1.983s)
[577.919670] Starting dynamic subtest: vcs0
[579.953231] Dynamic subtest vcs0: SUCCESS (2.044s)
[579.965730] Starting dynamic subtest: vcs1
[581.936068] Dynamic subtest vcs1: SUCCESS (1.981s)
[581.948328] Starting dynamic subtest: vecs0
[583.920735] Dynamic subtest vecs0: SUCCESS (1.982s)
[583.933413] Starting dynamic subtest: ccs0
[585.968908] Dynamic subtest ccs0: SUCCESS (2.046s)
[585.971743] Subtest most-busy-idle-check-all: SUCCESS (11.826s)
[586.083538] [090/134] (438s left) kms_frontbuffer_tracking (psr-abgr161616f-draw-mmap-gtt)
[586.214221] Starting subtest: psr-abgr161616f-draw-mmap-gtt
[586.218309] Subtest psr-abgr161616f-draw-mmap-gtt: SKIP (0.000s)
[586.339397] [091/134] (438s left) kms_scaling_modes (scaling-mode-full-aspect)
[586.429011] Starting subtest: scaling-mode-full-aspect
[586.431345] Starting dynamic subtest: pipe-A-eDP-1
[586.526301] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.099s)
[586.538509] Starting dynamic subtest: pipe-B-eDP-1
[587.694869] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.168s)
[587.705958] Starting dynamic subtest: pipe-C-eDP-1
[588.896673] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.201s)
[588.906747] Starting dynamic subtest: pipe-D-eDP-1
[590.031784] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.134s)
[590.034174] Subtest scaling-mode-full-aspect: SUCCESS (3.607s)
[591.191732] [092/134] (433s left) kms_psr (fbc-pr-basic)
[591.295854] Starting subtest: fbc-pr-basic
[591.300258] Subtest fbc-pr-basic: SKIP (0.000s)
[591.387080] [093/134] (433s left) kms_psr (psr2-sprite-mmap-cpu)
[591.489064] Starting subtest: psr2-sprite-mmap-cpu
[591.491563] Starting dynamic subtest: eDP-1
[593.180153] Dynamic subtest eDP-1: SUCCESS (1.693s)
[593.182411] Subtest psr2-sprite-mmap-cpu: SUCCESS (1.694s)
[594.063598] [094/134] (431s left) kms_ccs (random-ccs-data-4-tiled-dg2-mc-ccs)
[594.167595] Starting subtest: random-ccs-data-4-tiled-dg2-mc-ccs
[594.169732] Starting dynamic subtest: pipe-A-eDP-1
[594.194035] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[594.205350] Starting dynamic subtest: pipe-B-eDP-1
[594.227464] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[594.236721] Starting dynamic subtest: pipe-C-eDP-1
[594.259570] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[594.268610] Starting dynamic subtest: pipe-D-eDP-1
[594.291668] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[594.295860] Subtest random-ccs-data-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[596.435190] [095/134] (428s left) gem_exec_reloc (basic-wc-cpu-noreloc)
[596.498696] Subtest basic-wc-cpu-noreloc: SKIP (0.000s)
[596.578503] [096/134] (428s left) gem_ctx_sseu (invalid-args)
[596.641083] Subtest invalid-args: SKIP (0.000s)
[596.740772] [097/134] (428s left) kms_prop_blob (blob-multiple)
[596.803858] Starting subtest: blob-multiple
[596.806213] Subtest blob-multiple: SUCCESS (0.002s)
[596.936730] [098/134] (428s left) gem_exec_schedule (thriceslice)
[597.022347] Starting subtest: thriceslice
[597.024606] Starting dynamic subtest: rcs0
[597.041753] Dynamic subtest rcs0: SUCCESS (0.030s)
[597.053629] Starting dynamic subtest: bcs0
[597.075182] Dynamic subtest bcs0: SUCCESS (0.032s)
[597.086165] Starting dynamic subtest: vcs0
[597.106157] Dynamic subtest vcs0: SUCCESS (0.030s)
[597.115850] Starting dynamic subtest: vcs1
[597.157661] Dynamic subtest vcs1: SUCCESS (0.050s)
[597.169754] Starting dynamic subtest: vecs0
[597.187768] Dynamic subtest vecs0: SUCCESS (0.028s)
[597.197263] Starting dynamic subtest: ccs0
[597.218068] Dynamic subtest ccs0: SUCCESS (0.029s)
[597.220411] Subtest thriceslice: SUCCESS (0.207s)
[597.532461] [099/134] (427s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[597.623550] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[597.627862] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[597.757139] [100/134] (427s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[597.866521] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip
[597.870711] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[597.969022] [101/134] (427s left) gem_exec_capture (pi)
[598.038420] Starting subtest: pi
[598.040598] Starting dynamic subtest: rcs0
[602.229039] Dynamic subtest rcs0: SUCCESS (4.188s)
[602.241135] Starting dynamic subtest: bcs0
[606.340756] Dynamic subtest bcs0: SUCCESS (4.108s)
[606.352840] Starting dynamic subtest: vcs0
[610.463643] Dynamic subtest vcs0: SUCCESS (4.118s)
[610.475933] Starting dynamic subtest: vcs1
[614.596183] Dynamic subtest vcs1: SUCCESS (4.129s)
[614.608232] Starting dynamic subtest: vecs0
[618.712447] Dynamic subtest vecs0: SUCCESS (4.113s)
[618.724865] Starting dynamic subtest: ccs0
[622.774027] Dynamic subtest ccs0: SUCCESS (4.059s)
[622.776690] Subtest pi: SUCCESS (24.727s)
[622.865534] [102/134] (402s left) gem_ctx_param (invalid-get-no-zeromap)
[622.971443] Starting subtest: invalid-get-no-zeromap
[622.973423] Subtest invalid-get-no-zeromap: SUCCESS (0.001s)
[623.097132] [103/134] (402s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-downscaling)
[623.203977] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-downscaling
[623.207664] Starting dynamic subtest: pipe-A-default-mode
[623.496080] Dynamic subtest pipe-A-default-mode: SKIP (0.289s)
[623.500676] Subtest flip-64bpp-ytile-to-16bpp-ytile-downscaling: SKIP (0.290s)
[624.376122] [104/134] (401s left) kms_feature_discovery (dp-mst)
[624.481936] Starting subtest: dp-mst
[624.486286] Subtest dp-mst: SKIP (0.000s)
[624.569245] [105/134] (400s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[624.847473] Starting subtest: cursor-rapid-movement-512x512
[624.851912] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[625.049239] [106/134] (400s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[625.151071] Starting subtest: addfb25-y-tiled-legacy
[625.152964] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[625.259170] [107/134] (400s left) kms_universal_plane (disable-primary-vs-flip)
[625.358668] Starting subtest: disable-primary-vs-flip
[625.360541] Starting dynamic subtest: pipe-A-eDP-1
[626.923040] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.563s)
[626.933773] Starting dynamic subtest: pipe-B-eDP-1
[629.115902] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.190s)
[629.126410] Starting dynamic subtest: pipe-C-eDP-1
[631.360838] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.244s)
[631.371284] Starting dynamic subtest: pipe-D-eDP-1
[633.510137] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.146s)
[633.512790] Subtest disable-primary-vs-flip: SUCCESS (8.150s)
[634.343273] [108/134] (391s left) gem_exec_reloc (basic-cpu-read)
[634.409634] Subtest basic-cpu-read: SKIP (0.000s)
[634.481616] [109/134] (391s left) gem_mmap_offset (ptrace)
[634.541165] Starting subtest: ptrace
[634.543779] Starting dynamic subtest: smem0-wb
[634.559608] Dynamic subtest smem0-wb: SUCCESS (0.018s)
[634.571171] Starting dynamic subtest: smem0-wc
[634.579142] Dynamic subtest smem0-wc: SUCCESS (0.019s)
[634.588607] Starting dynamic subtest: smem0-uc
[634.599165] Dynamic subtest smem0-uc: SUCCESS (0.019s)
[634.601434] Subtest ptrace: SUCCESS (0.061s)
[634.729535] [110/134] (391s left) gem_close_race (basic-threads)
[634.800889] Starting subtest: basic-threads
[636.227830] Subtest basic-threads: SUCCESS (1.427s)
[636.425639] [111/134] (389s left) syncobj_timeline (wait-all-for-submit-complex)
[636.496719] Starting subtest: wait-all-for-submit-complex
[636.712880] Subtest wait-all-for-submit-complex: SUCCESS (0.214s)
[636.802196] [112/134] (389s left) kms_addfb_basic (bad-pitch-128)
[636.869713] Starting subtest: bad-pitch-128
[636.871799] Subtest bad-pitch-128: SUCCESS (0.000s)
[637.041187] [113/134] (388s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs-cc)
[637.140063] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs-cc
[637.141994] Starting dynamic subtest: pipe-A-eDP-1
[637.888396] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.740s)
[637.899330] Starting dynamic subtest: pipe-B-eDP-1
[639.653381] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.764s)
[639.664947] Starting dynamic subtest: pipe-C-eDP-1
[641.489231] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.835s)
[641.498843] Starting dynamic subtest: pipe-D-eDP-1
[643.300207] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.809s)
[643.302064] Subtest random-ccs-data-4-tiled-mtl-rc-ccs-cc: SUCCESS (6.154s)
[644.453507] [114/134] (381s left) prime_busy (before)
[644.520413] Starting subtest: before
[644.525476] Starting dynamic subtest: rcs0
[644.556578] Dynamic subtest rcs0: SUCCESS (0.032s)
[644.566343] Starting dynamic subtest: bcs0
[644.615454] Dynamic subtest bcs0: SUCCESS (0.058s)
[644.625398] Starting dynamic subtest: vcs0
[644.656264] Dynamic subtest vcs0: SUCCESS (0.040s)
[644.666254] Starting dynamic subtest: vcs1
[644.695452] Dynamic subtest vcs1: SUCCESS (0.038s)
[644.704936] Starting dynamic subtest: vecs0
[644.734925] Dynamic subtest vecs0: SUCCESS (0.038s)
[644.744318] Starting dynamic subtest: ccs0
[644.774801] Dynamic subtest ccs0: SUCCESS (0.039s)
[644.883157] Subtest before: SUCCESS (0.361s)
[644.971959] [115/134] (380s left) gen7_exec_parse (basic-allowed)
[645.035997] Subtest basic-allowed: SKIP (0.000s)
[645.117797] [116/134] (380s left) gem_exec_params (no-blt)
[645.170380] Starting subtest: no-blt
[645.175159] Subtest no-blt: SUCCESS (0.002s)
[645.320761] [117/134] (380s left) kms_big_fb (x-tiled-16bpp-rotate-90)
[645.431711] Starting subtest: x-tiled-16bpp-rotate-90
[645.451633] Subtest x-tiled-16bpp-rotate-90: SKIP (0.019s)
[645.591408] [118/134] (380s left) kms_async_flips (invalid-async-flip)
[645.682349] Starting subtest: invalid-async-flip
[646.053077] Starting dynamic subtest: pipe-A-eDP-1
[646.862159] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.809s)
[647.235811] Starting dynamic subtest: pipe-B-eDP-1
[647.988573] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.774s)
[648.349476] Starting dynamic subtest: pipe-C-eDP-1
[649.123861] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.782s)
[649.491345] Starting dynamic subtest: pipe-D-eDP-1
[650.254615] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.785s)
[650.256995] Subtest invalid-async-flip: SUCCESS (4.576s)
[651.411724] [119/134] (374s left) kms_frontbuffer_tracking (fbcpsr-1p-shrfb-fliptrack-mmap-gtt)
[651.507525] Starting subtest: fbcpsr-1p-shrfb-fliptrack-mmap-gtt
[651.511515] Subtest fbcpsr-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[651.643941] [120/134] (374s left) api_intel_allocator (gem-pool)
[651.707927] Starting subtest: gem-pool
[651.713151] Subtest gem-pool: SUCCESS (0.007s)
[651.864035] [121/134] (374s left) gem_exec_whisper (basic-fds-priority-all)
[651.931363] Starting subtest: basic-fds-priority-all
[675.893015] Subtest basic-fds-priority-all: SUCCESS (23.963s)
[676.105508] [122/134] (350s left) gem_fence_thrash (bo-write-verify-y)
[676.137075] Starting subtest: bo-write-verify-y
[676.156667] Subtest bo-write-verify-y: SKIP (0.017s)
[676.251580] [123/134] (350s left) gem_lmem_swapping (heavy-verify-multi-ccs)
[676.295953] Subtest heavy-verify-multi-ccs: SKIP (0.000s)
[676.343524] [124/134] (350s left) gem_render_copy (yf-tiled-to-vebox-yf-tiled)
[676.403655] Starting subtest: yf-tiled-to-vebox-yf-tiled
[676.407902] Subtest yf-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[676.601129] [125/134] (349s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[676.990622] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[677.808652] [126/134] (348s left) kms_pipe_b_c_ivb (from-pipe-c-to-b-with-3-lanes)
[677.863174] Subtest from-pipe-C-to-B-with-3-lanes: SKIP (0.000s)
[677.915179] [127/134] (348s left) gem_busy (busy)
[677.971396] Starting subtest: busy
[677.973680] Starting dynamic subtest: all-engines
[678.033469] Dynamic subtest all-engines: SUCCESS (0.062s)
[678.044854] Starting dynamic subtest: rcs0
[679.927815] Dynamic subtest rcs0: SUCCESS (1.893s)
[679.939595] Starting dynamic subtest: bcs0
[679.980599] Dynamic subtest bcs0: SUCCESS (0.051s)
[679.991411] Starting dynamic subtest: vcs0
[680.020764] Dynamic subtest vcs0: SUCCESS (0.038s)
[680.031012] Starting dynamic subtest: vcs1
[681.973652] Dynamic subtest vcs1: SUCCESS (1.951s)
[681.985195] Starting dynamic subtest: vecs0
[683.958628] Dynamic subtest vecs0: SUCCESS (1.984s)
[683.970196] Starting dynamic subtest: ccs0
[685.942144] Dynamic subtest ccs0: SUCCESS (1.983s)
[685.944244] Subtest busy: SUCCESS (7.970s)
[686.314030] [128/134] (340s left) kms_color_pipeline (plane-lut1d-lut1d)
[686.426660] Starting subtest: plane-lut1d-lut1d
[686.439642] Starting dynamic subtest: pipe-A-eDP-1
[687.170852] Dynamic subtest pipe-A-eDP-1: FAIL (0.343s)
[687.826518] Starting dynamic subtest: pipe-B-eDP-1
[688.679346] Dynamic subtest pipe-B-eDP-1: FAIL (0.313s)
[689.257999] Starting dynamic subtest: pipe-C-eDP-1
[690.106626] Dynamic subtest pipe-C-eDP-1: FAIL (0.258s)
[690.588052] Starting dynamic subtest: pipe-D-eDP-1
[691.469190] Dynamic subtest pipe-D-eDP-1: FAIL (0.289s)
[691.471233] Subtest plane-lut1d-lut1d: FAIL (4.732s)
[691.976246] [129/134] (334s left) kms_plane_cursor (primary)
[692.080819] Starting subtest: primary
[692.085351] Starting dynamic subtest: pipe-A-eDP-1-size-64
[694.674932] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.595s)
[694.700003] Starting dynamic subtest: pipe-A-eDP-1-size-128
[697.286109] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.593s)
[697.311463] Starting dynamic subtest: pipe-A-eDP-1-size-256
[699.941841] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.638s)
[700.259392] Starting dynamic subtest: pipe-B-eDP-1-size-64
[703.607621] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.359s)
[703.632743] Starting dynamic subtest: pipe-B-eDP-1-size-128
[706.195702] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.571s)
[706.222205] Starting dynamic subtest: pipe-B-eDP-1-size-256
[708.807647] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.594s)
[709.129372] Starting dynamic subtest: pipe-C-eDP-1-size-64
[711.997371] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.886s)
[712.026164] Starting dynamic subtest: pipe-C-eDP-1-size-128
[714.230276] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.213s)
[714.259295] Starting dynamic subtest: pipe-C-eDP-1-size-256
[716.452417] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.202s)
[716.771290] Starting dynamic subtest: pipe-D-eDP-1-size-64
[719.615470] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.857s)
[719.643558] Starting dynamic subtest: pipe-D-eDP-1-size-128
[721.815394] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.180s)
[721.843380] Starting dynamic subtest: pipe-D-eDP-1-size-256
[724.014380] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.180s)
[724.328397] Subtest primary: SUCCESS (32.257s)
[725.189483] [130/134] (301s left) gem_tiled_swapping (non-threaded)
[725.267072] Subtest non-threaded: SKIP (0.000s)
[725.330456] [131/134] (301s left) syncobj_wait (invalid-signal-zero-handles)
[725.389367] Starting subtest: invalid-signal-zero-handles
[725.391674] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[725.510190] [132/134] (301s left) kms_joiner (basic-force-ultra-joiner)
[725.612701] Starting subtest: basic-force-ultra-joiner
[725.616845] Subtest basic-force-ultra-joiner: SKIP (0.000s)
[725.694570] [133/134] (301s left) kms_psr (fbc-psr2-sprite-blt)
[725.790690] Starting subtest: fbc-psr2-sprite-blt
[725.792750] Starting dynamic subtest: eDP-1
[725.796680] Dynamic subtest eDP-1: SKIP (0.000s)
[725.800571] Subtest fbc-psr2-sprite-blt: SKIP (0.001s)
[725.876276] [134/134] (300s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc)
[725.980757] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc
[725.984791] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[726.101379] 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.