[55.930993] Initializing watchdogs
[55.931055]   /dev/watchdog0
[55.945099] [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]
[55.949545] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[55.952242] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[55.955642] [001/134] (960s left) gem_flink_basic (double-flink)
[56.031166] Starting subtest: double-flink
[56.033573] Subtest double-flink: SUCCESS (0.000s)
[56.124170] [002/134] (960s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[56.224588] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[56.229034] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[56.311694] [003/134] (960s left) gem_pxp (regular-baseline-src-copy-readible)
[56.439327] Starting subtest: regular-baseline-src-copy-readible
[56.501161] Subtest regular-baseline-src-copy-readible: SUCCESS (0.066s)
[56.647100] [004/134] (959s left) gem_create (create-size-update)
[56.705324] Starting subtest: create-size-update
[56.707293] Subtest create-size-update: SUCCESS (0.000s)
[56.950529] [005/134] (959s left) gem_mmap_gtt (close-race)
[57.005029] Subtest close-race: SKIP (0.000s)
[57.063939] [006/134] (959s left) syncobj_timeline (reset-signaled)
[57.118586] Starting subtest: reset-signaled
[57.120932] Subtest reset-signaled: SUCCESS (0.000s)
[57.223484] [007/134] (959s left) sw_sync (sync_multi_consumer)
[57.263869] Starting subtest: sync_multi_consumer
[57.689972] Subtest sync_multi_consumer: SUCCESS (0.431s)
[57.756746] [008/134] (958s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[57.866623] Starting subtest: fbc-rgb565-draw-mmap-gtt
[57.870810] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[57.975733] [009/134] (958s left) kms_cursor_crc (cursor-sliding-32x10)
[58.143692] Starting subtest: cursor-sliding-32x10
[58.198422] Subtest cursor-sliding-32x10: SKIP (0.049s)
[58.486649] [010/134] (958s left) kms_cursor_crc (cursor-onscreen-32x32)
[58.631664] Starting subtest: cursor-onscreen-32x32
[58.681014] Subtest cursor-onscreen-32x32: SKIP (0.047s)
[58.967808] [011/134] (957s left) kms_frontbuffer_tracking (psr-indfb-scaledprimary)
[59.066337] Starting subtest: psr-indfb-scaledprimary
[64.763457] Subtest psr-indfb-scaledprimary: SUCCESS (5.731s)
[64.906211] [012/134] (951s left) kms_pipe_crc_basic (bad-source)
[65.008321] Starting subtest: bad-source
[65.010647] Subtest bad-source: SUCCESS (0.000s)
[65.102986] [013/134] (951s left) kms_plane (plane-panning-bottom-right)
[65.198851] Starting subtest: plane-panning-bottom-right
[65.202279] Starting dynamic subtest: pipe-A
[66.882703] Dynamic subtest pipe-A: SUCCESS (1.689s)
[66.891767] Starting dynamic subtest: pipe-B
[69.224776] Dynamic subtest pipe-B: SUCCESS (2.347s)
[69.227267] Subtest plane-panning-bottom-right: SUCCESS (4.039s)
[70.041433] [014/134] (946s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted)
[70.097542] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[70.099718] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[70.215494] [015/134] (946s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-pwrite)
[70.308719] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-pwrite
[70.312660] Subtest fbc-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[70.431695] [016/134] (946s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-mc-ccs)
[70.527852] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-mc-ccs
[70.530205] Starting dynamic subtest: pipe-A-eDP-1
[70.553277] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[70.561871] Starting dynamic subtest: pipe-B-eDP-1
[70.583305] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[70.590705] Starting dynamic subtest: pipe-C-eDP-1
[70.612812] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[70.620953] Starting dynamic subtest: pipe-D-eDP-1
[70.643051] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[70.647119] Subtest crc-primary-rotation-180-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[72.725553] [017/134] (944s left) kms_multipipe_modeset (basic-max-pipe-crc-check)
[72.830016] Starting subtest: basic-max-pipe-crc-check
[72.834503] Subtest basic-max-pipe-crc-check: SKIP (0.000s)
[72.872434] [018/134] (944s left) gem_exec_reloc (basic-cpu)
[72.940148] Subtest basic-cpu: SKIP (0.000s)
[72.998350] [019/134] (944s left) kms_ccs (crc-primary-basic-4-tiled-dg2-mc-ccs)
[73.095063] Starting subtest: crc-primary-basic-4-tiled-dg2-mc-ccs
[73.097341] Starting dynamic subtest: pipe-A-eDP-1
[73.120193] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[73.129322] Starting dynamic subtest: pipe-B-eDP-1
[73.151261] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[73.157628] Starting dynamic subtest: pipe-C-eDP-1
[73.179247] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[73.186278] Starting dynamic subtest: pipe-D-eDP-1
[73.208158] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[73.212532] Subtest crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.006s)
[75.394920] [020/134] (941s left) kms_chamelium_edid (dp-edid-change-during-suspend)
[75.786476] Subtest dp-edid-change-during-suspend: SKIP (0.000s)
[76.590766] [021/134] (940s left) gem_ctx_persistence (legacy-engines-hostile)
[76.652661] Starting subtest: legacy-engines-hostile
[76.654921] Starting dynamic subtest: render
[76.773292] Dynamic subtest render: SUCCESS (0.120s)
[76.784186] Starting dynamic subtest: bsd1
[76.886847] Dynamic subtest bsd1: SUCCESS (0.112s)
[76.896778] Starting dynamic subtest: bsd2
[77.002033] Dynamic subtest bsd2: SUCCESS (0.113s)
[77.010944] Starting dynamic subtest: blt
[77.116406] Dynamic subtest blt: SUCCESS (0.114s)
[77.126499] Starting dynamic subtest: vebox
[77.231407] Dynamic subtest vebox: SUCCESS (0.113s)
[77.234358] Subtest legacy-engines-hostile: SUCCESS (0.579s)
[77.318123] [022/134] (939s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs)
[77.409195] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs
[77.411535] Starting dynamic subtest: pipe-A-eDP-1
[77.434593] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[77.443990] Starting dynamic subtest: pipe-B-eDP-1
[77.465259] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[77.472770] Starting dynamic subtest: pipe-C-eDP-1
[77.494816] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[77.503172] Starting dynamic subtest: pipe-D-eDP-1
[77.524994] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[77.529053] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.003s)
[79.682360] [023/134] (937s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[79.783186] Starting subtest: plane-upscale-20x20-with-rotation
[79.785645] Starting dynamic subtest: pipe-A
[80.007107] Dynamic subtest pipe-A: SUCCESS (0.226s)
[80.016108] Starting dynamic subtest: pipe-B
[81.344872] Dynamic subtest pipe-B: SUCCESS (1.336s)
[81.354124] Starting dynamic subtest: pipe-C
[82.668121] Dynamic subtest pipe-C: SUCCESS (1.323s)
[82.676686] Starting dynamic subtest: pipe-D
[84.007109] Dynamic subtest pipe-D: SUCCESS (1.338s)
[84.009493] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.226s)
[85.206221] [024/134] (932s left) gem_exec_fence (syncobj-wait)
[85.656610] Starting subtest: syncobj-wait
[86.929088] Subtest syncobj-wait: SUCCESS (1.271s)
[87.298970] [FACT gem_exec_fence (syncobj-wait)] new: kernel.kmod_is_loaded.vgem: true
[87.302086] [025/134] (930s left) gem_exec_fence (keep-in-fence)
[87.484298] Starting subtest: keep-in-fence
[87.486177] Starting dynamic subtest: rcs0
[87.547600] Dynamic subtest rcs0: SUCCESS (0.066s)
[87.557457] Starting dynamic subtest: bcs0
[87.600439] Dynamic subtest bcs0: SUCCESS (0.052s)
[87.610104] Starting dynamic subtest: vcs0
[88.917815] Dynamic subtest vcs0: SUCCESS (1.315s)
[88.927831] Starting dynamic subtest: vcs1
[90.901315] Dynamic subtest vcs1: SUCCESS (1.981s)
[90.910038] Starting dynamic subtest: vecs0
[92.885874] Dynamic subtest vecs0: SUCCESS (1.984s)
[92.894575] Starting dynamic subtest: ccs0
[93.115358] Dynamic subtest ccs0: SUCCESS (0.229s)
[93.118035] Subtest keep-in-fence: SUCCESS (5.633s)
[95.058477] [026/134] (922s left) gem_exec_reloc (basic-wc-read)
[95.133125] Subtest basic-wc-read: SKIP (0.000s)
[95.214080] [027/134] (922s left) kms_content_protection (content-type-change)
[95.363580] Starting subtest: content-type-change
[95.367943] Subtest content-type-change: SKIP (0.000s)
[95.526672] [028/134] (921s left) gem_exec_schedule (preemptive-hang)
[95.717068] Starting subtest: preemptive-hang
[95.719377] Starting dynamic subtest: rcs0
[105.086822] Dynamic subtest rcs0: SUCCESS (9.369s)
[105.096454] Starting dynamic subtest: bcs0
[114.052789] Dynamic subtest bcs0: SUCCESS (8.960s)
[114.060087] Starting dynamic subtest: vcs0
[123.012292] Dynamic subtest vcs0: SUCCESS (8.962s)
[123.021527] Starting dynamic subtest: vcs1
[132.033678] Dynamic subtest vcs1: SUCCESS (9.015s)
[132.041290] Starting dynamic subtest: vecs0
[141.049403] Dynamic subtest vecs0: SUCCESS (9.020s)
[141.056705] Starting dynamic subtest: ccs0
[150.017791] Dynamic subtest ccs0: SUCCESS (8.961s)
[150.019885] Subtest preemptive-hang: SUCCESS (54.293s)
[150.279832] [029/134] (867s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling)
[150.375859] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling
[150.378281] Starting dynamic subtest: pipe-A-default-mode
[153.167707] Dynamic subtest pipe-A-default-mode: SUCCESS (2.791s)
[153.169791] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (2.792s)
[154.014065] [030/134] (863s left) syncobj_timeline (wait-for-submit-snapshot)
[154.082933] Starting subtest: wait-for-submit-snapshot
[154.162694] Subtest wait-for-submit-snapshot: SUCCESS (0.082s)
[154.247808] [031/134] (863s left) syncobj_wait (single-wait-all-submitted)
[154.320795] Starting subtest: single-wait-all-submitted
[154.424857] Subtest single-wait-all-submitted: SUCCESS (0.104s)
[154.522991] [032/134] (863s left) gen9_exec_parse (unaligned-access)
[154.587977] Subtest unaligned-access: SKIP (0.000s)
[154.652779] [033/134] (863s left) gem_userptr_blits (unsync-overlap)
[154.728311] Subtest unsync-overlap: SKIP (0.000s)
[154.890966] [034/134] (862s left) kms_flip (dpms-vs-vblank-race-interruptible)
[154.996173] Starting subtest: dpms-vs-vblank-race-interruptible
[154.998499] Starting dynamic subtest: A-eDP1
[160.005572] Dynamic subtest A-eDP1: SUCCESS (5.005s)
[160.014122] Starting dynamic subtest: B-eDP1
[163.510443] Dynamic subtest B-eDP1: SUCCESS (3.503s)
[163.519046] Starting dynamic subtest: C-eDP1
[168.144775] Dynamic subtest C-eDP1: SUCCESS (4.633s)
[168.153425] Starting dynamic subtest: D-eDP1
[172.779536] Dynamic subtest D-eDP1: SUCCESS (4.635s)
[172.781983] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (17.783s)
[173.658305] [035/134] (844s left) kms_vblank (wait-busy)
[173.750086] Starting subtest: wait-busy
[173.752037] Starting dynamic subtest: pipe-A-eDP-1
[175.626823] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.876s)
[175.640017] Starting dynamic subtest: pipe-D-eDP-1
[178.207079] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.577s)
[178.209320] Subtest wait-busy: SUCCESS (4.456s)
[179.015647] [036/134] (838s left) gen9_exec_parse (bb-start-out)
[179.081426] Subtest bb-start-out: SKIP (0.000s)
[179.145845] [037/134] (838s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[179.251194] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[179.255616] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[179.402256] [038/134] (838s left) i915_hangman (gt-engine-error)
[179.488900] Starting subtest: gt-engine-error
[179.491186] Starting dynamic subtest: rcs0
[180.852357] Dynamic subtest rcs0: SUCCESS (1.363s)
[180.863390] Starting dynamic subtest: bcs0
[182.898750] Dynamic subtest bcs0: SUCCESS (2.044s)
[182.909526] Starting dynamic subtest: vcs0
[184.883613] Dynamic subtest vcs0: SUCCESS (1.983s)
[184.894613] Starting dynamic subtest: vcs1
[186.867872] Dynamic subtest vcs1: SUCCESS (1.982s)
[186.878774] Starting dynamic subtest: vecs0
[188.852035] Dynamic subtest vecs0: SUCCESS (1.982s)
[188.862944] Starting dynamic subtest: ccs0
[190.900408] Dynamic subtest ccs0: SUCCESS (2.046s)
[190.902991] Subtest gt-engine-error: SUCCESS (11.412s)
[191.003099] [039/134] (826s left) perf (gen12-group-exclusive-stream-ctx-handle)
[191.131537] Starting subtest: gen12-group-exclusive-stream-ctx-handle
[191.155209] Subtest gen12-group-exclusive-stream-ctx-handle: SUCCESS (0.023s)
[191.196128] [040/134] (826s left) kms_big_fb (4-tiled-16bpp-rotate-270)
[192.948107] Starting subtest: 4-tiled-16bpp-rotate-270
[192.967653] Subtest 4-tiled-16bpp-rotate-270: SKIP (0.019s)
[193.106840] [041/134] (824s left) kms_frontbuffer_tracking (fbcpsr-suspend)
[193.207959] Starting subtest: fbcpsr-suspend
[233.583827] Subtest fbcpsr-suspend: SUCCESS (11.025s)
[233.749610] [042/134] (784s left) i915_suspend (fence-restore-tiled2untiled)
[233.817481] Starting subtest: fence-restore-tiled2untiled
[233.822810] Subtest fence-restore-tiled2untiled: SKIP (0.000s)
[233.933210] [043/134] (784s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[233.994335] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[234.099484] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.107s)
[234.188035] [044/134] (783s left) prime_self_import (basic-with_one_bo_two_files)
[234.219529] Starting subtest: basic-with_one_bo_two_files
[234.242956] Subtest basic-with_one_bo_two_files: SUCCESS (0.024s)
[234.394593] [045/134] (783s left) kms_pm_rpm (legacy-planes)
[236.518077] Starting subtest: legacy-planes
[236.520960] Starting dynamic subtest: plane-64
[244.829322] Dynamic subtest plane-64: SUCCESS (8.425s)
[244.840756] Starting dynamic subtest: plane-94
[253.143087] Dynamic subtest plane-94: SUCCESS (8.351s)
[253.155067] Starting dynamic subtest: plane-124
[261.414602] Dynamic subtest plane-124: SUCCESS (8.285s)
[261.426804] Starting dynamic subtest: plane-134
[269.746816] Dynamic subtest plane-134: SUCCESS (8.318s)
[269.749990] Subtest legacy-planes: SUCCESS (33.388s)
[270.134621] [046/134] (748s left) gem_mmap_gtt (fault-concurrent-y)
[270.200802] Subtest fault-concurrent-Y: SKIP (0.000s)
[270.258694] [047/134] (748s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[270.380566] Starting subtest: basic-busy-flip-before-cursor-atomic
[270.385255] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s)
[270.539391] [048/134] (747s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-wc)
[270.639864] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-wc
[277.216972] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (6.578s)
[277.368763] [049/134] (741s left) kms_psr (pr-sprite-blt)
[277.478871] Starting subtest: pr-sprite-blt
[277.483873] Subtest pr-sprite-blt: SKIP (0.000s)
[277.561448] [050/134] (740s left) kms_plane_multiple (tiling-y)
[277.657281] Starting subtest: tiling-y
[277.661733] Subtest tiling-y: SKIP (0.000s)
[277.739698] [051/134] (740s left) gem_exec_params (rel-constants-invalid)
[277.798720] Starting subtest: rel-constants-invalid
[277.801084] Subtest rel-constants-invalid: SUCCESS (0.000s)
[277.920805] [052/134] (740s left) dmabuf_sync_file (export-basic)
[277.962971] Starting subtest: export-basic
[277.965347] Subtest export-basic: SUCCESS (0.001s)
[278.031469] [053/134] (740s left) gem_madvise (dontneed-before-mmap)
[278.066958] Starting subtest: dontneed-before-mmap
[278.089005] Subtest dontneed-before-mmap: SUCCESS (0.022s)
[278.215568] [054/134] (740s left) kms_flip (2x-blocking-absolute-wf_vblank)
[278.311219] Starting subtest: 2x-blocking-absolute-wf_vblank
[278.323867] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.012s)
[278.415024] [055/134] (740s left) kms_psr (fbc-psr-primary-mmap-gtt)
[278.511609] Starting subtest: fbc-psr-primary-mmap-gtt
[278.513743] Starting dynamic subtest: eDP-1
[278.517784] Dynamic subtest eDP-1: SKIP (0.000s)
[278.522051] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.001s)
[278.595606] [056/134] (740s left) kms_fbcon_fbt (psr-suspend)
[278.657674] Starting subtest: psr-suspend
[328.264019] Subtest psr-suspend: SUCCESS (20.215s)
[328.307375] [057/134] (690s left) kms_plane (pixel-format-y-tiled-modifier-source-clamping)
[328.417771] Starting subtest: pixel-format-y-tiled-modifier-source-clamping
[328.442557] Starting dynamic subtest: pipe-A-plane-0
[328.448014] Dynamic subtest pipe-A-plane-0: SKIP (0.000s)
[328.457088] Starting dynamic subtest: pipe-A-plane-3
[328.462331] Dynamic subtest pipe-A-plane-3: SKIP (0.000s)
[328.470668] Starting dynamic subtest: pipe-A-plane-5
[328.475347] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[329.531183] Starting dynamic subtest: pipe-B-plane-0
[329.535564] Dynamic subtest pipe-B-plane-0: SKIP (0.000s)
[329.543521] Starting dynamic subtest: pipe-B-plane-3
[329.548007] Dynamic subtest pipe-B-plane-3: SKIP (0.000s)
[329.555843] Starting dynamic subtest: pipe-B-plane-5
[329.560311] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[329.833411] Subtest pixel-format-y-tiled-modifier-source-clamping: SKIP (1.444s)
[330.699022] [058/134] (688s left) api_intel_bb (object-noreloc-purge-cache-simple)
[330.756684] Starting subtest: object-noreloc-purge-cache-simple
[330.761768] Subtest object-noreloc-purge-cache-simple: SUCCESS (0.006s)
[330.914135] [059/134] (687s left) kms_dirtyfb (psr-dirtyfb-ioctl)
[331.013363] Starting subtest: psr-dirtyfb-ioctl
[331.015796] Starting dynamic subtest: A-eDP-1
[334.952864] Dynamic subtest A-eDP-1: SUCCESS (3.990s)
[334.955926] Subtest psr-dirtyfb-ioctl: SUCCESS (3.991s)
[335.831845] [060/134] (682s left) kms_flip (flip-vs-panning-vs-hang)
[335.938569] Starting subtest: flip-vs-panning-vs-hang
[335.940870] Starting dynamic subtest: A-eDP1
[386.616919] Dynamic subtest A-eDP1: SUCCESS (50.737s)
[386.625948] Starting dynamic subtest: D-eDP1
[435.646989] Dynamic subtest D-eDP1: SUCCESS (49.031s)
[435.650401] Subtest flip-vs-panning-vs-hang: SUCCESS (99.772s)
[436.844503] [061/134] (582s left) kms_big_fb (linear-64bpp-rotate-270)
[436.960041] Starting subtest: linear-64bpp-rotate-270
[436.979202] Subtest linear-64bpp-rotate-270: SKIP (0.019s)
[437.128027] [062/134] (581s left) gem_mmap_wc (copy)
[437.192662] Subtest copy: SKIP (0.000s)
[437.257528] [063/134] (581s left) kms_flip (flip-vs-absolute-wf_vblank)
[437.360907] Starting subtest: flip-vs-absolute-wf_vblank
[437.363724] Starting dynamic subtest: A-eDP1
[446.274147] Dynamic subtest A-eDP1: SUCCESS (8.911s)
[446.283184] Starting dynamic subtest: B-eDP1
[455.205346] Dynamic subtest B-eDP1: SUCCESS (8.929s)
[455.215285] Starting dynamic subtest: C-eDP1
[464.169654] Dynamic subtest C-eDP1: SUCCESS (8.917s)
[464.179656] Starting dynamic subtest: D-eDP1
[473.105713] Dynamic subtest D-eDP1: SUCCESS (8.933s)
[473.108160] Subtest flip-vs-absolute-wf_vblank: SUCCESS (35.698s)
[474.300247] [064/134] (544s left) gem_exec_nop (basic-sequential)
[474.379631] Starting subtest: basic-sequential
[488.703124] Subtest basic-sequential: SUCCESS (14.311s)
[488.906491] [065/134] (530s left) gem_workarounds (suspend-resume)
[488.985146] Starting subtest: suspend-resume
[505.081731] Subtest suspend-resume: SUCCESS (1.216s)
[505.237573] [066/134] (513s left) gem_exec_reloc (basic-cpu-gtt-active)
[505.307978] Subtest basic-cpu-gtt-active: SKIP (0.000s)
[505.397239] [067/134] (513s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[505.496381] Starting subtest: yf-tiled-8bpp-rotate-270
[505.501923] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[505.617157] [068/134] (513s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-pwrite)
[505.723942] Starting subtest: fbc-rgb101010-draw-pwrite
[510.947058] Subtest fbc-rgb101010-draw-pwrite: SUCCESS (5.396s)
[512.061707] [069/134] (507s left) gem_softpin (allocator-basic)
[512.119009] Starting subtest: allocator-basic
[512.186220] Subtest allocator-basic: SUCCESS (0.069s)
[512.338646] [070/134] (506s left) syncobj_basic (bad-fd-to-handle)
[512.398060] Starting subtest: bad-fd-to-handle
[512.400282] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[512.519522] [071/134] (506s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-pwrite)
[512.625314] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-pwrite
[512.630221] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[512.733557] [072/134] (506s left) gem_fenced_exec_thrash (2-spare-fences)
[512.785290] Subtest 2-spare-fences: SKIP (0.000s)
[512.858889] [073/134] (506s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[512.955390] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[512.959856] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[513.070103] [074/134] (506s left) gem_partial_pwrite_pread (reads)
[513.128178] Subtest reads: SKIP (0.000s)
[513.192847] [075/134] (506s left) kms_properties (invalid-properties-atomic)
[513.284595] Starting subtest: invalid-properties-atomic
[513.583744] Subtest invalid-properties-atomic: SUCCESS (0.304s)
[513.668718] [076/134] (505s left) kms_psr2_sf (pr-overlay-primary-update-sf-dmg-area)
[518.656489] Starting subtest: pr-overlay-primary-update-sf-dmg-area
[518.662177] Subtest pr-overlay-primary-update-sf-dmg-area: SKIP (0.002s)
[519.510986] [077/134] (499s left) i915_pm_rps (reset)
[519.588415] Starting subtest: reset
[528.030788] Subtest reset: SUCCESS (8.479s)
[528.182957] [078/134] (491s left) syncobj_timeline (multi-wait-all-available-submitted-signaled)
[528.241502] Starting subtest: multi-wait-all-available-submitted-signaled
[528.244397] Subtest multi-wait-all-available-submitted-signaled: SUCCESS (0.000s)
[528.372403] [079/134] (491s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite)
[528.486602] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite
[528.491997] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[528.609248] [080/134] (491s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[528.715808] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[528.721117] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[528.819599] [081/134] (490s left) gem_exec_balancer (hang)
[529.088152] Starting subtest: hang
[531.084664] Subtest hang: SUCCESS (2.003s)
[531.216593] [082/134] (488s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[531.310483] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[531.313132] Starting dynamic subtest: A-eDP1
[534.878169] Dynamic subtest A-eDP1: SUCCESS (3.572s)
[534.888169] Starting dynamic subtest: B-eDP1
[538.082942] Dynamic subtest B-eDP1: SUCCESS (3.206s)
[538.092485] Starting dynamic subtest: C-eDP1
[541.205185] Dynamic subtest C-eDP1: SUCCESS (3.118s)
[541.223692] Starting dynamic subtest: D-eDP1
[544.325968] Dynamic subtest D-eDP1: SUCCESS (3.117s)
[544.328307] Subtest single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (13.020s)
[545.136163] [083/134] (474s left) kms_big_fb (yf-tiled-16bpp-rotate-0)
[545.247499] Starting subtest: yf-tiled-16bpp-rotate-0
[545.252942] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s)
[545.354684] [084/134] (474s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[545.464315] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[545.469245] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[545.568778] [085/134] (474s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render)
[545.678061] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render
[545.682800] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[545.799861] [086/134] (474s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[545.884451] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[545.887277] Starting dynamic subtest: pipe-A-default-mode
[546.190984] Dynamic subtest pipe-A-default-mode: SKIP (0.305s)
[546.196361] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.306s)
[546.988737] [087/134] (472s left) kms_psr2_sf (fbc-pr-cursor-plane-update-sf)
[552.050027] Starting subtest: fbc-pr-cursor-plane-update-sf
[552.056241] Subtest fbc-pr-cursor-plane-update-sf: SKIP (0.002s)
[552.906014] [088/134] (467s left) gem_exec_await (wide-contexts)
[553.114894] Starting subtest: wide-contexts
[576.982762] Subtest wide-contexts: SUCCESS (23.868s)
[577.190112] [089/134] (442s left) perf_pmu (most-busy-idle-check-all)
[577.275802] Starting subtest: most-busy-idle-check-all
[577.279094] Starting dynamic subtest: rcs0
[579.057822] Dynamic subtest rcs0: SUCCESS (1.783s)
[579.071301] Starting dynamic subtest: bcs0
[581.043810] Dynamic subtest bcs0: SUCCESS (1.983s)
[581.056128] Starting dynamic subtest: vcs0
[583.026952] Dynamic subtest vcs0: SUCCESS (1.981s)
[583.040521] Starting dynamic subtest: vcs1
[585.074662] Dynamic subtest vcs1: SUCCESS (2.045s)
[585.088138] Starting dynamic subtest: vecs0
[587.059117] Dynamic subtest vecs0: SUCCESS (1.982s)
[587.072530] Starting dynamic subtest: ccs0
[589.043324] Dynamic subtest ccs0: SUCCESS (1.982s)
[589.046415] Subtest most-busy-idle-check-all: SUCCESS (11.773s)
[589.155843] [090/134] (430s left) kms_frontbuffer_tracking (psr-abgr161616f-draw-mmap-gtt)
[589.267499] Starting subtest: psr-abgr161616f-draw-mmap-gtt
[589.273011] Subtest psr-abgr161616f-draw-mmap-gtt: SKIP (0.000s)
[589.377266] [091/134] (430s left) kms_scaling_modes (scaling-mode-full-aspect)
[589.468492] Starting subtest: scaling-mode-full-aspect
[589.470919] Starting dynamic subtest: pipe-A-eDP-1
[589.567659] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.100s)
[589.578130] Starting dynamic subtest: pipe-B-eDP-1
[590.714540] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.145s)
[590.724993] Starting dynamic subtest: pipe-C-eDP-1
[591.840732] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.126s)
[591.853494] Starting dynamic subtest: pipe-D-eDP-1
[592.991250] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.148s)
[592.994110] Subtest scaling-mode-full-aspect: SUCCESS (3.526s)
[594.231405] [092/134] (425s left) kms_psr (fbc-pr-basic)
[594.340256] Starting subtest: fbc-pr-basic
[594.345308] Subtest fbc-pr-basic: SKIP (0.000s)
[594.430007] [093/134] (425s left) kms_psr (psr2-sprite-mmap-cpu)
[594.534370] Starting subtest: psr2-sprite-mmap-cpu
[594.537101] Starting dynamic subtest: eDP-1
[596.217775] Dynamic subtest eDP-1: SUCCESS (1.682s)
[596.220477] Subtest psr2-sprite-mmap-cpu: SUCCESS (1.683s)
[597.091986] [094/134] (423s left) kms_ccs (random-ccs-data-4-tiled-dg2-mc-ccs)
[597.193215] Starting subtest: random-ccs-data-4-tiled-dg2-mc-ccs
[597.195860] Starting dynamic subtest: pipe-A-eDP-1
[597.223991] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[597.234261] Starting dynamic subtest: pipe-B-eDP-1
[597.262248] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[597.272108] Starting dynamic subtest: pipe-C-eDP-1
[597.299918] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[597.309480] Starting dynamic subtest: pipe-D-eDP-1
[597.338403] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[597.343490] Subtest random-ccs-data-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[599.460962] [095/134] (420s left) gem_exec_reloc (basic-wc-cpu-noreloc)
[599.528756] Subtest basic-wc-cpu-noreloc: SKIP (0.000s)
[599.614848] [096/134] (420s left) gem_ctx_sseu (invalid-args)
[599.677376] Subtest invalid-args: SKIP (0.000s)
[599.759276] [097/134] (420s left) kms_prop_blob (blob-multiple)
[599.816661] Starting subtest: blob-multiple
[599.819351] Subtest blob-multiple: SUCCESS (0.002s)
[599.935087] [098/134] (420s left) gem_exec_schedule (thriceslice)
[600.016325] Starting subtest: thriceslice
[600.018759] Starting dynamic subtest: rcs0
[600.035915] Dynamic subtest rcs0: SUCCESS (0.031s)
[600.046489] Starting dynamic subtest: bcs0
[600.066502] Dynamic subtest bcs0: SUCCESS (0.030s)
[600.076051] Starting dynamic subtest: vcs0
[600.099353] Dynamic subtest vcs0: SUCCESS (0.031s)
[600.108733] Starting dynamic subtest: vcs1
[600.129119] Dynamic subtest vcs1: SUCCESS (0.029s)
[600.138547] Starting dynamic subtest: vecs0
[600.158833] Dynamic subtest vecs0: SUCCESS (0.029s)
[600.168497] Starting dynamic subtest: ccs0
[600.191089] Dynamic subtest ccs0: SUCCESS (0.031s)
[600.193530] Subtest thriceslice: SUCCESS (0.187s)
[602.088080] [099/134] (418s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[602.188566] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[602.193574] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[602.310380] [100/134] (418s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[602.422153] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip
[602.427346] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[602.552957] [101/134] (417s left) gem_exec_capture (pi)
[602.614139] Starting subtest: pi
[602.617047] Starting dynamic subtest: rcs0
[606.914868] Dynamic subtest rcs0: SUCCESS (4.297s)
[606.926543] Starting dynamic subtest: bcs0
[611.074522] Dynamic subtest bcs0: SUCCESS (4.157s)
[611.084501] Starting dynamic subtest: vcs0
[615.318929] Dynamic subtest vcs0: SUCCESS (4.241s)
[615.331780] Starting dynamic subtest: vcs1
[619.495396] Dynamic subtest vcs1: SUCCESS (4.170s)
[619.505497] Starting dynamic subtest: vecs0
[623.740738] Dynamic subtest vecs0: SUCCESS (4.246s)
[623.754170] Starting dynamic subtest: ccs0
[627.989807] Dynamic subtest ccs0: SUCCESS (4.246s)
[627.992685] Subtest pi: SUCCESS (25.367s)
[628.084648] [102/134] (392s left) gem_ctx_param (invalid-get-no-zeromap)
[628.201787] Starting subtest: invalid-get-no-zeromap
[628.204303] Subtest invalid-get-no-zeromap: SUCCESS (0.001s)
[628.310015] [103/134] (392s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-downscaling)
[628.423113] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-downscaling
[628.425524] Starting dynamic subtest: pipe-A-default-mode
[628.713206] Dynamic subtest pipe-A-default-mode: SKIP (0.289s)
[628.717990] Subtest flip-64bpp-ytile-to-16bpp-ytile-downscaling: SKIP (0.290s)
[629.579046] [104/134] (391s left) kms_feature_discovery (dp-mst)
[629.685260] Starting subtest: dp-mst
[629.690369] Subtest dp-mst: SKIP (0.000s)
[629.771747] [105/134] (390s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[630.059448] Starting subtest: cursor-rapid-movement-512x512
[630.064890] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[630.254861] [106/134] (390s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[630.362413] Starting subtest: addfb25-y-tiled-legacy
[630.364767] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[630.481059] [107/134] (390s left) kms_universal_plane (disable-primary-vs-flip)
[630.569085] Starting subtest: disable-primary-vs-flip
[630.570994] Starting dynamic subtest: pipe-A-eDP-1
[632.166318] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.594s)
[632.180294] Starting dynamic subtest: pipe-B-eDP-1
[634.435174] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.267s)
[634.445759] Starting dynamic subtest: pipe-C-eDP-1
[636.664741] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.229s)
[636.678239] Starting dynamic subtest: pipe-D-eDP-1
[638.854390] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.187s)
[638.857427] Subtest disable-primary-vs-flip: SUCCESS (8.284s)
[639.654265] [108/134] (381s left) gem_exec_reloc (basic-cpu-read)
[639.714338] Subtest basic-cpu-read: SKIP (0.000s)
[639.779937] [109/134] (381s left) gem_mmap_offset (ptrace)
[639.840425] Starting subtest: ptrace
[639.843128] Starting dynamic subtest: smem0-wb
[639.863359] Dynamic subtest smem0-wb: SUCCESS (0.020s)
[639.879484] Starting dynamic subtest: smem0-wc
[639.889476] Dynamic subtest smem0-wc: SUCCESS (0.025s)
[639.901393] Starting dynamic subtest: smem0-uc
[639.917509] Dynamic subtest smem0-uc: SUCCESS (0.028s)
[639.920462] Subtest ptrace: SUCCESS (0.079s)
[640.062852] [110/134] (380s left) gem_close_race (basic-threads)
[640.133420] Starting subtest: basic-threads
[641.542274] Subtest basic-threads: SUCCESS (1.408s)
[641.739810] [111/134] (379s left) syncobj_timeline (wait-all-for-submit-complex)
[641.817735] Starting subtest: wait-all-for-submit-complex
[642.030639] Subtest wait-all-for-submit-complex: SUCCESS (0.215s)
[642.120713] [112/134] (378s left) kms_addfb_basic (bad-pitch-128)
[642.171459] Starting subtest: bad-pitch-128
[642.173685] Subtest bad-pitch-128: SUCCESS (0.000s)
[642.330273] [113/134] (378s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs-cc)
[642.421648] Starting subtest: random-ccs-data-4-tiled-mtl-rc-ccs-cc
[642.423904] Starting dynamic subtest: pipe-A-eDP-1
[643.166521] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.736s)
[643.176901] Starting dynamic subtest: pipe-B-eDP-1
[644.986070] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.817s)
[644.996909] Starting dynamic subtest: pipe-C-eDP-1
[646.813212] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.827s)
[646.824240] Starting dynamic subtest: pipe-D-eDP-1
[648.659793] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.846s)
[648.661705] Subtest random-ccs-data-4-tiled-mtl-rc-ccs-cc: SUCCESS (6.231s)
[649.807823] [114/134] (371s left) prime_busy (before)
[649.874489] Starting subtest: before
[649.880857] Starting dynamic subtest: rcs0
[649.911650] Dynamic subtest rcs0: SUCCESS (0.034s)
[649.922509] Starting dynamic subtest: bcs0
[649.969634] Dynamic subtest bcs0: SUCCESS (0.057s)
[649.981399] Starting dynamic subtest: vcs0
[650.010005] Dynamic subtest vcs0: SUCCESS (0.039s)
[650.021197] Starting dynamic subtest: vcs1
[650.050193] Dynamic subtest vcs1: SUCCESS (0.039s)
[650.060103] Starting dynamic subtest: vecs0
[650.091592] Dynamic subtest vecs0: SUCCESS (0.041s)
[650.101332] Starting dynamic subtest: ccs0
[650.133407] Dynamic subtest ccs0: SUCCESS (0.041s)
[650.241862] Subtest before: SUCCESS (0.366s)
[650.321563] [115/134] (370s left) gen7_exec_parse (basic-allowed)
[650.380414] Subtest basic-allowed: SKIP (0.000s)
[650.456945] [116/134] (370s left) gem_exec_params (no-blt)
[650.515797] Starting subtest: no-blt
[650.518389] Subtest no-blt: SUCCESS (0.002s)
[650.645726] [117/134] (370s left) kms_big_fb (x-tiled-16bpp-rotate-90)
[650.759105] Starting subtest: x-tiled-16bpp-rotate-90
[650.778423] Subtest x-tiled-16bpp-rotate-90: SKIP (0.019s)
[650.943721] [118/134] (370s left) kms_async_flips (invalid-async-flip)
[651.037320] Starting subtest: invalid-async-flip
[651.416131] Starting dynamic subtest: pipe-A-eDP-1
[652.193421] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.778s)
[652.556462] Starting dynamic subtest: pipe-B-eDP-1
[653.335341] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.788s)
[653.696401] Starting dynamic subtest: pipe-C-eDP-1
[654.453714] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.765s)
[654.813613] Starting dynamic subtest: pipe-D-eDP-1
[655.596752] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.791s)
[655.599495] Subtest invalid-async-flip: SUCCESS (4.563s)
[656.757660] [119/134] (364s left) kms_frontbuffer_tracking (fbcpsr-1p-shrfb-fliptrack-mmap-gtt)
[656.865482] Starting subtest: fbcpsr-1p-shrfb-fliptrack-mmap-gtt
[656.870379] Subtest fbcpsr-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[656.981993] [120/134] (364s left) api_intel_allocator (gem-pool)
[657.041470] Starting subtest: gem-pool
[657.046875] Subtest gem-pool: SUCCESS (0.009s)
[657.200143] [121/134] (364s left) gem_exec_whisper (basic-fds-priority-all)
[657.260842] Starting subtest: basic-fds-priority-all
[681.745306] Subtest basic-fds-priority-all: SUCCESS (24.482s)
[681.931879] [122/134] (339s left) gem_fence_thrash (bo-write-verify-y)
[681.979805] Starting subtest: bo-write-verify-y
[682.009300] Subtest bo-write-verify-y: SKIP (0.027s)
[682.080726] [123/134] (339s left) gem_lmem_swapping (heavy-verify-multi-ccs)
[682.123210] Subtest heavy-verify-multi-ccs: SKIP (0.000s)
[682.183646] [124/134] (339s left) gem_render_copy (yf-tiled-to-vebox-yf-tiled)
[682.240470] Starting subtest: yf-tiled-to-vebox-yf-tiled
[682.245816] Subtest yf-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[682.448727] [125/134] (339s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[682.845233] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[683.650411] [126/134] (337s left) kms_pipe_b_c_ivb (from-pipe-c-to-b-with-3-lanes)
[683.714470] Subtest from-pipe-C-to-B-with-3-lanes: SKIP (0.000s)
[683.785690] [127/134] (337s left) gem_busy (busy)
[683.856333] Starting subtest: busy
[683.859254] Starting dynamic subtest: all-engines
[683.932077] Dynamic subtest all-engines: SUCCESS (0.079s)
[683.949552] Starting dynamic subtest: rcs0
[685.048754] Dynamic subtest rcs0: SUCCESS (1.116s)
[685.062371] Starting dynamic subtest: bcs0
[685.116390] Dynamic subtest bcs0: SUCCESS (0.062s)
[685.127471] Starting dynamic subtest: vcs0
[685.155907] Dynamic subtest vcs0: SUCCESS (0.039s)
[685.167382] Starting dynamic subtest: vcs1
[687.032500] Dynamic subtest vcs1: SUCCESS (1.874s)
[687.044554] Starting dynamic subtest: vecs0
[689.079355] Dynamic subtest vecs0: SUCCESS (2.046s)
[689.092329] Starting dynamic subtest: ccs0
[691.064489] Dynamic subtest ccs0: SUCCESS (1.984s)
[691.067427] Subtest busy: SUCCESS (7.212s)
[691.442754] [128/134] (330s left) kms_color_pipeline (plane-lut1d-lut1d)
[691.540445] Starting subtest: plane-lut1d-lut1d
[691.553376] Starting dynamic subtest: pipe-A-eDP-1
[692.353017] Dynamic subtest pipe-A-eDP-1: FAIL (0.343s)
[692.949352] Starting dynamic subtest: pipe-B-eDP-1
[693.869260] Dynamic subtest pipe-B-eDP-1: FAIL (0.313s)
[694.293323] Starting dynamic subtest: pipe-C-eDP-1
[695.266922] Dynamic subtest pipe-C-eDP-1: FAIL (0.279s)
[695.626588] Starting dynamic subtest: pipe-D-eDP-1
[696.556292] Dynamic subtest pipe-D-eDP-1: FAIL (0.279s)
[696.558289] Subtest plane-lut1d-lut1d: FAIL (4.649s)
[697.013296] [129/134] (324s left) kms_plane_cursor (primary)
[697.106459] Starting subtest: primary
[697.111876] Starting dynamic subtest: pipe-A-eDP-1-size-64
[699.707844] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.600s)
[699.733384] Starting dynamic subtest: pipe-A-eDP-1-size-128
[702.363366] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.637s)
[702.388974] Starting dynamic subtest: pipe-A-eDP-1-size-256
[704.987234] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.605s)
[705.311629] Starting dynamic subtest: pipe-B-eDP-1-size-64
[708.675745] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.377s)
[708.702330] Starting dynamic subtest: pipe-B-eDP-1-size-128
[711.266663] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.572s)
[711.293058] Starting dynamic subtest: pipe-B-eDP-1-size-256
[713.824029] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.538s)
[714.139507] Starting dynamic subtest: pipe-C-eDP-1-size-64
[717.069609] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.943s)
[717.099469] Starting dynamic subtest: pipe-C-eDP-1-size-128
[719.280807] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.191s)
[719.307541] Starting dynamic subtest: pipe-C-eDP-1-size-256
[721.526053] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.225s)
[721.849505] Starting dynamic subtest: pipe-D-eDP-1-size-64
[724.818130] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.982s)
[724.845822] Starting dynamic subtest: pipe-D-eDP-1-size-128
[727.051336] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.213s)
[727.080463] Starting dynamic subtest: pipe-D-eDP-1-size-256
[729.271804] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.202s)
[729.585492] Subtest primary: SUCCESS (32.481s)
[730.440944] [130/134] (291s left) gem_tiled_swapping (non-threaded)
[730.497245] Subtest non-threaded: SKIP (0.000s)
[730.563863] [131/134] (291s left) syncobj_wait (invalid-signal-zero-handles)
[730.619915] Starting subtest: invalid-signal-zero-handles
[730.622383] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[730.737135] [132/134] (291s left) kms_joiner (basic-force-ultra-joiner)
[730.843065] Starting subtest: basic-force-ultra-joiner
[730.848241] Subtest basic-force-ultra-joiner: SKIP (0.000s)
[730.933723] [133/134] (290s left) kms_psr (fbc-psr2-sprite-blt)
[731.039172] Starting subtest: fbc-psr2-sprite-blt
[731.041299] Starting dynamic subtest: eDP-1
[731.046025] Dynamic subtest eDP-1: SKIP (0.000s)
[731.050753] Subtest fbc-psr2-sprite-blt: SKIP (0.001s)
[731.123817] [134/134] (290s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc)
[731.229764] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc
[731.234708] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[731.363385] 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.