[39.306433] Initializing watchdogs
[39.306482]   /dev/watchdog0
[39.313430] [001/130] (960s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[39.509400] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu
[39.510942] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[39.584449] [002/130] (960s left) syncobj_wait (wait-any-interrupted)
[39.653050] Starting subtest: wait-any-interrupted
[39.755508] Subtest wait-any-interrupted: SUCCESS (0.102s)
[39.818448] [003/130] (960s left) gem_exec_fence (syncobj-unused-fence)
[40.272529] Starting subtest: syncobj-unused-fence
[40.295078] Subtest syncobj-unused-fence: SUCCESS (0.023s)
[40.667078] [004/130] (959s left) kms_plane_scaling (plane-downscale-factor-0-25-with-rotation)
[40.855177] Starting subtest: plane-downscale-factor-0-25-with-rotation
[40.855961] Starting dynamic subtest: pipe-A
[41.597782] Dynamic subtest pipe-A: SKIP (0.740s)
[41.602879] Starting dynamic subtest: pipe-B
[42.753589] Dynamic subtest pipe-B: SKIP (1.141s)
[42.758843] Starting dynamic subtest: pipe-C
[43.917513] Dynamic subtest pipe-C: SKIP (1.138s)
[43.922687] Starting dynamic subtest: pipe-D
[45.070422] Dynamic subtest pipe-D: SKIP (1.131s)
[45.071853] Subtest plane-downscale-factor-0-25-with-rotation: SKIP (4.152s)
[45.142501] [005/130] (954s left) gem_exec_schedule (u-semaphore-codependency)
[45.217467] Starting subtest: u-semaphore-codependency
[45.249365] Subtest u-semaphore-codependency: SUCCESS (0.031s)
[45.566112] [006/130] (954s left) gem_mmap_offset (mmap-unmap)
[45.617128] Starting subtest: mmap-unmap
[45.618059] Starting dynamic subtest: lmem0
[46.276218] Dynamic subtest lmem0: SUCCESS (0.641s)
[46.281761] Starting dynamic subtest: smem0
[47.172739] Dynamic subtest smem0: SUCCESS (0.892s)
[47.173617] Subtest mmap-unmap: SUCCESS (1.534s)
[47.306328] [007/130] (952s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc)
[47.490525] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc
[47.492583] Starting dynamic subtest: pipe-A-DP-4
[47.514289] Dynamic subtest pipe-A-DP-4: SKIP (0.001s)
[47.519646] Starting dynamic subtest: pipe-B-DP-4
[47.540584] Dynamic subtest pipe-B-DP-4: SKIP (0.001s)
[47.545847] Starting dynamic subtest: pipe-C-DP-4
[47.572347] Dynamic subtest pipe-C-DP-4: SKIP (0.001s)
[47.577706] Starting dynamic subtest: pipe-D-DP-4
[47.599680] Dynamic subtest pipe-D-DP-4: SKIP (0.001s)
[47.601143] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.009s)
[47.919491] [008/130] (952s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-indfb-draw-mmap-cpu)
[48.151124] Starting subtest: psr-1p-offscren-pri-indfb-draw-mmap-cpu
[48.152555] Subtest psr-1p-offscren-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[48.232802] [009/130] (951s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-plflip-blt)
[48.443456] Starting subtest: psr-2p-primscrn-indfb-plflip-blt
[48.445244] Subtest psr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[48.518484] [010/130] (951s left) kms_cursor_legacy (short-busy-flip-before-cursor-atomic-transitions)
[48.724910] Starting subtest: short-busy-flip-before-cursor-atomic-transitions
[48.726766] Subtest short-busy-flip-before-cursor-atomic-transitions: SKIP (0.000s)
[48.783846] [011/130] (951s left) kms_plane_scaling (planes-upscale-20x20)
[48.977913] Starting subtest: planes-upscale-20x20
[48.978768] Starting dynamic subtest: pipe-A
[49.092212] Dynamic subtest pipe-A: SUCCESS (0.112s)
[49.106701] Starting dynamic subtest: pipe-B
[49.338766] Dynamic subtest pipe-B: SUCCESS (0.243s)
[49.349699] Starting dynamic subtest: pipe-C
[49.565479] Dynamic subtest pipe-C: SUCCESS (0.224s)
[49.575049] Starting dynamic subtest: pipe-D
[49.811176] Dynamic subtest pipe-D: SUCCESS (0.242s)
[49.812228] Subtest planes-upscale-20x20: SUCCESS (0.825s)
[50.089504] [012/130] (950s left) syncobj_timeline (single-wait-for-submit-available-submitted)
[50.178939] Starting subtest: single-wait-for-submit-available-submitted
[50.179773] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.000s)
[50.270772] [013/130] (949s left) kms_big_fb (linear-8bpp-rotate-0)
[50.470208] Starting subtest: linear-8bpp-rotate-0
[51.923998] Subtest linear-8bpp-rotate-0: SUCCESS (1.442s)
[52.090848] [014/130] (948s left) kms_rotation_crc (primary-yf-tiled-reflect-x-90)
[52.302415] Starting subtest: primary-yf-tiled-reflect-x-90
[52.304258] Subtest primary-yf-tiled-reflect-x-90: SKIP (0.001s)
[52.353481] [015/130] (947s left) gem_eio (reset-stress)
[52.624207] Starting subtest: reset-stress
[93.459490] Subtest reset-stress: SUCCESS (40.782s)
[93.726556] [016/130] (906s left) perf (oa-exponents)
[94.149879] Starting subtest: oa-exponents
[94.150722] Starting dynamic subtest: 0-rcs0
[96.344849] Dynamic subtest 0-rcs0: SUCCESS (2.194s)
[96.345629] Subtest oa-exponents: SUCCESS (2.195s)
[96.359797] [017/130] (903s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[96.586244] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[96.587791] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[96.665426] [018/130] (903s left) gem_ctx_engines (execute-allforone)
[96.772662] Starting subtest: execute-allforone
[96.802164] Subtest execute-allforone: SUCCESS (0.029s)
[97.049373] [019/130] (903s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[97.139445] Starting subtest: etime-multi-wait-all-submitted-signaled
[97.249193] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.107s)
[97.331734] [020/130] (903s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[97.626700] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[97.744481] [021/130] (902s left) kms_cursor_legacy (cursora-vs-flipa-legacy)
[97.973156] Starting subtest: cursorA-vs-flipA-legacy
[108.908073] Subtest cursorA-vs-flipA-legacy: SUCCESS (10.933s)
[109.149425] [022/130] (891s left) gem_mmap (big-bo)
[109.271457] Subtest big-bo: SKIP (0.000s)
[109.311925] [023/130] (891s left) kms_big_fb (x-tiled-8bpp-rotate-0)
[109.542599] Starting subtest: x-tiled-8bpp-rotate-0
[110.952655] Subtest x-tiled-8bpp-rotate-0: SUCCESS (1.409s)
[111.102808] [024/130] (889s left) kms_psr_stress_test (invalidate-primary-flip-overlay)
[111.192394] Subtest invalidate-primary-flip-overlay: SKIP (0.000s)
[111.228783] [025/130] (889s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs)
[111.444156] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs
[111.445111] Starting dynamic subtest: pipe-A-DP-4
[115.189647] Dynamic subtest pipe-A-DP-4: SUCCESS (3.741s)
[115.199569] Starting dynamic subtest: pipe-B-DP-4
[115.934778] Dynamic subtest pipe-B-DP-4: SUCCESS (0.742s)
[115.941132] Starting dynamic subtest: pipe-C-DP-4
[116.682773] Dynamic subtest pipe-C-DP-4: SUCCESS (0.742s)
[116.693186] Starting dynamic subtest: pipe-D-DP-4
[117.425618] Dynamic subtest pipe-D-DP-4: SUCCESS (0.739s)
[117.426897] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs: SUCCESS (5.978s)
[117.736247] [026/130] (882s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions)
[117.961625] Starting subtest: cursorA-vs-flipB-atomic-transitions
[117.964541] Subtest cursorA-vs-flipB-atomic-transitions: SKIP (0.001s)
[118.026786] [027/130] (882s left) kms_vblank (wait-forked)
[118.247919] Starting subtest: wait-forked
[118.249874] Starting dynamic subtest: pipe-A-DP-4
[120.580628] Dynamic subtest pipe-A-DP-4: SUCCESS (2.330s)
[120.601297] Starting dynamic subtest: pipe-D-DP-4
[122.901430] Dynamic subtest pipe-D-DP-4: SUCCESS (2.311s)
[122.902518] Subtest wait-forked: SUCCESS (4.652s)
[123.100985] [028/130] (877s left) kms_big_fb (y-tiled-addfb)
[123.369248] Starting subtest: y-tiled-addfb
[123.371090] Subtest y-tiled-addfb: SKIP (0.000s)
[123.432364] [029/130] (877s left) sysfs_timeslice_duration (idempotent)
[123.528183] Starting subtest: idempotent
[123.529073] Starting dynamic subtest: vecs0
[123.529952] Dynamic subtest vecs0: SUCCESS (0.000s)
[123.536420] Starting dynamic subtest: ccs0
[123.537370] Dynamic subtest ccs0: SUCCESS (0.000s)
[123.543316] Starting dynamic subtest: vcs0
[123.544169] Dynamic subtest vcs0: SUCCESS (0.000s)
[123.550215] Starting dynamic subtest: bcs0
[123.551377] Dynamic subtest bcs0: SUCCESS (0.000s)
[123.557294] Starting dynamic subtest: vecs1
[123.558098] Dynamic subtest vecs1: SUCCESS (0.000s)
[123.564201] Starting dynamic subtest: rcs0
[123.564971] Dynamic subtest rcs0: SUCCESS (0.000s)
[123.571058] Starting dynamic subtest: vcs1
[123.571853] Dynamic subtest vcs1: SUCCESS (0.000s)
[123.573068] Subtest idempotent: SUCCESS (0.006s)
[123.616883] [030/130] (877s left) gem_eio (in-flight-internal-1us)
[123.940452] Starting subtest: in-flight-internal-1us
[125.329431] Subtest in-flight-internal-1us: SUCCESS (1.395s)
[125.514999] [031/130] (875s left) gem_busy (parallel)
[125.757303] Starting subtest: parallel
[125.758232] Starting dynamic subtest: rcs0
[125.867054] Dynamic subtest rcs0: SUCCESS (0.109s)
[125.873690] Starting dynamic subtest: bcs0
[125.919915] Dynamic subtest bcs0: SUCCESS (0.052s)
[125.930184] Starting dynamic subtest: vcs0
[125.984769] Dynamic subtest vcs0: SUCCESS (0.064s)
[126.011384] Starting dynamic subtest: vcs1
[126.074122] Dynamic subtest vcs1: SUCCESS (0.088s)
[126.083419] Starting dynamic subtest: vecs0
[126.130601] Dynamic subtest vecs0: SUCCESS (0.056s)
[126.140080] Starting dynamic subtest: vecs1
[126.194356] Dynamic subtest vecs1: SUCCESS (0.063s)
[126.209025] Starting dynamic subtest: ccs0
[126.263780] Dynamic subtest ccs0: SUCCESS (0.068s)
[126.265254] Subtest parallel: SUCCESS (0.507s)
[126.468528] [032/130] (874s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-wc)
[126.691958] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-wc
[126.693582] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[126.771158] [033/130] (873s left) gem_userptr_blits (mmap-offset-banned)
[126.886404] Starting subtest: mmap-offset-banned
[126.887295] Starting dynamic subtest: fixed
[126.888209] Dynamic subtest fixed: SUCCESS (0.000s)
[126.889087] Subtest mmap-offset-banned: SUCCESS (0.001s)
[127.023147] [034/130] (873s left) gem_mmap_wc (write-gtt-read-wc)
[127.138708] Subtest write-gtt-read-wc: SKIP (0.000s)
[127.177458] [035/130] (873s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[127.401616] Starting subtest: cursorA-vs-flipB-legacy
[127.404518] Subtest cursorA-vs-flipB-legacy: SKIP (0.001s)
[127.467909] [036/130] (873s left) syncobj_wait (wait-for-submit-delayed-submit)
[127.568992] Starting subtest: wait-for-submit-delayed-submit
[127.670170] Subtest wait-for-submit-delayed-submit: SUCCESS (0.101s)
[127.742342] [037/130] (873s left) kms_chamelium_audio (hdmi-audio)
[128.029872] Subtest hdmi-audio: SKIP (0.000s)
[128.144424] [038/130] (872s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[128.378448] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[128.379386] Starting dynamic subtest: pipe-A-valid-mode
[130.188538] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.807s)
[130.190045] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SUCCESS (1.808s)
[130.439292] [039/130] (870s left) sriov_basic (enable-vfs-autoprobe-on)
[130.567199] Subtest enable-vfs-autoprobe-on: SKIP (0.000s)
[130.602125] [040/130] (870s left) gem_exec_fence (submit3)
[130.817084] Starting subtest: submit3
[130.831836] Subtest submit3: SKIP (0.000s)
[131.477910] [041/130] (869s left) kms_cursor_edge_walk (256x256-left-edge)
[131.688852] Starting subtest: 256x256-left-edge
[131.689761] Starting dynamic subtest: pipe-A-DP-4
[135.146145] Dynamic subtest pipe-A-DP-4: SUCCESS (3.456s)
[135.160027] Starting dynamic subtest: pipe-D-DP-4
[138.485427] Dynamic subtest pipe-D-DP-4: SUCCESS (3.337s)
[138.486467] Subtest 256x256-left-edge: SUCCESS (6.797s)
[138.715555] [042/130] (862s left) kms_color (ctm-negative)
[138.939513] Starting subtest: ctm-negative
[138.940440] Starting dynamic subtest: pipe-A-DP-4
[139.575266] Dynamic subtest pipe-A-DP-4: SUCCESS (0.635s)
[139.593667] Starting dynamic subtest: pipe-B-DP-4
[140.155422] Dynamic subtest pipe-B-DP-4: SUCCESS (0.579s)
[140.163736] Starting dynamic subtest: pipe-C-DP-4
[140.752466] Dynamic subtest pipe-C-DP-4: SUCCESS (0.596s)
[140.762207] Starting dynamic subtest: pipe-D-DP-4
[141.328709] Dynamic subtest pipe-D-DP-4: SUCCESS (0.576s)
[141.329757] Subtest ctm-negative: SUCCESS (2.389s)
[141.581552] [043/130] (859s left) kms_atomic_transition (modeset-transition)
[141.816531] Starting subtest: modeset-transition
[141.817442] Starting dynamic subtest: 1x-outputs
[144.506637] Dynamic subtest 1x-outputs: SUCCESS (2.689s)
[144.561543] Subtest modeset-transition: SUCCESS (2.744s)
[144.791315] [044/130] (856s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-wc)
[145.029554] Starting subtest: fbc-rgb565-draw-mmap-wc
[145.031274] Subtest fbc-rgb565-draw-mmap-wc: SKIP (0.000s)
[145.113067] [045/130] (855s left) gem_exec_reloc (basic-scanout)
[145.228261] Subtest basic-scanout: SKIP (0.000s)
[145.268878] [046/130] (855s left) gem_eio (context-create)
[145.586475] Starting subtest: context-create
[146.005651] Subtest context-create: SUCCESS (0.420s)
[146.189138] [047/130] (854s left) kms_cursor_legacy (flip-vs-cursor-busy-crc-atomic)
[146.407640] Starting subtest: flip-vs-cursor-busy-crc-atomic
[147.238249] Subtest flip-vs-cursor-busy-crc-atomic: SUCCESS (0.830s)
[147.482038] [048/130] (853s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-ccs)
[147.611728] Starting subtest: y-tiled-ccs-to-yf-tiled-ccs
[147.614401] Subtest y-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[147.821491] [049/130] (853s left) i915_selftest (live)
[150.039742] Starting subtest: live
[150.040576] Starting dynamic subtest: sanitycheck
[151.370883] Dynamic subtest sanitycheck: SUCCESS (1.331s)
[151.376915] Starting dynamic subtest: uncore
[152.702096] Dynamic subtest uncore: SUCCESS (1.330s)
[152.708228] Starting dynamic subtest: workarounds
[155.637891] Dynamic subtest workarounds: SUCCESS (2.935s)
[155.642635] Starting dynamic subtest: gt_engines
[157.692693] Dynamic subtest gt_engines: SUCCESS (2.053s)
[157.710965] Starting dynamic subtest: gt_timelines
[176.894307] Dynamic subtest gt_timelines: SUCCESS (19.200s)
[176.900259] Starting dynamic subtest: gt_contexts
[178.256790] Dynamic subtest gt_contexts: SUCCESS (1.362s)
[178.261879] Starting dynamic subtest: gt_lrc
[184.130055] Dynamic subtest gt_lrc: SUCCESS (5.872s)
[184.135044] Starting dynamic subtest: gt_mocs
[186.622808] Dynamic subtest gt_mocs: SUCCESS (2.492s)
[186.627132] Starting dynamic subtest: gt_pm
[189.675058] Dynamic subtest gt_pm: SUCCESS (3.051s)
[189.680601] Starting dynamic subtest: gt_heartbeat
[191.006124] Dynamic subtest gt_heartbeat: SUCCESS (1.330s)
[191.012537] Starting dynamic subtest: gt_tlb
[198.973181] Dynamic subtest gt_tlb: SUCCESS (7.966s)
[198.979814] Starting dynamic subtest: requests
[211.428235] Dynamic subtest requests: SUCCESS (12.454s)
[211.432515] Starting dynamic subtest: migrate
[216.076928] Dynamic subtest migrate: SUCCESS (4.648s)
[216.081551] Starting dynamic subtest: active
[217.399991] Dynamic subtest active: SUCCESS (1.322s)
[217.406074] Starting dynamic subtest: objects
[219.560853] Dynamic subtest objects: SUCCESS (2.160s)
[219.566931] Starting dynamic subtest: mman
[225.861937] Dynamic subtest mman: SUCCESS (6.300s)
[225.867912] Starting dynamic subtest: dmabuf
[227.202885] Dynamic subtest dmabuf: SUCCESS (1.340s)
[227.207465] Starting dynamic subtest: vma
[228.514929] Dynamic subtest vma: SUCCESS (1.311s)
[228.519357] Starting dynamic subtest: coherency
[232.698031] Dynamic subtest coherency: SUCCESS (4.182s)
[232.704390] Starting dynamic subtest: gtt
[242.292668] Dynamic subtest gtt: SUCCESS (9.593s)
[242.298140] Starting dynamic subtest: gem
[243.708927] Dynamic subtest gem: SUCCESS (1.416s)
[243.713812] Starting dynamic subtest: evict
[246.215154] Dynamic subtest evict: SUCCESS (2.505s)
[246.220900] Starting dynamic subtest: hugepages
[264.120631] Dynamic subtest hugepages: SUCCESS (17.904s)
[264.126090] Starting dynamic subtest: gem_contexts
[294.599962] Dynamic subtest gem_contexts: SUCCESS (30.479s)
[294.605129] Starting dynamic subtest: client
[295.972972] Dynamic subtest client: SUCCESS (1.372s)
[295.977593] Starting dynamic subtest: gem_migrate
[299.279973] Dynamic subtest gem_migrate: SUCCESS (3.306s)
[299.286129] Starting dynamic subtest: reset
[300.699038] Dynamic subtest reset: SUCCESS (1.418s)
[300.704950] Starting dynamic subtest: memory_region
[303.581938] Dynamic subtest memory_region: SUCCESS (2.882s)
[303.588013] Starting dynamic subtest: hangcheck
[334.358989] Dynamic subtest hangcheck: SUCCESS (30.776s)
[334.363944] Starting dynamic subtest: execlists
[335.654948] Dynamic subtest execlists: SUCCESS (1.295s)
[335.659519] Starting dynamic subtest: ring_submission
[336.913832] Dynamic subtest ring_submission: SUCCESS (1.258s)
[336.918843] Starting dynamic subtest: perf
[338.320049] Dynamic subtest perf: SUCCESS (1.406s)
[338.326036] Starting dynamic subtest: slpc
[345.301865] Dynamic subtest slpc: SUCCESS (6.981s)
[345.307801] Starting dynamic subtest: guc
[347.907481] Dynamic subtest guc: SUCCESS (2.605s)
[347.912041] Starting dynamic subtest: guc_multi_lrc
[349.280036] Dynamic subtest guc_multi_lrc: SUCCESS (1.372s)
[349.286836] Starting dynamic subtest: guc_hang
[351.379800] Dynamic subtest guc_hang: SUCCESS (2.099s)
[351.384834] Starting dynamic subtest: late_gt_pm
[352.778871] Dynamic subtest late_gt_pm: SUCCESS (1.398s)
[352.780422] Subtest live: SUCCESS (202.735s)
[353.251516] [050/130] (647s left) drm_read (empty-block)
[355.057364] Starting subtest: empty-block
[356.059284] Subtest empty-block: SUCCESS (1.000s)
[356.202403] [051/130] (644s left) api_intel_bb (add-remove-objects)
[356.254056] Starting subtest: add-remove-objects
[356.279177] Subtest add-remove-objects: SUCCESS (0.026s)
[356.429961] [052/130] (644s left) kms_lease (lease-get)
[356.647880] Starting subtest: lease-get
[356.648758] Starting dynamic subtest: pipe-A-DP-4
[356.650711] Dynamic subtest pipe-A-DP-4: SUCCESS (0.001s)
[356.657131] Starting dynamic subtest: pipe-B-DP-4
[356.657931] Dynamic subtest pipe-B-DP-4: SUCCESS (0.001s)
[356.664126] Starting dynamic subtest: pipe-C-DP-4
[356.664951] Dynamic subtest pipe-C-DP-4: SUCCESS (0.001s)
[356.670734] Starting dynamic subtest: pipe-D-DP-4
[356.671501] Dynamic subtest pipe-D-DP-4: SUCCESS (0.001s)
[356.672447] Subtest lease-get: SUCCESS (0.010s)
[356.742052] [053/130] (644s left) kms_psr (fbc-psr-sprite-blt)
[356.946453] Subtest fbc-psr-sprite-blt: SKIP (0.000s)
[356.963430] [054/130] (644s left) gem_userptr_blits (process-exit-busy)
[357.031382] Starting subtest: process-exit-busy
[357.045590] Subtest process-exit-busy: SUCCESS (0.014s)
[357.202658] [055/130] (644s left) gem_pxp (verify-pxp-stale-buf-execution)
[359.836355] Subtest verify-pxp-stale-buf-execution: SKIP (0.000s)
[359.928590] [056/130] (641s left) gen9_exec_parse (secure-batches)
[360.010012] Subtest secure-batches: SKIP (0.000s)
[360.066577] [057/130] (641s left) kms_fb_coherency (memset-crc)
[360.266146] Starting subtest: memset-crc
[360.267118] Starting dynamic subtest: mmap-offset-fixed
[360.755947] Dynamic subtest mmap-offset-fixed: SUCCESS (0.489s)
[360.855198] Subtest memset-crc: SUCCESS (0.589s)
[361.071522] [058/130] (640s left) kms_big_fb (4-tiled-8bpp-rotate-180)
[361.303992] Starting subtest: 4-tiled-8bpp-rotate-180
[362.651423] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (1.347s)
[362.802405] [059/130] (638s left) kms_pm_rpm (pc8-residency)
[364.525195] Starting subtest: pc8-residency
[364.529463] Subtest pc8-residency: SKIP (0.000s)
[364.899967] [060/130] (636s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite)
[365.121191] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite
[365.122892] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[365.212900] [061/130] (636s left) gem_eio (in-flight-internal-immediate)
[365.505800] Starting subtest: in-flight-internal-immediate
[367.309982] Subtest in-flight-internal-immediate: SUCCESS (1.805s)
[367.505586] [062/130] (633s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-pwrite)
[367.705072] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-pwrite
[371.358335] Subtest fbc-1p-primscrn-cur-indfb-draw-pwrite: SUCCESS (3.654s)
[371.473518] [063/130] (629s left) kms_addfb_basic (bad-pitch-32)
[371.533405] Starting subtest: bad-pitch-32
[371.534341] Subtest bad-pitch-32: SUCCESS (0.000s)
[371.744120] [064/130] (629s left) gem_exec_flush (basic-wb-rw-default)
[371.825767] Subtest basic-wb-rw-default: SKIP (0.000s)
[371.872531] [065/130] (629s left) gem_exec_schedule (submit-early-slice)
[371.944152] Starting subtest: submit-early-slice
[371.945116] Starting dynamic subtest: rcs0
[372.005370] Dynamic subtest rcs0: SUCCESS (0.061s)
[372.012226] Starting dynamic subtest: bcs0
[372.046933] Dynamic subtest bcs0: SUCCESS (0.041s)
[372.056483] Starting dynamic subtest: vcs0
[372.094069] Dynamic subtest vcs0: SUCCESS (0.046s)
[372.110129] Starting dynamic subtest: vcs1
[372.159503] Dynamic subtest vcs1: SUCCESS (0.064s)
[372.167628] Starting dynamic subtest: vecs0
[372.204712] Dynamic subtest vecs0: SUCCESS (0.045s)
[372.211628] Starting dynamic subtest: vecs1
[372.260407] Dynamic subtest vecs1: SUCCESS (0.055s)
[372.276074] Starting dynamic subtest: ccs0
[372.311619] Dynamic subtest ccs0: SUCCESS (0.050s)
[372.312500] Subtest submit-early-slice: SUCCESS (0.368s)
[372.700699] [066/130] (628s left) gem_ctx_persistence (engines-hostile-preempt)
[372.758794] Starting subtest: engines-hostile-preempt
[372.759646] Starting dynamic subtest: rcs0
[372.859323] Dynamic subtest rcs0: SUCCESS (0.100s)
[372.869866] Starting dynamic subtest: bcs0
[372.882282] Dynamic subtest bcs0: SUCCESS (0.022s)
[372.896373] Starting dynamic subtest: vcs0
[372.922385] Dynamic subtest vcs0: SUCCESS (0.039s)
[372.936199] Starting dynamic subtest: vcs1
[373.006122] Dynamic subtest vcs1: SUCCESS (0.082s)
[373.040929] Starting dynamic subtest: vecs0
[373.074822] Dynamic subtest vecs0: SUCCESS (0.067s)
[373.094517] Starting dynamic subtest: vecs1
[373.103517] Dynamic subtest vecs1: SUCCESS (0.027s)
[373.123878] Starting dynamic subtest: ccs0
[373.147638] Dynamic subtest ccs0: SUCCESS (0.043s)
[373.148661] Subtest engines-hostile-preempt: SUCCESS (0.389s)
[373.281283] [067/130] (628s left) drm_mm (drm_mm)
[373.358180] Starting subtest: drm_mm
[373.363280] Starting dynamic subtest: drm_test_mm_init
[373.427882] Dynamic subtest drm_test_mm_init: SUCCESS (0.064s)
[373.436979] Starting dynamic subtest: drm_test_mm_debug
[373.484512] Dynamic subtest drm_test_mm_debug: SUCCESS (0.056s)
[373.509623] Starting dynamic subtest: drm_test_mm_align32
[373.571926] Dynamic subtest drm_test_mm_align32: SUCCESS (0.082s)
[373.603231] Starting dynamic subtest: drm_test_mm_align64
[373.652237] Dynamic subtest drm_test_mm_align64: SUCCESS (0.078s)
[373.681569] Starting dynamic subtest: drm_test_mm_lowest
[373.742165] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.090s)
[373.749066] Starting dynamic subtest: drm_test_mm_highest
[373.827325] Dynamic subtest drm_test_mm_highest: SUCCESS (0.083s)
[373.829276] Subtest drm_mm: SUCCESS (0.469s)
[373.998188] [068/130] (627s left) gem_ctx_persistence (legacy-engines-queued)
[374.084315] Starting subtest: legacy-engines-queued
[374.085182] Starting dynamic subtest: render
[374.192425] Dynamic subtest render: SUCCESS (0.108s)
[374.205137] Starting dynamic subtest: bsd1
[374.217282] Dynamic subtest bsd1: SUCCESS (0.024s)
[374.229065] Starting dynamic subtest: bsd2
[374.268478] Dynamic subtest bsd2: SUCCESS (0.050s)
[374.281638] Starting dynamic subtest: blt
[374.330472] Dynamic subtest blt: SUCCESS (0.061s)
[374.354595] Starting dynamic subtest: vebox
[374.400639] Dynamic subtest vebox: SUCCESS (0.069s)
[374.402047] Subtest legacy-engines-queued: SUCCESS (0.316s)
[374.547921] [069/130] (627s left) gem_exec_params (invalid-bsd-ring)
[374.611581] Starting subtest: invalid-bsd-ring
[374.612595] Subtest invalid-bsd-ring: SUCCESS (0.000s)
[374.716416] [070/130] (626s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-msflip-blt)
[374.912346] Starting subtest: psr-2p-scndscrn-shrfb-msflip-blt
[374.914032] Subtest psr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[374.995457] [071/130] (626s left) gem_ctx_create (basic)
[375.056245] Starting subtest: basic
[375.057162] Subtest basic: SUCCESS (0.000s)
[375.265154] [072/130] (626s left) api_intel_bb (intel-bb-blit-x)
[375.346386] Starting subtest: intel-bb-blit-x
[375.964081] Subtest intel-bb-blit-x: SUCCESS (0.618s)
[376.093284] [073/130] (625s left) gem_mmap_gtt (cpuset-big-copy)
[376.147610] Subtest cpuset-big-copy: SKIP (0.000s)
[376.184858] [074/130] (625s left) syncobj_wait (invalid-signal-one-illegal-handle)
[376.234802] Starting subtest: invalid-signal-one-illegal-handle
[376.235723] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[376.317136] [075/130] (625s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-render)
[376.508625] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-render
[376.510327] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[376.595969] [076/130] (625s left) gem_tiled_fence_blits (normal)
[376.674117] Subtest normal: SKIP (0.000s)
[376.700489] [077/130] (625s left) i915_pm_rpm (sysfs-read)
[378.408225] Starting subtest: sysfs-read
[378.826591] Subtest sysfs-read: SUCCESS (0.416s)
[379.178590] [078/130] (622s left) kms_flip (2x-blocking-wf_vblank)
[379.393831] Starting subtest: 2x-blocking-wf_vblank
[379.409024] Subtest 2x-blocking-wf_vblank: SKIP (0.016s)
[379.477525] [079/130] (622s left) kms_cursor_crc (cursor-random-64x21)
[379.767374] Starting subtest: cursor-random-64x21
[379.771675] Starting dynamic subtest: pipe-A-DP-4
[384.143410] Dynamic subtest pipe-A-DP-4: SUCCESS (4.371s)
[384.175182] Starting dynamic subtest: pipe-D-DP-4
[388.416895] Dynamic subtest pipe-D-DP-4: SUCCESS (4.248s)
[388.417742] Subtest cursor-random-64x21: SUCCESS (8.649s)
[388.815253] [080/130] (613s left) kms_flip (2x-flip-vs-suspend-interruptible)
[389.004491] Starting subtest: 2x-flip-vs-suspend-interruptible
[389.021151] Subtest 2x-flip-vs-suspend-interruptible: SKIP (0.016s)
[389.076518] [081/130] (612s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-move)
[389.256404] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-move
[389.258197] Subtest fbcpsr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[389.330118] [082/130] (612s left) kms_psr (psr2-sprite-mmap-cpu)
[389.533269] Subtest psr2-sprite-mmap-cpu: SKIP (0.000s)
[389.555060] [083/130] (612s left) gem_eio (in-flight-internal-10ms)
[389.822224] Starting subtest: in-flight-internal-10ms
[391.309383] Subtest in-flight-internal-10ms: SUCCESS (1.488s)
[391.492348] [084/130] (610s left) kms_properties (crtc-properties-legacy)
[391.669506] Starting subtest: crtc-properties-legacy
[391.670463] Starting dynamic subtest: pipe-A-DP-4
[391.986777] Dynamic subtest pipe-A-DP-4: SUCCESS (0.316s)
[391.996816] Starting dynamic subtest: pipe-B-DP-4
[392.351527] Dynamic subtest pipe-B-DP-4: SUCCESS (0.363s)
[392.359386] Starting dynamic subtest: pipe-C-DP-4
[392.732401] Dynamic subtest pipe-C-DP-4: SUCCESS (0.380s)
[392.740291] Starting dynamic subtest: pipe-D-DP-4
[393.095406] Dynamic subtest pipe-D-DP-4: SUCCESS (0.362s)
[393.096328] Subtest crtc-properties-legacy: SUCCESS (1.426s)
[393.358810] [085/130] (608s left) kms_psr (fbc-psr2-primary-blt)
[393.571799] Subtest fbc-psr2-primary-blt: SKIP (0.000s)
[393.592833] [086/130] (608s left) gen9_exec_parse (bb-start-out)
[393.651959] Subtest bb-start-out: SKIP (0.000s)
[393.694329] [087/130] (608s left) kms_sequence (get-forked-busy)
[393.881551] Starting subtest: get-forked-busy
[393.882463] Starting dynamic subtest: pipe-A-DP-4
[396.513305] Dynamic subtest pipe-A-DP-4: SUCCESS (2.627s)
[396.555744] Starting dynamic subtest: pipe-B-DP-4
[399.121426] Dynamic subtest pipe-B-DP-4: SUCCESS (2.605s)
[399.145081] Starting dynamic subtest: pipe-C-DP-4
[401.720691] Dynamic subtest pipe-C-DP-4: SUCCESS (2.593s)
[401.752663] Starting dynamic subtest: pipe-D-DP-4
[404.346171] Dynamic subtest pipe-D-DP-4: SUCCESS (2.621s)
[404.347829] Subtest get-forked-busy: SUCCESS (10.463s)
[404.632278] [088/130] (597s left) sw_sync (alloc_fence)
[404.680579] Starting subtest: alloc_fence
[404.681425] Subtest alloc_fence: SUCCESS (0.000s)
[404.726925] [089/130] (597s left) debugfs_test (read_all_entries)
[404.785210] Starting subtest: read_all_entries
[405.431222] Subtest read_all_entries: SUCCESS (0.646s)
[405.609252] [090/130] (596s left) kms_psr (pr-sprite-plane-onoff)
[405.783223] Subtest pr-sprite-plane-onoff: SKIP (0.000s)
[405.805015] [091/130] (596s left) kms_flip (2x-wf_vblank-ts-check)
[405.981054] Starting subtest: 2x-wf_vblank-ts-check
[405.995949] Subtest 2x-wf_vblank-ts-check: SKIP (0.016s)
[406.061705] [092/130] (596s left) gem_ringfill (engines-basic)
[406.494991] Starting subtest: engines-basic
[406.496985] Starting dynamic subtest: rcs0
[406.559437] Dynamic subtest rcs0: SUCCESS (0.064s)
[406.567780] Starting dynamic subtest: bcs0
[406.599847] Dynamic subtest bcs0: SUCCESS (0.040s)
[406.610248] Starting dynamic subtest: vcs0
[406.642549] Dynamic subtest vcs0: SUCCESS (0.041s)
[406.673059] Starting dynamic subtest: vcs1
[406.692965] Dynamic subtest vcs1: SUCCESS (0.049s)
[406.710421] Starting dynamic subtest: vecs0
[406.737095] Dynamic subtest vecs0: SUCCESS (0.043s)
[406.758133] Starting dynamic subtest: vecs1
[406.783706] Dynamic subtest vecs1: SUCCESS (0.045s)
[406.817040] Starting dynamic subtest: ccs0
[406.833907] Dynamic subtest ccs0: SUCCESS (0.047s)
[406.835114] Subtest engines-basic: SUCCESS (0.340s)
[406.951301] [093/130] (595s left) vgem_basic (create)
[407.031091] Starting subtest: create
[407.032280] Subtest create: SUCCESS (0.000s)
[407.080688] [094/130] (595s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-fullscreen)
[407.282941] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-fullscreen
[407.284648] Subtest fbcpsr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[407.370771] [095/130] (594s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted)
[407.458178] Starting subtest: invalid-multi-wait-unsubmitted-submitted
[407.459052] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s)
[407.585311] [096/130] (594s left) gem_mmap_offset (partial-mmap)
[407.650024] Starting subtest: partial-mmap
[407.650940] Starting dynamic subtest: lmem0
[407.653210] Dynamic subtest lmem0: SUCCESS (0.003s)
[407.660394] Starting dynamic subtest: smem0
[407.661212] Dynamic subtest smem0: SUCCESS (0.003s)
[407.662029] Subtest partial-mmap: SUCCESS (0.007s)
[407.802097] [097/130] (594s left) kms_invalid_mode (bad-vsync-end)
[407.994255] Starting subtest: bad-vsync-end
[407.995176] Starting dynamic subtest: pipe-A-DP-4
[408.071931] Dynamic subtest pipe-A-DP-4: SUCCESS (0.077s)
[408.080701] Starting dynamic subtest: pipe-B-DP-4
[408.081538] Dynamic subtest pipe-B-DP-4: SUCCESS (0.001s)
[408.090187] Starting dynamic subtest: pipe-C-DP-4
[408.091174] Dynamic subtest pipe-C-DP-4: SUCCESS (0.001s)
[408.099823] Starting dynamic subtest: pipe-D-DP-4
[408.100824] Dynamic subtest pipe-D-DP-4: SUCCESS (0.001s)
[408.101819] Subtest bad-vsync-end: SUCCESS (0.084s)
[408.258404] [098/130] (594s left) kms_atomic_transition (plane-all-modeset-transition)
[408.488810] Starting subtest: plane-all-modeset-transition
[408.489666] Starting dynamic subtest: pipe-A-DP-4
[439.165379] Dynamic subtest pipe-A-DP-4: SUCCESS (30.674s)
[439.251405] Starting dynamic subtest: pipe-B-DP-4
[466.556345] Dynamic subtest pipe-B-DP-4: SUCCESS (27.314s)
[466.610079] Subtest plane-all-modeset-transition: SUCCESS (58.118s)
[466.844554] [099/130] (535s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-signaled)
[466.909363] Starting subtest: etime-multi-wait-all-available-unsubmitted-signaled
[467.014373] Subtest etime-multi-wait-all-available-unsubmitted-signaled: SUCCESS (0.105s)
[467.094508] [100/130] (535s left) kms_psr (fbc-pr-cursor-plane-onoff)
[467.278409] Subtest fbc-pr-cursor-plane-onoff: SKIP (0.000s)
[467.301853] [101/130] (535s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted)
[467.354180] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted
[467.355125] Subtest multi-wait-for-submit-available-unsubmitted-submitted: SUCCESS (0.000s)
[467.434351] [102/130] (535s left) perf_pmu (busy-hang)
[467.511251] Starting subtest: busy-hang
[467.512229] Starting dynamic subtest: rcs0
[468.803210] Dynamic subtest rcs0: SUCCESS (1.291s)
[468.814103] Starting dynamic subtest: bcs0
[470.039025] Dynamic subtest bcs0: SUCCESS (1.232s)
[470.046991] Starting dynamic subtest: vcs0
[471.283194] Dynamic subtest vcs0: SUCCESS (1.242s)
[471.290995] Starting dynamic subtest: vcs1
[472.515286] Dynamic subtest vcs1: SUCCESS (1.229s)
[472.523024] Starting dynamic subtest: vecs0
[473.754223] Dynamic subtest vecs0: SUCCESS (1.236s)
[473.762398] Starting dynamic subtest: vecs1
[475.001337] Dynamic subtest vecs1: SUCCESS (1.245s)
[475.009352] Starting dynamic subtest: ccs0
[476.235290] Dynamic subtest ccs0: SUCCESS (1.231s)
[476.236064] Subtest busy-hang: SUCCESS (8.722s)
[476.323209] [103/130] (526s left) kms_frontbuffer_tracking (fbcpsr-tiling-linear)
[476.516536] Starting subtest: fbcpsr-tiling-linear
[476.518334] Subtest fbcpsr-tiling-linear: SKIP (0.000s)
[476.596888] [104/130] (525s left) perf_pmu (busy)
[476.659638] Starting subtest: busy
[476.660555] Starting dynamic subtest: rcs0
[477.295829] Dynamic subtest rcs0: SUCCESS (0.635s)
[477.307562] Starting dynamic subtest: bcs0
[477.857986] Dynamic subtest bcs0: SUCCESS (0.560s)
[477.869833] Starting dynamic subtest: vcs0
[478.430062] Dynamic subtest vcs0: SUCCESS (0.569s)
[478.441634] Starting dynamic subtest: vcs1
[478.997087] Dynamic subtest vcs1: SUCCESS (0.564s)
[479.008616] Starting dynamic subtest: vecs0
[479.564979] Dynamic subtest vecs0: SUCCESS (0.565s)
[479.576789] Starting dynamic subtest: vecs1
[480.127272] Dynamic subtest vecs1: SUCCESS (0.560s)
[480.161082] Starting dynamic subtest: ccs0
[480.705169] Dynamic subtest ccs0: SUCCESS (0.575s)
[480.707167] Subtest busy: SUCCESS (4.046s)
[480.786463] [105/130] (521s left) kms_chamelium_hpd (common-hpd-after-suspend)
[481.053761] Subtest common-hpd-after-suspend: SKIP (0.000s)
[481.173639] [106/130] (521s left) gem_ctx_param (invalid-size-set)
[481.239472] Starting subtest: invalid-size-set
[481.240412] Subtest invalid-size-set: SUCCESS (0.001s)
[481.366072] [107/130] (521s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-mmap-cpu)
[481.576063] Starting subtest: psr-2p-primscrn-spr-indfb-draw-mmap-cpu
[481.577871] Subtest psr-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[481.666272] [108/130] (520s left) kms_plane_cursor (overlay)
[481.879566] Starting subtest: overlay
[481.881372] Starting dynamic subtest: pipe-A-DP-4-size-64
[485.389493] Dynamic subtest pipe-A-DP-4-size-64: SUCCESS (3.508s)
[485.490636] Starting dynamic subtest: pipe-A-DP-4-size-128
[489.022885] Dynamic subtest pipe-A-DP-4-size-128: SUCCESS (3.565s)
[489.099589] Starting dynamic subtest: pipe-A-DP-4-size-256
[492.556453] Dynamic subtest pipe-A-DP-4-size-256: SUCCESS (3.466s)
[492.697588] Starting dynamic subtest: pipe-B-DP-4-size-64
[496.189325] Dynamic subtest pipe-B-DP-4-size-64: SUCCESS (3.503s)
[496.250420] Starting dynamic subtest: pipe-B-DP-4-size-128
[499.656299] Dynamic subtest pipe-B-DP-4-size-128: SUCCESS (3.415s)
[499.740525] Starting dynamic subtest: pipe-B-DP-4-size-256
[503.272933] Dynamic subtest pipe-B-DP-4-size-256: SUCCESS (3.565s)
[503.418397] Starting dynamic subtest: pipe-C-DP-4-size-64
[506.989790] Dynamic subtest pipe-C-DP-4-size-64: SUCCESS (3.585s)
[507.049378] Starting dynamic subtest: pipe-C-DP-4-size-128
[510.573191] Dynamic subtest pipe-C-DP-4-size-128: SUCCESS (3.533s)
[510.630761] Starting dynamic subtest: pipe-C-DP-4-size-256
[514.139954] Dynamic subtest pipe-C-DP-4-size-256: SUCCESS (3.517s)
[514.264627] Starting dynamic subtest: pipe-D-DP-4-size-64
[517.856398] Dynamic subtest pipe-D-DP-4-size-64: SUCCESS (3.604s)
[517.914675] Starting dynamic subtest: pipe-D-DP-4-size-128
[521.323369] Dynamic subtest pipe-D-DP-4-size-128: SUCCESS (3.416s)
[521.387225] Starting dynamic subtest: pipe-D-DP-4-size-256
[524.840214] Dynamic subtest pipe-D-DP-4-size-256: SUCCESS (3.466s)
[524.988286] Subtest overlay: SUCCESS (43.106s)
[525.231800] [109/130] (477s left) kms_frontbuffer_tracking (psr-indfb-scaledprimary)
[525.434355] Starting subtest: psr-indfb-scaledprimary
[525.436103] Subtest psr-indfb-scaledprimary: SKIP (0.000s)
[525.507082] [110/130] (477s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs-cc)
[525.701013] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs-cc
[525.701927] Starting dynamic subtest: pipe-A-DP-4
[525.710317] Dynamic subtest pipe-A-DP-4: SKIP (0.000s)
[525.718280] Starting dynamic subtest: pipe-B-DP-4
[525.726649] Dynamic subtest pipe-B-DP-4: SKIP (0.000s)
[525.734445] Starting dynamic subtest: pipe-C-DP-4
[525.742611] Dynamic subtest pipe-C-DP-4: SKIP (0.000s)
[525.750298] Starting dynamic subtest: pipe-D-DP-4
[525.760742] Dynamic subtest pipe-D-DP-4: SKIP (0.000s)
[525.762908] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs-cc: SKIP (0.005s)
[526.137916] [111/130] (476s left) kms_getfb (getfb-handle-valid)
[526.207036] Starting subtest: getfb-handle-valid
[526.207926] Subtest getfb-handle-valid: SUCCESS (0.000s)
[526.325461] [112/130] (476s left) kms_pm_dc (dc9-dpms)
[527.532917] Starting subtest: dc9-dpms
[527.943301] Subtest dc9-dpms: SUCCESS (0.410s)
[528.114822] [113/130] (474s left) kms_async_flips (test-cursor)
[528.326452] Starting subtest: test-cursor
[528.527048] Starting dynamic subtest: pipe-A-DP-4
[528.779749] Dynamic subtest pipe-A-DP-4: SUCCESS (0.253s)
[529.007437] Starting dynamic subtest: pipe-B-DP-4
[529.127839] Dynamic subtest pipe-B-DP-4: SUCCESS (0.130s)
[529.323721] Starting dynamic subtest: pipe-C-DP-4
[529.435030] Dynamic subtest pipe-C-DP-4: SUCCESS (0.120s)
[529.629300] Starting dynamic subtest: pipe-D-DP-4
[529.777274] Dynamic subtest pipe-D-DP-4: SUCCESS (0.157s)
[529.778362] Subtest test-cursor: SUCCESS (1.451s)
[530.181207] [114/130] (472s left) gem_exec_balancer (full-late)
[530.261958] Starting subtest: full-late
[531.464468] Subtest full-late: SUCCESS (1.202s)
[531.788713] [115/130] (471s left) kms_addfb_basic (bad-pitch-128)
[531.838237] Starting subtest: bad-pitch-128
[531.839154] Subtest bad-pitch-128: SUCCESS (0.000s)
[532.067749] [116/130] (470s left) gem_exec_whisper (basic-queues-forked)
[532.140120] Starting subtest: basic-queues-forked
[554.281702] Subtest basic-queues-forked: SUCCESS (22.140s)
[554.445533] [117/130] (448s left) gem_mmap_gtt (big-bo)
[554.512124] Subtest big-bo: SKIP (0.000s)
[554.555421] [118/130] (448s left) kms_psr2_sf (pr-plane-move-sf-dmg-area)
[554.756550] Subtest pr-plane-move-sf-dmg-area: SKIP (0.000s)
[554.785142] [119/130] (448s left) drm_fdinfo (isolation)
[554.828717] Starting subtest: isolation
[554.829700] Starting dynamic subtest: rcs0
[554.843343] Dynamic subtest rcs0: SKIP (0.013s)
[554.851485] Starting dynamic subtest: bcs0
[554.853308] Dynamic subtest bcs0: SKIP (0.005s)
[554.861578] Starting dynamic subtest: vcs0
[554.863245] Dynamic subtest vcs0: SKIP (0.000s)
[554.871230] Starting dynamic subtest: vcs1
[554.873111] Dynamic subtest vcs1: SKIP (0.000s)
[554.880791] Starting dynamic subtest: vecs0
[554.882309] Dynamic subtest vecs0: SKIP (0.000s)
[554.891049] Starting dynamic subtest: vecs1
[554.892945] Dynamic subtest vecs1: SKIP (0.000s)
[554.901017] Starting dynamic subtest: ccs0
[554.903234] Dynamic subtest ccs0: SKIP (0.000s)
[554.905366] Subtest isolation: SKIP (0.024s)
[554.918364] [120/130] (448s left) kms_plane_alpha_blend (constant-alpha-max)
[555.099009] Starting subtest: constant-alpha-max
[555.306706] Starting dynamic subtest: pipe-A-DP-4
[556.219519] Dynamic subtest pipe-A-DP-4: SUCCESS (0.912s)
[556.239659] Starting dynamic subtest: pipe-D-DP-4
[557.194899] Dynamic subtest pipe-D-DP-4: SUCCESS (0.972s)
[557.195742] Subtest constant-alpha-max: SUCCESS (2.096s)
[557.440422] [121/130] (445s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs-cc)
[557.649104] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs-cc
[557.649980] Starting dynamic subtest: pipe-A-DP-4
[557.657798] Dynamic subtest pipe-A-DP-4: SKIP (0.000s)
[557.665799] Starting dynamic subtest: pipe-B-DP-4
[557.674331] Dynamic subtest pipe-B-DP-4: SKIP (0.000s)
[557.682280] Starting dynamic subtest: pipe-C-DP-4
[557.690286] Dynamic subtest pipe-C-DP-4: SKIP (0.000s)
[557.698366] Starting dynamic subtest: pipe-D-DP-4
[557.707694] Dynamic subtest pipe-D-DP-4: SKIP (0.000s)
[557.710067] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs-cc: SKIP (0.005s)
[558.060094] [122/130] (444s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-blt)
[558.262998] Starting subtest: psr-1p-primscrn-cur-indfb-draw-blt
[558.264562] Subtest psr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[558.340909] [123/130] (444s left) kms_flip (2x-flip-vs-rmfb)
[558.541686] Starting subtest: 2x-flip-vs-rmfb
[558.558725] Subtest 2x-flip-vs-rmfb: SKIP (0.016s)
[558.618064] [124/130] (444s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-wc)
[558.817553] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-wc
[558.819373] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[558.889376] [125/130] (444s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[559.094169] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[559.095830] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[559.175295] [126/130] (443s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[559.391112] Starting subtest: yf-tiled-8bpp-rotate-270
[559.392789] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[559.476265] [127/130] (443s left) kms_cursor_crc (cursor-offscreen-256x85)
[559.853762] Starting subtest: cursor-offscreen-256x85
[559.859104] Starting dynamic subtest: pipe-A-DP-4
[562.326644] Dynamic subtest pipe-A-DP-4: SUCCESS (2.466s)
[562.374256] Starting dynamic subtest: pipe-D-DP-4
[564.801229] Dynamic subtest pipe-D-DP-4: SUCCESS (2.433s)
[564.802339] Subtest cursor-offscreen-256x85: SUCCESS (4.947s)
[565.088773] [128/130] (438s left) kms_psr2_sf (fbc-pr-plane-move-sf-dmg-area)
[565.315397] Subtest fbc-pr-plane-move-sf-dmg-area: SKIP (0.000s)
[565.329444] [129/130] (437s left) gem_eio (in-flight-contexts-1us)
[565.666421] Starting subtest: in-flight-contexts-1us
[579.316443] Subtest in-flight-contexts-1us: SUCCESS (13.651s)
[579.500542] [130/130] (423s left) gem_exec_balancer (sequential)
[579.563414] Starting subtest: sequential
[584.730299] Subtest sequential: SUCCESS (5.167s)
[584.982883] Closing watchdogs
Done.