[61.601951] Initializing watchdogs
[61.602010]   /dev/watchdog0
[61.613122] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:4c8a Intel Rocketlake (Gen12) RocketLake-S GT1 [UHD Graphics 750]
[61.617336] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[61.619267] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[61.620858] [001/131] (960s left) gem_softpin (evict-active)
[61.718432] Starting subtest: evict-active
[61.723048] Subtest evict-active: SUCCESS (0.005s)
[61.893719] [002/131] (960s left) gem_userptr_blits (set-cache-level)
[61.926691] Starting subtest: set-cache-level
[61.927914] Subtest set-cache-level: SUCCESS (0.000s)
[62.079220] [003/131] (960s left) kms_big_fb (yf-tiled-16bpp-rotate-270)
[62.187045] Starting subtest: yf-tiled-16bpp-rotate-270
[62.188323] Subtest yf-tiled-16bpp-rotate-270: SKIP (0.000s)
[62.299562] [004/131] (959s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-upscaling)
[62.402065] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-upscaling
[62.403614] Starting dynamic subtest: pipe-A-valid-mode
[63.056966] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.671s)
[63.057843] Subtest flip-64bpp-xtile-to-32bpp-xtile-upscaling: SUCCESS (0.672s)
[63.231749] [005/131] (958s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs-cc)
[63.330880] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs-cc
[63.331608] Starting dynamic subtest: pipe-A-HDMI-A-2
[63.911726] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.590s)
[63.918995] Starting dynamic subtest: pipe-B-HDMI-A-2
[64.542832] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.609s)
[64.563854] Starting dynamic subtest: pipe-C-HDMI-A-2
[65.110297] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.610s)
[65.111337] Subtest random-ccs-data-y-tiled-gen12-rc-ccs-cc: SUCCESS (1.815s)
[65.279999] [006/131] (956s left) gem_exec_reloc (basic-range)
[65.311258] Subtest basic-range: SKIP (0.000s)
[65.417987] [007/131] (956s left) kms_plane_alpha_blend (coverage-vs-premult-vs-constant)
[65.516877] Starting subtest: coverage-vs-premult-vs-constant
[65.597146] Starting dynamic subtest: pipe-A-HDMI-A-2
[66.047960] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.458s)
[66.052173] Starting dynamic subtest: pipe-C-HDMI-A-2
[66.479461] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.438s)
[66.480186] Subtest coverage-vs-premult-vs-constant: SUCCESS (0.979s)
[66.658609] [008/131] (955s left) kms_vblank (query-idle)
[66.757947] Starting subtest: query-idle
[66.759485] Starting dynamic subtest: pipe-A-HDMI-A-2
[69.260524] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (2.534s)
[69.266514] Starting dynamic subtest: pipe-C-HDMI-A-2
[71.679545] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (2.440s)
[71.680229] Subtest query-idle: SUCCESS (4.977s)
[71.849170] [009/131] (950s left) gem_exec_fence (syncobj-invalid-flags)
[72.172440] Starting subtest: syncobj-invalid-flags
[72.173104] Subtest syncobj-invalid-flags: SUCCESS (0.000s)
[72.491590] [FACT gem_exec_fence (syncobj-invalid-flags)] new: kernel.kmod_is_loaded.vgem: true
[72.492945] [010/131] (949s left) kms_big_fb (4-tiled-32bpp-rotate-0)
[72.600251] Starting subtest: 4-tiled-32bpp-rotate-0
[72.601560] Subtest 4-tiled-32bpp-rotate-0: SKIP (0.000s)
[72.725890] [011/131] (949s left) gem_userptr_blits (dmabuf-sync)
[72.767355] Starting subtest: dmabuf-sync
[72.769669] Subtest dmabuf-sync: SKIP (0.002s)
[72.921976] [012/131] (949s left) syncobj_wait (invalid-signal-one-illegal-handle)
[72.951487] Starting subtest: invalid-signal-one-illegal-handle
[72.952169] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[73.045474] [013/131] (949s left) sysfs_heartbeat_interval (idempotent)
[73.076644] Starting subtest: idempotent
[73.077439] Starting dynamic subtest: vecs0
[73.078881] Dynamic subtest vecs0: SUCCESS (0.001s)
[73.083359] Starting dynamic subtest: vcs0
[73.084036] Dynamic subtest vcs0: SUCCESS (0.001s)
[73.088252] Starting dynamic subtest: bcs0
[73.088919] Dynamic subtest bcs0: SUCCESS (0.001s)
[73.093406] Starting dynamic subtest: rcs0
[73.094109] Dynamic subtest rcs0: SUCCESS (0.001s)
[73.094883] Subtest idempotent: SUCCESS (0.005s)
[73.177505] [014/131] (949s left) kms_dp_linktrain_fallback (dsc-fallback)
[73.281266] Starting subtest: dsc-fallback
[73.283390] Subtest dsc-fallback: SKIP (0.000s)
[73.386102] [015/131] (949s left) gem_workarounds (reset)
[73.424981] Starting subtest: reset
[73.432167] Subtest reset: SUCCESS (0.007s)
[73.575730] [016/131] (948s left) gem_ppgtt (flink-and-close-vma-leak)
[73.607922] Starting subtest: flink-and-close-vma-leak
[73.611401] Subtest flink-and-close-vma-leak: SUCCESS (0.003s)
[73.770450] [017/131] (948s left) gem_ctx_persistence (saturated-hostile)
[73.802838] Starting subtest: saturated-hostile
[73.803496] Starting dynamic subtest: rcs0
[74.576818] Dynamic subtest rcs0: SUCCESS (0.778s)
[74.584294] Starting dynamic subtest: bcs0
[75.364849] Dynamic subtest bcs0: SUCCESS (0.792s)
[75.372500] Starting dynamic subtest: vcs0
[76.134072] Dynamic subtest vcs0: SUCCESS (0.772s)
[76.141278] Starting dynamic subtest: vecs0
[76.914064] Dynamic subtest vecs0: SUCCESS (0.783s)
[76.915163] Subtest saturated-hostile: SUCCESS (3.126s)
[77.072364] [018/131] (945s left) kms_psr2_su (frontbuffer-xrgb8888)
[77.104143] Subtest frontbuffer-XRGB8888: SKIP (0.000s)
[77.135695] [019/131] (945s left) kms_lease (multimaster-lease)
[77.236826] Starting subtest: multimaster-lease
[77.238368] Subtest multimaster-lease: SUCCESS (0.002s)
[77.324079] [020/131] (945s left) kms_psr2_sf (fbc-psr2-overlay-primary-update-sf-dmg-area)
[77.430333] Subtest fbc-psr2-overlay-primary-update-sf-dmg-area: SKIP (0.000s)
[77.456896] [021/131] (945s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-move)
[77.562273] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-move
[77.563599] Subtest fbcpsr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[77.712753] [022/131] (944s left) api_intel_allocator (simple-allocator)
[77.746042] Starting subtest: simple-allocator
[77.746712] Starting dynamic subtest: basic
[77.747374] Dynamic subtest basic: SUCCESS (0.002s)
[77.751910] Starting dynamic subtest: parallel-one
[77.892650] Dynamic subtest parallel-one: SUCCESS (0.149s)
[77.898593] Starting dynamic subtest: print
[77.899300] Dynamic subtest print: SUCCESS (0.000s)
[77.903846] Starting dynamic subtest: reuse
[77.904523] Dynamic subtest reuse: SUCCESS (0.000s)
[77.909017] Starting dynamic subtest: reserve
[77.909672] Dynamic subtest reserve: SUCCESS (0.000s)
[77.913951] Starting dynamic subtest: fork-reopen-allocator
[77.914614] Dynamic subtest fork-reopen-allocator: SUCCESS (0.013s)
[77.915264] Subtest simple-allocator: SUCCESS (0.165s)
[78.013197] [023/131] (944s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-blt)
[78.118407] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-blt
[78.119715] Subtest fbc-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[78.249956] [024/131] (944s left) prime_vgem (basic-fence-mmap)
[78.289369] Starting subtest: basic-fence-mmap
[78.306641] Subtest basic-fence-mmap: SUCCESS (0.017s)
[78.431056] [025/131] (944s left) kms_psr (fbc-pr-cursor-plane-onoff)
[78.533449] Subtest fbc-pr-cursor-plane-onoff: SKIP (0.000s)
[78.581484] [026/131] (944s left) drm_read (short-buffer-block)
[78.721449] Starting subtest: short-buffer-block
[78.722142] Subtest short-buffer-block: SUCCESS (0.000s)
[78.875282] [027/131] (943s left) api_intel_bb (simple-bb-ctx)
[78.905133] Starting subtest: simple-bb-ctx
[78.909489] Subtest simple-bb-ctx: SUCCESS (0.004s)
[79.246359] [028/131] (943s left) kms_dirtyfb (drrs-dirtyfb-ioctl)
[79.483136] Starting subtest: drrs-dirtyfb-ioctl
[79.486635] Subtest drrs-dirtyfb-ioctl: SKIP (0.001s)
[79.837904] [029/131] (943s left) gem_partial_pwrite_pread (reads-snoop)
[79.882369] Subtest reads-snoop: SKIP (0.000s)
[80.113835] [030/131] (942s left) kms_rotation_crc (bad-pixel-format)
[80.229081] Starting subtest: bad-pixel-format
[81.792850] Subtest bad-pixel-format: SUCCESS (1.568s)
[82.026458] [031/131] (941s left) prime_vgem (basic-write)
[82.102501] Starting subtest: basic-write
[82.109436] Subtest basic-write: SKIP (0.007s)
[82.262421] [032/131] (940s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs)
[82.367950] Starting subtest: crc-sprite-planes-basic-4-tiled-bmg-ccs
[82.369286] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[82.534832] [033/131] (940s left) kms_atomic_interruptible (atomic-setmode)
[82.641543] Starting subtest: atomic-setmode
[82.642293] Starting dynamic subtest: pipe-A-HDMI-A-2
[88.799815] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (6.165s)
[88.800636] Subtest atomic-setmode: SUCCESS (6.166s)
[88.961727] [034/131] (934s left) prime_vgem (wait)
[89.040086] Starting subtest: wait
[89.041035] Starting dynamic subtest: rcs0
[89.087238] Dynamic subtest rcs0: SUCCESS (0.048s)
[89.102542] Starting dynamic subtest: bcs0
[89.136086] Dynamic subtest bcs0: SUCCESS (0.048s)
[89.151732] Starting dynamic subtest: vcs0
[89.155650] Dynamic subtest vcs0: SUCCESS (0.019s)
[89.162900] Starting dynamic subtest: vecs0
[89.177557] Dynamic subtest vecs0: SUCCESS (0.022s)
[89.178613] Subtest wait: SUCCESS (0.139s)
[89.343296] [035/131] (933s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-pgflip-blt)
[89.450483] Starting subtest: fbcpsr-2p-primscrn-indfb-pgflip-blt
[89.451763] Subtest fbcpsr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[89.609314] [036/131] (933s left) syncobj_timeline (multi-wait-available-unsubmitted-submitted-signaled)
[89.641451] Starting subtest: multi-wait-available-unsubmitted-submitted-signaled
[89.642127] Subtest multi-wait-available-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[89.739112] [037/131] (933s left) gem_exec_balancer (parallel)
[89.893803] Subtest parallel: SKIP (0.000s)
[90.000783] [038/131] (933s left) syncobj_timeline (multi-wait-all-for-submit-signaled)
[90.031670] Starting subtest: multi-wait-all-for-submit-signaled
[90.032348] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.001s)
[90.137457] [039/131] (933s left) gem_lmem_swapping (heavy-verify-multi)
[90.171871] Subtest heavy-verify-multi: SKIP (0.000s)
[90.206132] [040/131] (933s left) gem_exec_whisper (basic-queues-all)
[90.243968] Starting subtest: basic-queues-all
[91.233316] Subtest basic-queues-all: SUCCESS (0.988s)
[91.447112] [041/131] (931s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling)
[91.548016] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling
[91.548758] Starting dynamic subtest: pipe-A-valid-mode
[92.393451] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.844s)
[92.394187] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-downscaling: SUCCESS (0.845s)
[92.598811] [042/131] (930s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[92.700375] Starting subtest: cursor-rapid-movement-32x10
[92.731116] Subtest cursor-rapid-movement-32x10: SKIP (0.029s)
[92.892142] [043/131] (930s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs)
[92.996463] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs
[92.998573] Starting dynamic subtest: pipe-A-HDMI-A-2
[93.006049] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.000s)
[93.010905] Starting dynamic subtest: pipe-B-HDMI-A-2
[93.017394] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.000s)
[93.022064] Starting dynamic subtest: pipe-C-HDMI-A-2
[93.028541] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.000s)
[93.029851] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs: SKIP (0.005s)
[93.222560] [044/131] (930s left) i915_suspend (basic-s3-without-i915)
[93.252557] Starting subtest: basic-s3-without-i915
[115.330300] Subtest basic-s3-without-i915: SUCCESS (5.594s)
[119.397460] [045/131] (924s left) kms_invalid_mode (int-max-clock)
[119.503046] Starting subtest: int-max-clock
[119.503724] Starting dynamic subtest: pipe-A-HDMI-A-2
[119.540063] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.036s)
[119.545578] Starting dynamic subtest: pipe-B-HDMI-A-2
[119.546264] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.000s)
[119.551695] Starting dynamic subtest: pipe-C-HDMI-A-2
[119.552385] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.000s)
[119.553066] Subtest int-max-clock: SUCCESS (0.040s)
[119.700902] [046/131] (924s left) syncobj_wait (invalid-reset-bad-pad)
[119.732354] Starting subtest: invalid-reset-bad-pad
[119.733097] Subtest invalid-reset-bad-pad: SUCCESS (0.000s)
[119.835076] [047/131] (924s left) drm_read (fault-buffer)
[119.981044] Starting subtest: fault-buffer
[119.981795] Subtest fault-buffer: SUCCESS (0.000s)
[120.158044] [048/131] (924s left) gem_ctx_isolation (clean)
[120.197821] Starting subtest: clean
[120.198525] Starting dynamic subtest: rcs0
[120.248672] Dynamic subtest rcs0: SUCCESS (0.049s)
[120.255201] Starting dynamic subtest: bcs0
[120.334755] Dynamic subtest bcs0: SUCCESS (0.083s)
[120.340914] Starting dynamic subtest: vcs0
[120.454620] Dynamic subtest vcs0: SUCCESS (0.116s)
[120.460512] Starting dynamic subtest: vecs0
[120.585191] Dynamic subtest vecs0: SUCCESS (0.127s)
[120.585897] Subtest clean: SUCCESS (0.376s)
[120.796378] [049/131] (923s left) gem_mmap_offset (bad-flags)
[120.828759] Starting subtest: bad-flags
[120.829465] Subtest bad-flags: SUCCESS (0.000s)
[120.970703] [050/131] (923s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-rotation)
[121.075431] Starting subtest: plane-scaler-with-clipping-clamping-rotation
[121.076197] Starting dynamic subtest: pipe-A
[121.500826] Dynamic subtest pipe-A: SKIP (0.412s)
[121.506618] Starting dynamic subtest: pipe-B
[121.908237] Dynamic subtest pipe-B: SKIP (0.398s)
[121.914114] Starting dynamic subtest: pipe-C
[122.338579] Dynamic subtest pipe-C: SKIP (0.420s)
[122.340139] Subtest plane-scaler-with-clipping-clamping-rotation: SKIP (1.232s)
[122.494145] [051/131] (921s left) gem_exec_schedule (noreorder-corked)
[122.652375] Starting subtest: noreorder-corked
[122.653097] Starting dynamic subtest: rcs0
[123.809722] Dynamic subtest rcs0: SUCCESS (1.138s)
[123.821821] Starting dynamic subtest: bcs0
[124.987813] Dynamic subtest bcs0: SUCCESS (1.157s)
[124.997719] Starting dynamic subtest: vcs0
[126.155871] Dynamic subtest vcs0: SUCCESS (1.150s)
[126.167971] Starting dynamic subtest: vecs0
[127.326735] Dynamic subtest vecs0: SUCCESS (1.155s)
[127.327906] Subtest noreorder-corked: SUCCESS (4.605s)
[127.530583] [052/131] (916s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[127.562458] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[127.563133] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[127.653583] [053/131] (916s left) kms_psr (fbc-psr2-primary-mmap-cpu)
[127.757949] Subtest fbc-psr2-primary-mmap-cpu: SKIP (0.000s)
[127.791829] [054/131] (916s left) kms_psr (psr-cursor-plane-move)
[127.896147] Subtest psr-cursor-plane-move: SKIP (0.000s)
[127.955678] [055/131] (916s left) i915_hangman (detector)
[127.992765] Starting subtest: detector
[127.993458] Starting dynamic subtest: rcs0
[137.563058] Dynamic subtest rcs0: SUCCESS (9.510s)
[137.575808] Starting dynamic subtest: bcs0
[147.530029] Dynamic subtest bcs0: SUCCESS (9.945s)
[147.542548] Starting dynamic subtest: vcs0
[157.509212] Dynamic subtest vcs0: SUCCESS (9.974s)
[157.521755] Starting dynamic subtest: vecs0
[167.568030] Dynamic subtest vecs0: SUCCESS (10.055s)
[167.569305] Subtest detector: SUCCESS (39.490s)
[167.666820] [056/131] (877s left) perf (gen12-group-concurrent-oa-buffer-read)
[167.763612] Starting subtest: gen12-group-concurrent-oa-buffer-read
[177.794005] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.027s)
[177.823684] [057/131] (866s left) gem_pxp (hw-rejects-pxp-context)
[177.938032] Starting subtest: hw-rejects-pxp-context
[177.940869] Subtest hw-rejects-pxp-context: SKIP (0.000s)
[178.046001] [058/131] (866s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-move)
[178.150066] Starting subtest: fbc-2p-scndscrn-cur-indfb-move
[178.151411] Subtest fbc-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[178.277960] [059/131] (866s left) drm_fdinfo (idle)
[178.309077] Starting subtest: idle
[178.309769] Starting dynamic subtest: rcs0
[178.813347] Dynamic subtest rcs0: SUCCESS (0.503s)
[178.823091] Starting dynamic subtest: bcs0
[179.317809] Dynamic subtest bcs0: SUCCESS (0.503s)
[179.327423] Starting dynamic subtest: vcs0
[179.822151] Dynamic subtest vcs0: SUCCESS (0.503s)
[179.831434] Starting dynamic subtest: vecs0
[180.326591] Dynamic subtest vecs0: SUCCESS (0.503s)
[180.327739] Subtest idle: SUCCESS (2.017s)
[180.420603] [060/131] (864s left) prime_mmap (test_errors)
[180.450851] Starting subtest: test_errors
[180.451526] Starting dynamic subtest: test_errors-smem
[180.587528] Dynamic subtest test_errors-smem: SUCCESS (0.136s)
[180.588215] Subtest test_errors: SUCCESS (0.137s)
[180.723973] [061/131] (864s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[180.824834] Starting subtest: basic-flip-after-cursor-legacy
[181.862176] Subtest basic-flip-after-cursor-legacy: SUCCESS (1.036s)
[182.029456] [062/131] (862s left) kms_pm_rpm (legacy-planes-dpms)
[183.453518] Starting subtest: legacy-planes-dpms
[183.454607] Starting dynamic subtest: plane-41
[184.725621] Dynamic subtest plane-41: SUCCESS (1.273s)
[184.737962] Starting dynamic subtest: plane-50
[186.094306] Dynamic subtest plane-50: SUCCESS (1.366s)
[186.113539] Starting dynamic subtest: plane-59
[187.450493] Dynamic subtest plane-59: SUCCESS (1.354s)
[187.463503] Starting dynamic subtest: plane-68
[188.811334] Dynamic subtest plane-68: SUCCESS (1.359s)
[188.812554] Subtest legacy-planes-dpms: SUCCESS (5.358s)
[189.008969] [063/131] (855s left) kms_psr (pr-primary-page-flip)
[189.112956] Subtest pr-primary-page-flip: SKIP (0.000s)
[189.171177] [064/131] (855s left) gem_busy (busy)
[189.210591] Starting subtest: busy
[189.211314] Starting dynamic subtest: all-engines
[189.237560] Dynamic subtest all-engines: SUCCESS (0.027s)
[189.244413] Starting dynamic subtest: rcs0
[189.306511] Dynamic subtest rcs0: SUCCESS (0.068s)
[189.326549] Starting dynamic subtest: bcs0
[189.327295] Dynamic subtest bcs0: SUCCESS (0.008s)
[189.333545] Starting dynamic subtest: vcs0
[189.366957] Dynamic subtest vcs0: SUCCESS (0.047s)
[189.381948] Starting dynamic subtest: vecs0
[189.389755] Dynamic subtest vecs0: SUCCESS (0.022s)
[189.390514] Subtest busy: SUCCESS (0.178s)
[189.767577] [065/131] (855s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[189.875646] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[189.877044] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[190.001747] [066/131] (855s left) sysfs_defaults (readonly)
[190.034836] Starting subtest: readonly
[190.035507] Starting dynamic subtest: vecs0
[190.036180] Dynamic subtest vecs0: SUCCESS (0.000s)
[190.042343] Starting dynamic subtest: vcs0
[190.043007] Dynamic subtest vcs0: SUCCESS (0.000s)
[190.049090] Starting dynamic subtest: bcs0
[190.049742] Dynamic subtest bcs0: SUCCESS (0.000s)
[190.055859] Starting dynamic subtest: rcs0
[190.056524] Dynamic subtest rcs0: SUCCESS (0.000s)
[190.057169] Subtest readonly: SUCCESS (0.003s)
[190.133019] [067/131] (854s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[190.238733] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-gtt
[190.240071] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[190.365417] [068/131] (854s left) syncobj_wait (multi-wait-all-submitted)
[190.397311] Starting subtest: multi-wait-all-submitted
[190.498912] Subtest multi-wait-all-submitted: SUCCESS (0.101s)
[190.621615] [069/131] (854s left) gem_softpin (noreloc-s3)
[190.657916] Starting subtest: noreloc-S3
[207.108201] Subtest noreloc-S3: SUCCESS (16.444s)
[215.275915] [070/131] (837s left) i915_query (query-topology-matches-eu-total)
[215.307949] Starting subtest: query-topology-matches-eu-total
[215.308629] Subtest query-topology-matches-eu-total: SUCCESS (0.000s)
[215.406768] [071/131] (837s left) gem_ctx_persistence (engines-mixed-process)
[215.439488] Starting subtest: engines-mixed-process
[215.440183] Starting dynamic subtest: rcs0
[215.808197] Dynamic subtest rcs0: SUCCESS (0.368s)
[215.827367] Starting dynamic subtest: bcs0
[216.219370] Dynamic subtest bcs0: SUCCESS (0.409s)
[216.232810] Starting dynamic subtest: vcs0
[216.568393] Dynamic subtest vcs0: SUCCESS (0.347s)
[216.586430] Starting dynamic subtest: vecs0
[216.959297] Dynamic subtest vecs0: SUCCESS (0.389s)
[216.960660] Subtest engines-mixed-process: SUCCESS (1.520s)
[217.062401] [072/131] (836s left) syncobj_basic (create-signaled)
[217.093243] Starting subtest: create-signaled
[217.093926] Subtest create-signaled: SUCCESS (0.000s)
[217.183504] [073/131] (836s left) gem_ctx_param (basic)
[217.214698] Starting subtest: basic
[217.215408] Subtest basic: SUCCESS (0.000s)
[217.300819] [074/131] (836s left) gem_exec_reloc (basic-cpu-wc-active)
[217.334890] Subtest basic-cpu-wc-active: SKIP (0.000s)
[217.424247] [075/131] (836s left) i915_pm_rps (min-max-config-idle)
[217.484637] Starting subtest: min-max-config-idle
[217.663145] Subtest min-max-config-idle: SUCCESS (0.179s)
[217.822500] [076/131] (835s left) fbdev (info)
[217.850780] Starting subtest: info
[217.851462] Subtest info: SUCCESS (0.000s)
[217.952470] [077/131] (835s left) perf_pmu (idle-no-semaphores)
[217.983529] Starting subtest: idle-no-semaphores
[217.984204] Starting dynamic subtest: rcs0
[218.525547] Dynamic subtest rcs0: SUCCESS (0.541s)
[218.537066] Starting dynamic subtest: bcs0
[219.042549] Dynamic subtest bcs0: SUCCESS (0.515s)
[219.055496] Starting dynamic subtest: vcs0
[219.576198] Dynamic subtest vcs0: SUCCESS (0.532s)
[219.589419] Starting dynamic subtest: vecs0
[220.110170] Dynamic subtest vecs0: SUCCESS (0.532s)
[220.111335] Subtest idle-no-semaphores: SUCCESS (2.127s)
[220.203662] [078/131] (833s left) kms_cursor_legacy (cursorb-vs-flipa-varying-size)
[220.306921] Starting subtest: cursorB-vs-flipA-varying-size
[220.309255] Subtest cursorB-vs-flipA-varying-size: SKIP (0.002s)
[220.392789] [079/131] (833s left) kms_ccs (bad-pixel-format-y-tiled-ccs)
[220.496745] Starting subtest: bad-pixel-format-y-tiled-ccs
[220.498533] Starting dynamic subtest: pipe-A-HDMI-A-2
[220.505058] Dynamic subtest pipe-A-HDMI-A-2: SKIP (0.000s)
[220.512259] Starting dynamic subtest: pipe-B-HDMI-A-2
[220.518742] Dynamic subtest pipe-B-HDMI-A-2: SKIP (0.000s)
[220.525656] Starting dynamic subtest: pipe-C-HDMI-A-2
[220.531935] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.000s)
[220.533207] Subtest bad-pixel-format-y-tiled-ccs: SKIP (0.004s)
[220.740888] [080/131] (832s left) gem_wait (write-busy)
[220.783714] Starting subtest: write-busy
[220.784426] Starting dynamic subtest: all-engines
[221.307139] Dynamic subtest all-engines: SUCCESS (0.523s)
[221.314597] Starting dynamic subtest: rcs0
[221.825216] Dynamic subtest rcs0: SUCCESS (0.518s)
[221.832425] Starting dynamic subtest: bcs0
[222.352323] Dynamic subtest bcs0: SUCCESS (0.526s)
[222.361841] Starting dynamic subtest: vcs0
[222.876143] Dynamic subtest vcs0: SUCCESS (0.523s)
[222.884201] Starting dynamic subtest: vecs0
[223.401173] Dynamic subtest vecs0: SUCCESS (0.524s)
[223.401948] Subtest write-busy: SUCCESS (2.618s)
[223.626552] [081/131] (830s left) gem_pxp (verify-pxp-execution-after-suspend-resume)
[223.712809] Starting subtest: verify-pxp-execution-after-suspend-resume
[230.074326] Subtest verify-pxp-execution-after-suspend-resume: SUCCESS (6.363s)
[238.257230] [082/131] (823s left) kms_rmfb (close-fd)
[238.360462] Starting subtest: close-fd
[238.361248] Starting dynamic subtest: pipe-A-HDMI-A-2
[238.530774] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (0.168s)
[238.543031] Starting dynamic subtest: pipe-B-HDMI-A-2
[238.742255] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.209s)
[238.750894] Starting dynamic subtest: pipe-C-HDMI-A-2
[238.934591] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.192s)
[238.935322] Subtest close-fd: SUCCESS (0.574s)
[239.134331] [083/131] (822s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180)
[239.243149] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180
[239.244486] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[239.390809] [084/131] (822s left) gem_exec_store (dword)
[239.428476] Starting subtest: dword
[239.429226] Starting dynamic subtest: rcs0
[239.501057] Dynamic subtest rcs0: SUCCESS (0.072s)
[239.525856] Starting dynamic subtest: bcs0
[239.526638] Dynamic subtest bcs0: SUCCESS (0.024s)
[239.534299] Starting dynamic subtest: vcs0
[239.552695] Dynamic subtest vcs0: SUCCESS (0.025s)
[239.567942] Starting dynamic subtest: vecs0
[239.583700] Dynamic subtest vecs0: SUCCESS (0.030s)
[239.584916] Subtest dword: SUCCESS (0.156s)
[239.789285] [085/131] (822s left) kms_frontbuffer_tracking (fbc-tiling-y)
[239.895508] Starting subtest: fbc-tiling-y
[242.468267] Subtest fbc-tiling-y: SUCCESS (2.573s)
[242.663534] [086/131] (819s left) syncobj_eventfd (timeline-wait-signaled)
[242.694937] Starting subtest: timeline-wait-signaled
[242.695729] Subtest timeline-wait-signaled: SUCCESS (0.000s)
[242.796817] [087/131] (819s left) kms_color (invalid-degamma-lut-sizes)
[242.899508] Starting subtest: invalid-degamma-lut-sizes
[242.900237] Starting dynamic subtest: pipe-A
[242.953538] Dynamic subtest pipe-A: SUCCESS (0.053s)
[242.962328] Starting dynamic subtest: pipe-B
[242.963030] Dynamic subtest pipe-B: SUCCESS (0.001s)
[242.969957] Starting dynamic subtest: pipe-C
[242.970655] Dynamic subtest pipe-C: SUCCESS (0.001s)
[242.971337] Subtest invalid-degamma-lut-sizes: SUCCESS (0.057s)
[243.081917] [088/131] (818s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-render)
[243.190123] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-render
[245.726667] Subtest fbc-1p-primscrn-spr-indfb-draw-render: SUCCESS (2.537s)
[245.951322] [089/131] (816s left) gem_exec_params (invalid-flag)
[245.985263] Starting subtest: invalid-flag
[245.986052] Subtest invalid-flag: SUCCESS (0.000s)
[246.090883] [090/131] (815s left) prime_mmap (test_map_unmap)
[246.122611] Starting subtest: test_map_unmap
[246.123298] Starting dynamic subtest: test_map_unmap-smem
[246.170296] Dynamic subtest test_map_unmap-smem: SUCCESS (0.048s)
[246.171010] Subtest test_map_unmap: SUCCESS (0.049s)
[246.311934] [091/131] (815s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[246.420425] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[246.846362] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.425s)
[247.069741] [092/131] (815s left) kms_async_flips (alternate-sync-async-flip-atomic)
[247.171671] Starting subtest: alternate-sync-async-flip-atomic
[247.364715] Starting dynamic subtest: pipe-A-HDMI-A-2
[249.451615] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (2.086s)
[249.630824] Starting dynamic subtest: pipe-B-HDMI-A-2
[251.685479] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (2.060s)
[251.831156] Starting dynamic subtest: pipe-C-HDMI-A-2
[253.891040] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (2.065s)
[253.892294] Subtest alternate-sync-async-flip-atomic: SUCCESS (6.718s)
[254.147926] [093/131] (808s left) kms_dsc (dsc-with-output-formats-with-bpc)
[254.253889] Starting subtest: dsc-with-output-formats-with-bpc
[254.266955] Subtest dsc-with-output-formats-with-bpc: SKIP (0.001s)
[254.366528] [094/131] (807s left) kms_pm_backlight (fade)
[254.470961] Subtest fade: SKIP (0.000s)
[254.511733] [095/131] (807s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc)
[254.613577] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc
[254.615319] Starting dynamic subtest: pipe-A-HDMI-A-2
[255.873671] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (1.255s)
[255.885517] Starting dynamic subtest: pipe-B-HDMI-A-2
[256.598450] Dynamic subtest pipe-B-HDMI-A-2: SUCCESS (0.721s)
[256.607505] Starting dynamic subtest: pipe-C-HDMI-A-2
[257.324538] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.722s)
[257.325384] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SUCCESS (2.708s)
[257.517902] [096/131] (804s left) gem_eio (suspend)
[257.555186] Starting subtest: suspend
[268.962913] Subtest suspend: SUCCESS (11.405s)
[277.121736] [097/131] (793s left) kms_rotation_crc (multiplane-rotation-cropping-bottom)
[277.225641] Starting subtest: multiplane-rotation-cropping-bottom
[299.088388] Subtest multiplane-rotation-cropping-bottom: SUCCESS (21.856s)
[299.263156] [098/131] (771s left) gem_tiled_partial_pwrite_pread (writes)
[299.298162] Subtest writes: SKIP (0.000s)
[299.393773] [099/131] (771s left) kms_cursor_legacy (2x-long-cursor-vs-flip-atomic)
[299.498736] Starting subtest: 2x-long-cursor-vs-flip-atomic
[299.501122] Subtest 2x-long-cursor-vs-flip-atomic: SKIP (0.001s)
[299.592738] [100/131] (770s left) kms_vblank (wait-busy-hang)
[299.694546] Starting subtest: wait-busy-hang
[299.696288] Starting dynamic subtest: pipe-A-HDMI-A-2
[326.392843] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (26.687s)
[326.406300] Starting dynamic subtest: pipe-C-HDMI-A-2
[340.192387] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (13.790s)
[340.193100] Subtest wait-busy-hang: SUCCESS (40.484s)
[340.398449] [101/131] (730s left) gem_exec_capture (capture-invisible)
[340.434497] Starting subtest: capture-invisible
[340.435241] Starting dynamic subtest: smem0
[340.436590] Dynamic subtest smem0: SKIP (0.000s)
[340.437911] Subtest capture-invisible: SKIP (0.001s)
[340.559196] [102/131] (729s left) kms_cursor_crc (cursor-onscreen-64x21)
[340.665271] Starting subtest: cursor-onscreen-64x21
[340.668112] Starting dynamic subtest: pipe-A-HDMI-A-2
[343.203707] Dynamic subtest pipe-A-HDMI-A-2: SUCCESS (2.534s)
[343.233426] Starting dynamic subtest: pipe-C-HDMI-A-2
[345.630228] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (2.402s)
[345.630926] Subtest cursor-onscreen-64x21: SUCCESS (4.964s)
[345.790994] [103/131] (724s left) gem_exec_schedule (semaphore-power)
[345.953558] Starting subtest: semaphore-power
[345.957568] Subtest semaphore-power: SKIP (0.004s)
[346.178864] [104/131] (724s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-gtt)
[346.284161] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-gtt
[346.285487] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[346.425778] [105/131] (724s left) kms_frontbuffer_tracking (psr-rgb565-draw-blt)
[346.531435] Starting subtest: psr-rgb565-draw-blt
[346.532785] Subtest psr-rgb565-draw-blt: SKIP (0.000s)
[346.674492] [106/131] (724s left) gem_ctx_shared (single-timeline)
[346.712689] Starting subtest: single-timeline
[346.717707] Subtest single-timeline: SUCCESS (0.004s)
[346.938814] [107/131] (723s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move)
[347.043223] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move
[347.044579] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[347.166165] [108/131] (723s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-shrfb-draw-mmap-gtt)
[347.272262] Starting subtest: psr-1p-offscren-pri-shrfb-draw-mmap-gtt
[347.273638] Subtest psr-1p-offscren-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[347.384030] [109/131] (723s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[347.489133] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[347.490485] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[347.623982] [110/131] (723s left) kms_chamelium_edid (hdmi-edid-stress-resolution-non-4k)
[347.766190] Subtest hdmi-edid-stress-resolution-non-4k: SKIP (0.000s)
[347.836605] [111/131] (723s left) kms_big_fb (y-tiled-8bpp-rotate-0)
[347.943467] Starting subtest: y-tiled-8bpp-rotate-0
[349.422829] Subtest y-tiled-8bpp-rotate-0: SUCCESS (1.478s)
[349.599302] [112/131] (721s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt)
[349.707098] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt
[349.708435] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[349.864800] [113/131] (721s left) kms_cursor_crc (cursor-offscreen-512x170)
[349.971468] Starting subtest: cursor-offscreen-512x170
[349.972857] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[350.104581] [114/131] (720s left) gem_eio (in-flight-suspend)
[350.142716] Starting subtest: in-flight-suspend
[387.275173] Subtest in-flight-suspend: SUCCESS (37.120s)
[394.460252] [115/131] (683s left) kms_chamelium_hpd (dp-hpd)
[394.597660] Subtest dp-hpd: SKIP (0.000s)
[394.668483] [116/131] (683s left) gem_userptr_blits (coherency-sync)
[394.709838] Starting subtest: coherency-sync
[395.125059] Subtest coherency-sync: SKIP (0.403s)
[395.302021] [117/131] (682s left) kms_big_fb (x-tiled-64bpp-rotate-180)
[395.457364] Starting subtest: x-tiled-64bpp-rotate-180
[398.056257] Subtest x-tiled-64bpp-rotate-180: SUCCESS (2.597s)
[398.275337] [118/131] (679s left) gem_render_copy (y-tiled-to-vebox-y-tiled)
[398.312055] Starting subtest: y-tiled-to-vebox-y-tiled
[398.313017] Starting dynamic subtest: smem
[398.413536] Dynamic subtest smem: SUCCESS (0.101s)
[398.414339] Subtest y-tiled-to-vebox-y-tiled: SUCCESS (0.102s)
[398.597894] [119/131] (679s left) api_intel_allocator (fork-simple-stress)
[398.629478] Starting subtest: fork-simple-stress
[404.041551] Subtest fork-simple-stress: SUCCESS (5.411s)
[404.176314] [120/131] (674s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[404.288079] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[404.289398] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[404.407620] [121/131] (673s left) kms_busy (basic-hang)
[404.515590] Starting subtest: basic-hang
[404.517715] Starting dynamic subtest: flip-pipe-A
[404.986105] Dynamic subtest flip-pipe-A: SUCCESS (0.469s)
[404.995830] Starting dynamic subtest: modeset-pipe-A
[405.560437] Dynamic subtest modeset-pipe-A: SUCCESS (0.572s)
[405.571054] Starting dynamic subtest: flip-pipe-C
[405.985770] Dynamic subtest flip-pipe-C: SUCCESS (0.422s)
[405.996570] Starting dynamic subtest: modeset-pipe-C
[406.548353] Dynamic subtest modeset-pipe-C: SUCCESS (0.562s)
[406.549054] Subtest basic-hang: SUCCESS (2.032s)
[406.742521] [122/131] (671s left) kms_pm_rpm (system-suspend-modeset)
[408.180878] Starting subtest: system-suspend-modeset
[425.531259] Subtest system-suspend-modeset: SUCCESS (17.346s)
[433.719786] [123/131] (652s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[433.827254] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[433.828585] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[433.958749] [124/131] (652s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-wc)
[434.066111] Starting subtest: fbc-rgb565-draw-mmap-wc
[436.584124] Subtest fbc-rgb565-draw-mmap-wc: SUCCESS (2.517s)
[436.771673] [125/131] (649s left) kms_psr (pr-cursor-mmap-cpu)
[436.875016] Subtest pr-cursor-mmap-cpu: SKIP (0.000s)
[436.918675] [126/131] (649s left) gem_tiled_swapping (non-threaded)
[448.497942] Starting subtest: non-threaded
[450.379211] Subtest non-threaded: FAIL (1.857s)
[452.486830] [127/131] (634s left) gem_mmap_gtt (cpuset-big-copy)
[452.553664] Starting subtest: cpuset-big-copy
[465.422371] Subtest cpuset-big-copy: SUCCESS (12.865s)
[465.544959] [128/131] (621s left) i915_hangman (gt-engine-hang)
[465.616138] Starting subtest: gt-engine-hang
[465.616831] Starting dynamic subtest: rcs0
[466.219923] Dynamic subtest rcs0: SUCCESS (0.603s)
[466.233851] Starting dynamic subtest: bcs0
[466.815778] Dynamic subtest bcs0: SUCCESS (0.593s)
[466.831681] Starting dynamic subtest: vcs0
[467.422839] Dynamic subtest vcs0: SUCCESS (0.604s)
[467.438649] Starting dynamic subtest: vecs0
[468.019385] Dynamic subtest vecs0: SUCCESS (0.594s)
[468.020108] Subtest gt-engine-hang: SUCCESS (2.404s)
[468.105056] [129/131] (618s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-pwrite)
[468.218024] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-pwrite
[470.920065] Subtest fbc-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (2.702s)
[471.127968] [130/131] (615s left) kms_atomic_transition (plane-all-modeset-transition-internal-panels)
[471.230796] Starting subtest: plane-all-modeset-transition-internal-panels
[471.232174] Subtest plane-all-modeset-transition-internal-panels: SKIP (0.000s)
[471.334587] [131/131] (615s left) kms_plane (plane-position-hole-dpms)
[471.438501] Starting subtest: plane-position-hole-dpms
[471.764858] Starting dynamic subtest: pipe-A-plane-1
[472.228538] Dynamic subtest pipe-A-plane-1: SUCCESS (0.463s)
[472.242230] Starting dynamic subtest: pipe-A-plane-2
[472.687176] Dynamic subtest pipe-A-plane-2: SUCCESS (0.457s)
[472.697694] Starting dynamic subtest: pipe-A-plane-3
[473.143573] Dynamic subtest pipe-A-plane-3: SUCCESS (0.455s)
[473.155538] Starting dynamic subtest: pipe-A-plane-4
[473.602496] Dynamic subtest pipe-A-plane-4: SUCCESS (0.458s)
[473.615419] Starting dynamic subtest: pipe-A-plane-5
[473.616738] Dynamic subtest pipe-A-plane-5: SUCCESS (0.009s)
[473.861614] Starting dynamic subtest: pipe-B-plane-1
[474.259162] Dynamic subtest pipe-B-plane-1: SUCCESS (0.406s)
[474.268412] Starting dynamic subtest: pipe-B-plane-2
[474.666114] Dynamic subtest pipe-B-plane-2: SUCCESS (0.406s)
[474.675259] Starting dynamic subtest: pipe-B-plane-3
[475.072238] Dynamic subtest pipe-B-plane-3: SUCCESS (0.405s)
[475.081648] Starting dynamic subtest: pipe-B-plane-4
[475.478213] Dynamic subtest pipe-B-plane-4: SUCCESS (0.405s)
[475.487634] Starting dynamic subtest: pipe-B-plane-5
[475.488939] Dynamic subtest pipe-B-plane-5: SUCCESS (0.005s)
[475.489602] Subtest plane-position-hole-dpms: SUCCESS (4.044s)
[475.670973] Closing watchdogs
Done.