[84.287352] Initializing watchdogs
[84.287537]   /dev/watchdog0
[84.326274] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:3185 Intel Geminilake (Gen9) GeminiLake [UHD Graphics 600]
[84.341449] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[84.348510] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[84.360807] [001/131] (960s left) gem_ringfill (engines-basic)
[84.798677] Starting subtest: engines-basic
[84.802536] Starting dynamic subtest: rcs0
[84.819294] Dynamic subtest rcs0: SUCCESS (0.024s)
[84.839629] Starting dynamic subtest: bcs0
[84.849398] Dynamic subtest bcs0: SUCCESS (0.029s)
[84.868536] Starting dynamic subtest: vcs0
[84.877350] Dynamic subtest vcs0: SUCCESS (0.028s)
[84.896708] Starting dynamic subtest: vecs0
[84.902684] Dynamic subtest vecs0: SUCCESS (0.020s)
[84.907357] Subtest engines-basic: SUCCESS (0.103s)
[85.031386] [FACT gem_ringfill (engines-basic)] new: kernel.kmod_is_loaded.vgem: true
[85.038224] [002/131] (959s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[85.207792] Starting subtest: basic-flip-before-cursor-varying-size
[86.370650] Subtest basic-flip-before-cursor-varying-size: SUCCESS (1.149s)
[86.587922] [003/131] (958s left) sysfs_timeslice_duration (duration)
[86.704781] Starting subtest: duration
[86.708194] Starting dynamic subtest: vecs0
[86.794245] Dynamic subtest vecs0: SUCCESS (0.086s)
[86.813276] Starting dynamic subtest: vcs0
[87.382135] Dynamic subtest vcs0: SUCCESS (0.586s)
[87.402669] Starting dynamic subtest: bcs0
[87.471522] Dynamic subtest bcs0: SUCCESS (0.088s)
[87.489900] Starting dynamic subtest: rcs0
[87.563552] Dynamic subtest rcs0: SUCCESS (0.088s)
[87.567570] Subtest duration: SUCCESS (0.859s)
[87.708281] [004/131] (957s left) gem_mmap_gtt (cpuset-basic-small-copy-xy)
[87.814982] Starting subtest: cpuset-basic-small-copy-XY
[94.309071] Subtest cpuset-basic-small-copy-XY: SUCCESS (6.497s)
[94.483338] [005/131] (950s left) gem_create (hog-create)
[94.754530] Starting subtest: hog-create
[94.758204] Starting dynamic subtest: smem0
[126.984906] Dynamic subtest smem0: SUCCESS (32.244s)
[126.988661] Subtest hog-create: SUCCESS (32.245s)
[127.254094] [006/131] (918s left) gem_exec_balancer (individual)
[127.388635] Starting subtest: individual
[131.863761] Subtest individual: SUCCESS (4.476s)
[132.134986] [007/131] (913s left) kms_cursor_legacy (forked-bo)
[132.313281] Starting subtest: forked-bo
[132.316683] Starting dynamic subtest: pipe-A
[137.838398] Dynamic subtest pipe-A: SUCCESS (5.522s)
[137.859438] Starting dynamic subtest: pipe-B
[143.266110] Dynamic subtest pipe-B: SUCCESS (5.427s)
[143.390481] Starting dynamic subtest: pipe-C
[148.690634] Dynamic subtest pipe-C: SUCCESS (5.428s)
[148.714048] Starting dynamic subtest: all-pipes
[154.132639] Dynamic subtest all-pipes: SUCCESS (5.438s)
[154.136251] Subtest forked-bo: SUCCESS (21.820s)
[154.280972] [008/131] (891s left) kms_pm_dc (dc6-dpms)
[155.474053] Starting subtest: dc6-dpms
[155.484195] Subtest dc6-dpms: SKIP (0.000s)
[155.613179] [009/131] (890s left) syncobj_timeline (wait-all-for-submit-delayed-submit)
[155.729977] Starting subtest: wait-all-for-submit-delayed-submit
[155.835335] Subtest wait-all-for-submit-delayed-submit: SUCCESS (0.107s)
[155.980783] [010/131] (889s left) kms_async_flips (async-flip-with-page-flip-events-tiled-atomic)
[156.143723] Starting subtest: async-flip-with-page-flip-events-tiled-atomic
[156.441769] Starting dynamic subtest: pipe-A-HDMI-A-2-yf
[159.074656] Dynamic subtest pipe-A-HDMI-A-2-yf: SUCCESS (2.631s)
[159.099856] Starting dynamic subtest: pipe-A-HDMI-A-2-yf
[161.105860] Dynamic subtest pipe-A-HDMI-A-2-yf: SUCCESS (2.030s)
[161.129614] Starting dynamic subtest: pipe-A-HDMI-A-2-yf
[163.145104] Dynamic subtest pipe-A-HDMI-A-2-yf: SUCCESS (2.032s)
[163.166163] Starting dynamic subtest: pipe-A-HDMI-A-2-x
[165.286712] Dynamic subtest pipe-A-HDMI-A-2-x: SUCCESS (2.148s)
[165.632234] Starting dynamic subtest: pipe-B-HDMI-A-2-yf
[168.257708] Dynamic subtest pipe-B-HDMI-A-2-yf: SUCCESS (2.643s)
[168.278135] Starting dynamic subtest: pipe-B-HDMI-A-2-yf
[170.287729] Dynamic subtest pipe-B-HDMI-A-2-yf: SUCCESS (2.029s)
[170.308424] Starting dynamic subtest: pipe-B-HDMI-A-2-yf
[172.320559] Dynamic subtest pipe-B-HDMI-A-2-yf: SUCCESS (2.032s)
[172.351331] Starting dynamic subtest: pipe-B-HDMI-A-2-x
[174.438243] Dynamic subtest pipe-B-HDMI-A-2-x: SUCCESS (2.116s)
[174.753953] Starting dynamic subtest: pipe-C-HDMI-A-2-yf
[177.365107] Dynamic subtest pipe-C-HDMI-A-2-yf: SUCCESS (2.629s)
[177.386212] Starting dynamic subtest: pipe-C-HDMI-A-2-y
[179.910268] Dynamic subtest pipe-C-HDMI-A-2-y: SUCCESS (2.546s)
[179.931477] Starting dynamic subtest: pipe-C-HDMI-A-2-x
[182.062045] Dynamic subtest pipe-C-HDMI-A-2-x: SUCCESS (2.149s)
[182.065095] Subtest async-flip-with-page-flip-events-tiled-atomic: SUCCESS (25.917s)
[182.587310] [011/131] (863s left) kms_lease (possible-crtcs-filtering)
[182.764101] Starting subtest: possible-crtcs-filtering
[182.767258] Subtest possible-crtcs-filtering: SUCCESS (0.008s)
[182.964120] [012/131] (863s left) gem_userptr_blits (unsync-unmap-after-close)
[183.099102] Subtest unsync-unmap-after-close: SKIP (0.000s)
[183.296084] [013/131] (862s left) kms_cursor_legacy (flip-vs-cursor-toggle)
[183.462180] Starting subtest: flip-vs-cursor-toggle
[204.733995] Subtest flip-vs-cursor-toggle: SUCCESS (21.274s)
[204.962587] [014/131] (841s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[205.152697] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[205.159499] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s)
[205.310303] [015/131] (841s left) kms_cursor_crc (cursor-offscreen-256x256)
[205.484695] Starting subtest: cursor-offscreen-256x256
[205.493441] Starting dynamic subtest: pipe-A-HDMI-A-2
[208.073462] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (2.580s)
[208.188717] Starting dynamic subtest: pipe-C-HDMI-A-2
[210.711148] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (2.557s)
[210.714309] Subtest cursor-offscreen-256x256: SUCCESS (5.218s)
[210.958324] [016/131] (835s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-cpu)
[211.142535] Starting subtest: fbcpsr-rgb101010-draw-mmap-cpu
[211.148733] Subtest fbcpsr-rgb101010-draw-mmap-cpu: SKIP (0.000s)
[211.289207] [017/131] (835s left) i915_drm_fdinfo (all-busy-check-all)
[211.403262] Starting subtest: all-busy-check-all
[211.932677] Subtest all-busy-check-all: SUCCESS (0.529s)
[212.079408] [018/131] (834s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-render)
[212.253604] Starting subtest: psr-1p-primscrn-spr-indfb-draw-render
[212.260887] Subtest psr-1p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[212.390555] [019/131] (834s left) gem_exec_reloc (basic-write-read-active)
[212.509854] Starting subtest: basic-write-read-active
[212.646058] Subtest basic-write-read-active: SUCCESS (0.136s)
[212.855205] [020/131] (833s left) kms_cursor_crc (cursor-rapid-movement-128x42)
[213.033632] Starting subtest: cursor-rapid-movement-128x42
[213.046653] Starting dynamic subtest: pipe-A-HDMI-A-2
[213.699631] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.645s)
[213.802955] Starting dynamic subtest: pipe-C-HDMI-A-2
[214.353193] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.586s)
[214.357168] Subtest cursor-rapid-movement-128x42: SUCCESS (1.314s)
[214.642451] [021/131] (832s left) kms_pm_rpm (modeset-lpsp-stress)
[216.373684] Starting subtest: modeset-lpsp-stress
[216.502348] Subtest modeset-lpsp-stress: SKIP (0.167s)
[216.762220] [022/131] (830s left) perf (invalid-oa-metric-set-id)
[217.000966] Starting subtest: invalid-oa-metric-set-id
[217.052051] Subtest invalid-oa-metric-set-id: SUCCESS (0.047s)
[217.171229] [023/131] (830s left) kms_pipe_stress (stress-xrgb8888-ytiled)
[217.346677] Starting subtest: stress-xrgb8888-ytiled
[225.466950] Subtest stress-xrgb8888-ytiled: SUCCESS (8.122s)
[225.845308] [024/131] (821s left) kms_vrr (negative-basic)
[226.015315] Starting subtest: negative-basic
[226.026328] Subtest negative-basic: SKIP (0.000s)
[226.156313] [025/131] (821s left) kms_psr (psr2-cursor-blt)
[226.320979] Subtest psr2-cursor-blt: SKIP (0.000s)
[226.433431] [026/131] (821s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-pwrite)
[226.608290] Starting subtest: fbcpsr-rgb565-draw-pwrite
[226.614505] Subtest fbcpsr-rgb565-draw-pwrite: SKIP (0.000s)
[226.773083] [027/131] (820s left) kms_plane_scaling (planes-downscale-factor-0-5-unity-scaling)
[226.938517] Starting subtest: planes-downscale-factor-0-5-unity-scaling
[226.944101] Starting dynamic subtest: pipe-A
[227.076357] Dynamic subtest pipe-A: SUCCESS (0.140s)
[227.099945] Starting dynamic subtest: pipe-B
[227.470219] Dynamic subtest pipe-B: SUCCESS (0.392s)
[227.496215] Starting dynamic subtest: pipe-C
[227.503188] Dynamic subtest pipe-C: SUCCESS (0.028s)
[227.506788] Subtest planes-downscale-factor-0-5-unity-scaling: SUCCESS (0.562s)
[227.909521] [028/131] (819s left) gem_madvise (dontneed-before-exec)
[228.018363] Starting subtest: dontneed-before-exec
[228.026169] Subtest dontneed-before-exec: SUCCESS (0.010s)
[228.159137] [029/131] (819s left) syncobj_timeline (etime-multi-wait-for-submit-available-unsubmitted)
[228.265416] Starting subtest: etime-multi-wait-for-submit-available-unsubmitted
[228.371167] Subtest etime-multi-wait-for-submit-available-unsubmitted: SUCCESS (0.107s)
[228.514926] [030/131] (819s left) perf_pmu (most-busy-idle-check-all)
[228.629179] Starting subtest: most-busy-idle-check-all
[228.634421] Starting dynamic subtest: rcs0
[229.258854] Dynamic subtest rcs0: SUCCESS (0.625s)
[229.280905] Starting dynamic subtest: bcs0
[229.872946] Dynamic subtest bcs0: SUCCESS (0.619s)
[229.894978] Starting dynamic subtest: vcs0
[230.492230] Dynamic subtest vcs0: SUCCESS (0.618s)
[230.514766] Starting dynamic subtest: vecs0
[231.113245] Dynamic subtest vecs0: SUCCESS (0.621s)
[231.116509] Subtest most-busy-idle-check-all: SUCCESS (2.484s)
[231.259666] [031/131] (816s left) vgem_basic (debugfs)
[231.382935] Starting subtest: debugfs
[231.386826] Subtest debugfs: SUCCESS (0.003s)
[231.527923] [032/131] (816s left) kms_flip (wf_vblank-ts-check-interruptible)
[231.704612] Starting subtest: wf_vblank-ts-check-interruptible
[231.711462] Starting dynamic subtest: A-HDMI-A2
[242.601096] Dynamic subtest A-HDMI-A2: SUCCESS (10.885s)
[242.625089] Starting dynamic subtest: B-HDMI-A2
[253.421037] Dynamic subtest B-HDMI-A2: SUCCESS (10.823s)
[253.442089] Starting dynamic subtest: C-HDMI-A2
[264.264567] Dynamic subtest C-HDMI-A2: SUCCESS (10.835s)
[264.268501] Subtest wf_vblank-ts-check-interruptible: SUCCESS (32.554s)
[264.675681] [033/131] (783s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-onoff)
[264.860234] Starting subtest: fbc-2p-scndscrn-cur-indfb-onoff
[264.866231] Subtest fbc-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[265.002060] [034/131] (783s left) syncobj_wait (multi-wait-all-submitted-signaled)
[265.112536] Starting subtest: multi-wait-all-submitted-signaled
[265.220313] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.105s)
[265.383318] [035/131] (783s left) kms_dp_linktrain_fallback (dp-fallback)
[265.547823] Starting subtest: dp-fallback
[265.559797] Subtest dp-fallback: SKIP (0.000s)
[265.686505] [036/131] (782s left) kms_cursor_legacy (cursor-vs-flip-toggle)
[265.859328] Starting subtest: cursor-vs-flip-toggle
[308.768519] Subtest cursor-vs-flip-toggle: SUCCESS (42.910s)
[308.995776] [037/131] (739s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-fully-sf)
[309.179041] Subtest fbc-pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[309.287175] [038/131] (739s left) kms_cursor_crc (cursor-random-32x10)
[309.460142] Starting subtest: cursor-random-32x10
[309.570575] Subtest cursor-random-32x10: SKIP (0.104s)
[309.727465] [039/131] (739s left) perf_pmu (busy-accuracy-2)
[309.843553] Starting subtest: busy-accuracy-2
[309.846630] Starting dynamic subtest: rcs0
[312.925441] Dynamic subtest rcs0: SUCCESS (3.076s)
[312.946975] Starting dynamic subtest: bcs0
[315.999432] Dynamic subtest bcs0: SUCCESS (3.075s)
[316.021220] Starting dynamic subtest: vcs0
[319.064518] Dynamic subtest vcs0: SUCCESS (3.063s)
[319.086269] Starting dynamic subtest: vecs0
[322.138434] Dynamic subtest vecs0: SUCCESS (3.069s)
[322.142818] Subtest busy-accuracy-2: SUCCESS (12.287s)
[322.277339] [040/131] (726s left) kms_frontbuffer_tracking (fbc-1p-pri-indfb-multidraw)
[322.453823] Starting subtest: fbc-1p-pri-indfb-multidraw
[338.846573] Subtest fbc-1p-pri-indfb-multidraw: SUCCESS (16.396s)
[339.057514] [041/131] (710s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[339.247348] Starting subtest: 4-tiled-8bpp-rotate-270
[339.253779] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.000s)
[339.392125] [042/131] (709s left) kms_ccs (crc-primary-basic-yf-tiled-ccs)
[339.549841] Starting subtest: crc-primary-basic-yf-tiled-ccs
[339.553384] Starting dynamic subtest: pipe-A-HDMI-A-2
[340.009250] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.381s)
[340.031865] Starting dynamic subtest: pipe-B-HDMI-A-2
[340.416067] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.462s)
[340.455764] Starting dynamic subtest: pipe-C-HDMI-A-2
[340.486703] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.002s)
[340.489757] Subtest crc-primary-basic-yf-tiled-ccs: SUCCESS (0.855s)
[341.068977] [043/131] (708s left) gem_softpin (noreloc)
[341.194715] Starting subtest: noreloc
[346.706762] Subtest noreloc: SUCCESS (5.509s)
[346.870264] [044/131] (702s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-render)
[347.056232] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-render
[347.063339] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[347.201667] [045/131] (702s left) i915_query (query-topology-garbage-items)
[347.315406] Starting subtest: query-topology-garbage-items
[347.320061] Subtest query-topology-garbage-items: SUCCESS (0.001s)
[347.472998] [046/131] (702s left) kms_flip (flip-vs-expired-vblank-interruptible)
[347.651841] Starting subtest: flip-vs-expired-vblank-interruptible
[347.660284] Starting dynamic subtest: A-HDMI-A2
[358.113686] Dynamic subtest A-HDMI-A2: SUCCESS (10.449s)
[358.135972] Starting dynamic subtest: B-HDMI-A2
[368.478405] Dynamic subtest B-HDMI-A2: SUCCESS (10.366s)
[368.499881] Starting dynamic subtest: C-HDMI-A2
[378.879812] Dynamic subtest C-HDMI-A2: SUCCESS (10.391s)
[378.882884] Subtest flip-vs-expired-vblank-interruptible: SUCCESS (31.218s)
[379.301533] [047/131] (670s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt)
[379.489975] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt
[382.236099] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (2.744s)
[382.442925] [048/131] (667s left) gem_pxp (fail-invalid-protected-context)
[385.086332] Starting subtest: fail-invalid-protected-context
[385.093058] Subtest fail-invalid-protected-context: SKIP (0.000s)
[385.244486] [049/131] (664s left) syncobj_wait (invalid-signal-bad-pad)
[385.353030] Starting subtest: invalid-signal-bad-pad
[385.356631] Subtest invalid-signal-bad-pad: SUCCESS (0.000s)
[385.492330] [050/131] (664s left) kms_psr (fbc-psr2-cursor-plane-onoff)
[385.668392] Subtest fbc-psr2-cursor-plane-onoff: SKIP (0.000s)
[385.771873] [051/131] (664s left) prime_busy (after-wait)
[385.885987] Starting subtest: after-wait
[385.898040] Starting dynamic subtest: rcs0
[385.913550] Dynamic subtest rcs0: SUCCESS (0.011s)
[385.938142] Starting dynamic subtest: bcs0
[385.941332] Dynamic subtest bcs0: SUCCESS (0.023s)
[385.964669] Starting dynamic subtest: vcs0
[385.968579] Dynamic subtest vcs0: SUCCESS (0.016s)
[386.010184] Starting dynamic subtest: vecs0
[386.014196] Dynamic subtest vecs0: SUCCESS (0.012s)
[386.079529] Subtest after-wait: SUCCESS (0.192s)
[386.229544] [052/131] (664s left) gem_exec_schedule (preempt-queue-chain)
[386.374157] Starting subtest: preempt-queue-chain
[386.377535] Starting dynamic subtest: rcs0
[386.713351] Dynamic subtest rcs0: SUCCESS (0.333s)
[386.739513] Starting dynamic subtest: bcs0
[387.046896] Dynamic subtest bcs0: SUCCESS (0.336s)
[387.068413] Starting dynamic subtest: vcs0
[387.382801] Dynamic subtest vcs0: SUCCESS (0.336s)
[387.405072] Starting dynamic subtest: vecs0
[387.752623] Dynamic subtest vecs0: SUCCESS (0.368s)
[387.756719] Subtest preempt-queue-chain: SUCCESS (1.377s)
[388.146366] [053/131] (662s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-mc-ccs)
[388.311712] Starting subtest: ccs-on-another-bo-4-tiled-mtl-mc-ccs
[388.315692] Starting dynamic subtest: pipe-A-HDMI-A-2
[388.405393] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.000s)
[388.427147] Starting dynamic subtest: pipe-B-HDMI-A-2
[388.458204] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.000s)
[388.479727] Starting dynamic subtest: pipe-C-HDMI-A-2
[388.510425] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.001s)
[388.516767] Subtest ccs-on-another-bo-4-tiled-mtl-mc-ccs: SKIP (0.012s)
[389.006944] [054/131] (661s left) i915_pm_rpm (gem-execbuf)
[390.691985] Starting subtest: gem-execbuf
[390.695429] Starting dynamic subtest: smem0
[392.088082] Dynamic subtest smem0: SUCCESS (1.396s)
[392.110184] Subtest gem-execbuf: SUCCESS (1.398s)
[392.367137] [055/131] (658s left) gem_lmem_swapping (parallel-random)
[392.485517] Subtest parallel-random: SKIP (0.000s)
[392.604938] [056/131] (658s left) kms_psr (psr-sprite-mmap-gtt)
[392.772257] Subtest psr-sprite-mmap-gtt: SKIP (0.000s)
[392.893415] [057/131] (657s left) kms_invalid_mode (int-max-clock)
[393.081703] Starting subtest: int-max-clock
[393.084978] Starting dynamic subtest: pipe-A-HDMI-A-2
[393.272262] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.212s)
[393.295149] Starting dynamic subtest: pipe-B-HDMI-A-2
[393.299155] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.003s)
[393.322216] Starting dynamic subtest: pipe-C-HDMI-A-2
[393.325331] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.003s)
[393.328467] Subtest int-max-clock: SUCCESS (0.232s)
[393.524658] [058/131] (657s left) perf_pmu (all-busy-idle-check-all)
[393.641627] Starting subtest: all-busy-idle-check-all
[394.267194] Subtest all-busy-idle-check-all: SUCCESS (0.623s)
[394.409966] [059/131] (656s left) gem_exec_schedule (pi-distinct-iova)
[394.669065] Starting subtest: pi-distinct-iova
[394.675314] Starting dynamic subtest: rcs0
[394.732063] Dynamic subtest rcs0: SUCCESS (0.057s)
[394.755301] Starting dynamic subtest: bcs0
[394.812499] Dynamic subtest bcs0: SUCCESS (0.074s)
[394.849300] Starting dynamic subtest: vcs0
[394.860422] Dynamic subtest vcs0: SUCCESS (0.053s)
[394.882340] Starting dynamic subtest: vecs0
[394.929800] Dynamic subtest vecs0: SUCCESS (0.060s)
[394.935828] Subtest pi-distinct-iova: SUCCESS (0.258s)
[395.209763] [060/131] (655s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[395.330331] Starting subtest: x-tiled-to-vebox-y-tiled
[395.338062] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s)
[395.591573] [061/131] (655s left) kms_flip (flip-vs-dpms-on-nop)
[395.762263] Starting subtest: flip-vs-dpms-on-nop
[395.774181] Starting dynamic subtest: A-HDMI-A2
[397.167221] Dynamic subtest A-HDMI-A2: SUCCESS (1.395s)
[397.195634] Starting dynamic subtest: B-HDMI-A2
[398.506610] Dynamic subtest B-HDMI-A2: SUCCESS (1.339s)
[398.529631] Starting dynamic subtest: C-HDMI-A2
[399.864552] Dynamic subtest C-HDMI-A2: SUCCESS (1.353s)
[399.867636] Subtest flip-vs-dpms-on-nop: SUCCESS (4.103s)
[400.273540] [062/131] (651s left) gem_fenced_exec_thrash (too-many-fences)
[400.394232] Starting subtest: too-many-fences
[402.573556] Subtest too-many-fences: SUCCESS (2.163s)
[403.218097] [063/131] (648s left) gem_exec_fence (basic-wait)
[403.936512] Starting subtest: basic-wait
[403.996770] Starting dynamic subtest: rcs0
[404.124156] Dynamic subtest rcs0: SUCCESS (0.022s)
[404.146654] Starting dynamic subtest: bcs0
[404.150516] Dynamic subtest bcs0: SUCCESS (0.023s)
[404.183969] Starting dynamic subtest: vcs0
[404.188113] Dynamic subtest vcs0: SUCCESS (0.023s)
[404.212848] Starting dynamic subtest: vecs0
[404.216034] Dynamic subtest vecs0: SUCCESS (0.023s)
[404.220628] Subtest basic-wait: SUCCESS (0.096s)
[404.487230] [064/131] (647s left) gem_pread (exhaustion)
[404.596485] Starting subtest: exhaustion
[429.826255] Subtest exhaustion: SUCCESS (25.234s)
[429.974654] [065/131] (621s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[430.143969] Starting subtest: bo-too-small-due-to-tiling
[430.147533] Subtest bo-too-small-due-to-tiling: SUCCESS (0.001s)
[430.305688] [066/131] (621s left) gem_exec_balancer (full)
[430.432392] Starting subtest: full
[434.996540] Subtest full: SUCCESS (4.558s)
[435.254698] [067/131] (616s left) gem_flink_race (flink_name)
[435.362048] Starting subtest: flink_name
[440.731520] Subtest flink_name: SUCCESS (5.374s)
[440.870625] [068/131] (611s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-render)
[441.053760] Starting subtest: fbc-rgb101010-draw-render
[443.789051] Subtest fbc-rgb101010-draw-render: SUCCESS (2.745s)
[443.968679] [069/131] (608s left) kms_hdr (bpc-switch-suspend)
[444.132660] Starting subtest: bpc-switch-suspend
[457.800149] Subtest bpc-switch-suspend: SKIP (13.437s)
[458.073786] [070/131] (594s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted)
[458.198540] Starting subtest: multi-wait-for-submit-unsubmitted-submitted
[458.305916] Subtest multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.108s)
[458.469134] [071/131] (594s left) gem_exec_reloc (basic-gtt)
[458.592389] Starting subtest: basic-gtt
[458.608408] Subtest basic-gtt: SUCCESS (0.018s)
[458.825334] [072/131] (593s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[458.937396] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[458.940462] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.002s)
[459.076808] [073/131] (593s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-20x20)
[459.249963] Starting subtest: planes-downscale-factor-0-75-upscale-20x20
[459.254533] Starting dynamic subtest: pipe-A
[459.376929] Dynamic subtest pipe-A: SUCCESS (0.127s)
[459.400180] Starting dynamic subtest: pipe-B
[459.761249] Dynamic subtest pipe-B: SUCCESS (0.378s)
[459.784659] Starting dynamic subtest: pipe-C
[459.802723] Dynamic subtest pipe-C: SUCCESS (0.036s)
[459.807736] Subtest planes-downscale-factor-0-75-upscale-20x20: SUCCESS (0.549s)
[460.224101] [074/131] (592s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen)
[460.405872] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen
[460.411973] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[460.560175] [075/131] (592s left) gem_flink_race (flink_close)
[460.666486] Starting subtest: flink_close
[465.685906] Subtest flink_close: SUCCESS (5.022s)
[465.838271] [076/131] (587s left) gem_exec_whisper (basic-contexts-all)
[465.962894] Starting subtest: basic-contexts-all
[477.229105] Subtest basic-contexts-all: SUCCESS (11.260s)
[477.489818] [077/131] (575s left) gen9_exec_parse (basic-rejected)
[477.622084] Starting subtest: basic-rejected
[477.630229] Subtest basic-rejected: SUCCESS (0.005s)
[477.908539] [078/131] (575s left) gem_ctx_persistence (engines-mixed)
[478.026630] Starting subtest: engines-mixed
[478.029867] Starting dynamic subtest: rcs0
[478.081056] Dynamic subtest rcs0: SUCCESS (0.053s)
[478.102939] Starting dynamic subtest: bcs0
[478.126067] Dynamic subtest bcs0: SUCCESS (0.041s)
[478.150694] Starting dynamic subtest: vcs0
[478.162528] Dynamic subtest vcs0: SUCCESS (0.034s)
[478.194490] Starting dynamic subtest: vecs0
[478.212232] Dynamic subtest vecs0: SUCCESS (0.045s)
[478.215451] Subtest engines-mixed: SUCCESS (0.189s)
[478.387423] [079/131] (575s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[478.573741] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[478.580537] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[478.721576] [080/131] (574s left) gem_exec_params (cliprects_ptr-dirt)
[478.843171] Starting subtest: cliprects_ptr-dirt
[478.846675] Subtest cliprects_ptr-dirt: SUCCESS (0.001s)
[478.987854] [081/131] (574s left) kms_fbcon_fbt (psr-suspend)
[479.109773] Starting subtest: psr-suspend
[479.116552] Subtest psr-suspend: SKIP (0.000s)
[479.269857] [082/131] (574s left) kms_ccs (random-ccs-data-yf-tiled-ccs)
[479.445725] Starting subtest: random-ccs-data-yf-tiled-ccs
[479.448831] Starting dynamic subtest: pipe-A-HDMI-A-2
[479.728136] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.264s)
[479.749946] Starting dynamic subtest: pipe-B-HDMI-A-2
[480.230430] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.477s)
[480.269327] Starting dynamic subtest: pipe-C-HDMI-A-2
[480.305566] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.001s)
[480.308717] Subtest random-ccs-data-yf-tiled-ccs: SUCCESS (0.768s)
[480.877932] [083/131] (573s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180)
[481.068140] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180
[482.666353] Subtest y-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.596s)
[482.894967] [084/131] (571s left) gem_userptr_blits (map-fixed-invalidate-overlap-busy)
[483.038059] Starting subtest: map-fixed-invalidate-overlap-busy
[483.041021] Starting dynamic subtest: gtt
[486.804069] Dynamic subtest gtt: SUCCESS (3.768s)
[486.826857] Starting dynamic subtest: wb
[490.507051] Dynamic subtest wb: SUCCESS (3.699s)
[490.529556] Starting dynamic subtest: wc
[494.175035] Dynamic subtest wc: SUCCESS (3.666s)
[494.197223] Starting dynamic subtest: uc
[497.856087] Dynamic subtest uc: SUCCESS (3.678s)
[497.859414] Subtest map-fixed-invalidate-overlap-busy: SUCCESS (14.825s)
[498.054806] [085/131] (556s left) gem_ctx_persistence (legacy-engines-mixed-process)
[498.168507] Starting subtest: legacy-engines-mixed-process
[498.171890] Starting dynamic subtest: render
[498.579673] Dynamic subtest render: SUCCESS (0.405s)
[498.615155] Starting dynamic subtest: bsd
[498.981818] Dynamic subtest bsd: SUCCESS (0.390s)
[499.006968] Starting dynamic subtest: blt
[499.376801] Dynamic subtest blt: SUCCESS (0.395s)
[499.420241] Starting dynamic subtest: vebox
[499.769907] Dynamic subtest vebox: SUCCESS (0.384s)
[499.773088] Subtest legacy-engines-mixed-process: SUCCESS (1.604s)
[499.946808] [086/131] (554s left) perf_pmu (interrupts-sync)
[500.068320] Starting subtest: interrupts-sync
[501.189304] Subtest interrupts-sync: SUCCESS (1.118s)
[501.344800] [087/131] (552s left) kms_psr (fbc-pr-cursor-blt)
[501.520242] Subtest fbc-pr-cursor-blt: SKIP (0.000s)
[501.638739] [088/131] (552s left) kms_big_fb (y-tiled-32bpp-rotate-90)
[501.830981] Starting subtest: y-tiled-32bpp-rotate-90
[506.728411] Subtest y-tiled-32bpp-rotate-90: SUCCESS (4.899s)
[507.162402] [089/131] (547s left) kms_color (ctm-negative)
[507.361086] Starting subtest: ctm-negative
[507.365440] Starting dynamic subtest: pipe-A-HDMI-A-2
[508.071096] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.702s)
[508.119080] Starting dynamic subtest: pipe-B-HDMI-A-2
[508.732758] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.664s)
[508.757496] Starting dynamic subtest: pipe-C-HDMI-A-2
[509.425335] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.678s)
[509.429497] Subtest ctm-negative: SUCCESS (2.061s)
[509.659193] [090/131] (544s left) api_intel_bb (crc32)
[509.771096] Starting subtest: crc32
[509.777731] Subtest crc32: SKIP (0.000s)
[509.920485] [091/131] (544s left) gem_barrier_race (remote-request)
[510.049579] Starting subtest: remote-request
[510.053999] Starting dynamic subtest: rcs0
[515.133987] Dynamic subtest rcs0: SUCCESS (5.084s)
[515.138713] Subtest remote-request: SUCCESS (5.088s)
[515.289157] [092/131] (539s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-sf)
[515.475812] Subtest pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[515.580694] [093/131] (539s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180)
[515.765703] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180
[517.337282] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.571s)
[517.538695] [094/131] (537s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs)
[517.706131] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-mc-ccs
[517.709125] Starting dynamic subtest: pipe-A-HDMI-A-2
[517.918395] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.013s)
[517.941112] Starting dynamic subtest: pipe-B-HDMI-A-2
[518.139543] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.013s)
[518.163373] Starting dynamic subtest: pipe-C-HDMI-A-2
[518.297674] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.013s)
[518.305171] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SKIP (0.057s)
[518.440231] [095/131] (536s left) kms_flip (2x-flip-vs-rmfb-interruptible)
[518.617565] Starting subtest: 2x-flip-vs-rmfb-interruptible
[518.624750] Subtest 2x-flip-vs-rmfb-interruptible: SKIP (0.001s)
[518.789827] [096/131] (536s left) kms_big_fb (x-tiled-64bpp-rotate-270)
[518.971693] Starting subtest: x-tiled-64bpp-rotate-270
[519.093212] Subtest x-tiled-64bpp-rotate-270: SKIP (0.118s)
[519.258873] [097/131] (536s left) kms_addfb_basic (too-high)
[519.429779] Starting subtest: too-high
[519.433271] Subtest too-high: SUCCESS (0.002s)
[519.589269] [098/131] (535s left) syncobj_timeline (multi-wait-for-submit-available-submitted)
[519.730104] Starting subtest: multi-wait-for-submit-available-submitted
[519.734048] Subtest multi-wait-for-submit-available-submitted: SUCCESS (0.002s)
[519.870791] [099/131] (535s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-render)
[520.060903] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-render
[522.689088] Subtest fbc-1p-primscrn-pri-indfb-draw-render: SUCCESS (2.633s)
[522.898214] [100/131] (532s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-upscaling)
[523.100084] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-upscaling
[523.103227] Starting dynamic subtest: pipe-A-valid-mode
[523.319343] Dynamic subtest pipe-A-valid-mode: SKIP (0.213s)
[523.340792] Subtest flip-64bpp-yftile-to-16bpp-yftile-upscaling: SKIP (0.219s)
[523.520384] [101/131] (532s left) api_intel_allocator (fork-simple-stress-signal)
[523.631776] Starting subtest: fork-simple-stress-signal
[529.150639] Subtest fork-simple-stress-signal: SUCCESS (5.522s)
[529.303945] [102/131] (526s left) gem_close (basic)
[529.417137] Starting subtest: basic
[529.420629] Subtest basic: SUCCESS (0.000s)
[529.575755] [103/131] (526s left) kms_ccs (bad-aux-stride-y-tiled-ccs)
[529.745318] Starting subtest: bad-aux-stride-y-tiled-ccs
[529.750234] Starting dynamic subtest: pipe-A-HDMI-A-2
[529.821834] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.004s)
[529.845426] Starting dynamic subtest: pipe-B-HDMI-A-2
[529.873743] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.004s)
[529.896639] Starting dynamic subtest: pipe-C-HDMI-A-2
[529.928492] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.001s)
[529.931780] Subtest bad-aux-stride-y-tiled-ccs: SUCCESS (0.025s)
[530.466915] [104/131] (525s left) kms_psr (fbc-psr-sprite-mmap-gtt)
[530.641236] Subtest fbc-psr-sprite-mmap-gtt: SKIP (0.000s)
[530.758995] [105/131] (525s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-downscaling)
[530.927930] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-downscaling
[530.948512] Starting dynamic subtest: pipe-A-valid-mode
[531.746079] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.809s)
[531.753716] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-downscaling: SUCCESS (0.816s)
[531.994285] [106/131] (524s left) api_intel_bb (render-ccs)
[532.105287] Starting subtest: render-ccs
[532.478362] Subtest render-ccs: SUCCESS (0.362s)
[532.618275] [107/131] (523s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-pgflip-blt)
[532.811060] Starting subtest: psr-2p-scndscrn-indfb-pgflip-blt
[532.817329] Subtest psr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[532.984223] [108/131] (523s left) kms_psr (psr-primary-blt)
[533.157152] Subtest psr-primary-blt: SKIP (0.000s)
[533.283368] [109/131] (523s left) kms_plane (planar-pixel-format-settings)
[533.458609] Starting subtest: planar-pixel-format-settings
[533.525799] Subtest planar-pixel-format-settings: SUCCESS (0.067s)
[533.687354] [110/131] (523s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode)
[534.064209] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s)
[534.267518] [111/131] (522s left) gem_exec_whisper (basic-sync)
[534.392868] Starting subtest: basic-sync
[539.338630] Subtest basic-sync: SUCCESS (4.945s)
[539.606386] [112/131] (517s left) gem_exec_gttfill (multigpu-basic)
[539.854161] Starting subtest: multigpu-basic
[559.092064] Subtest multigpu-basic: SUCCESS (19.236s)
[559.223867] [113/131] (497s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc)
[559.523315] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc
[559.534733] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[559.712881] [114/131] (497s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled)
[559.854853] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[559.859984] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[560.014896] [115/131] (497s left) gem_busy (busy)
[560.162857] Starting subtest: busy
[560.165954] Starting dynamic subtest: all-engines
[560.285510] Dynamic subtest all-engines: SUCCESS (0.119s)
[560.342913] Starting dynamic subtest: rcs0
[560.346362] Dynamic subtest rcs0: SUCCESS (0.030s)
[560.381141] Starting dynamic subtest: bcs0
[560.384242] Dynamic subtest bcs0: SUCCESS (0.011s)
[560.406989] Starting dynamic subtest: vcs0
[560.410072] Dynamic subtest vcs0: SUCCESS (0.010s)
[560.432611] Starting dynamic subtest: vecs0
[560.435523] Dynamic subtest vecs0: SUCCESS (0.004s)
[560.438452] Subtest busy: SUCCESS (0.215s)
[560.770194] [116/131] (496s left) gem_exec_suspend (basic-s3)
[560.899805] Starting subtest: basic-S3
[560.903708] Starting dynamic subtest: smem