[59.331019] Initializing watchdogs [59.331074] /dev/watchdog0 [59.346562] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics] [59.351197] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [59.353676] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [59.357156] [001/133] (960s left) gem_exec_balancer (parallel-keep-submit-fence) [59.650826] Starting subtest: parallel-keep-submit-fence [60.769858] Subtest parallel-keep-submit-fence: SUCCESS (1.119s) [60.889646] [002/133] (959s left) sriov_basic (enable-vfs-autoprobe-off) [60.938948] Starting subtest: enable-vfs-autoprobe-off [60.941400] Starting dynamic subtest: numvfs-1 [61.021494] Dynamic subtest numvfs-1: FAIL (0.032s) [61.029955] Starting dynamic subtest: numvfs-2 [61.103583] Dynamic subtest numvfs-2: FAIL (0.004s) [61.113066] Starting dynamic subtest: numvfs-3 [61.185958] Dynamic subtest numvfs-3: FAIL (0.004s) [61.193777] Starting dynamic subtest: numvfs-4 [61.266857] Dynamic subtest numvfs-4: FAIL (0.004s) [61.276059] Starting dynamic subtest: numvfs-5 [61.348674] Dynamic subtest numvfs-5: FAIL (0.004s) [61.357064] Starting dynamic subtest: numvfs-6 [61.429979] Dynamic subtest numvfs-6: FAIL (0.004s) [61.437872] Starting dynamic subtest: numvfs-7 [61.510736] Dynamic subtest numvfs-7: FAIL (0.004s) [61.519464] Starting dynamic subtest: numvfs-random [61.589314] Dynamic subtest numvfs-random: FAIL (0.004s) [61.597723] Starting dynamic subtest: numvfs-all [61.673287] Dynamic subtest numvfs-all: FAIL (0.503s) [61.675702] Subtest enable-vfs-autoprobe-off: FAIL (0.564s) [61.711582] [003/133] (958s left) i915_pm_rpm (system-suspend) [63.261601] Starting subtest: system-suspend [81.589473] Subtest system-suspend: SUCCESS (2.967s) [81.963228] [004/133] (938s left) prime_vgem (fence-flip-hang) [82.127805] Subtest fence-flip-hang: SKIP (0.000s) [82.260090] [FACT prime_vgem (fence-flip-hang)] new: kernel.kmod_is_loaded.vgem: true [82.263148] [005/133] (937s left) kms_big_fb (x-tiled-32bpp-rotate-180) [82.455751] Starting subtest: x-tiled-32bpp-rotate-180 [84.111365] Subtest x-tiled-32bpp-rotate-180: SUCCESS (1.656s) [84.278839] [006/133] (935s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions) [84.403744] Starting subtest: cursor-vs-flip-atomic-transitions [114.395472] Subtest cursor-vs-flip-atomic-transitions: SUCCESS (29.992s) [115.269702] [007/133] (904s left) gem_exec_schedule (pi-userfault) [115.469989] Starting subtest: pi-userfault [115.471997] Starting dynamic subtest: rcs0 [115.480944] Dynamic subtest rcs0: SUCCESS (0.014s) [115.488972] Starting dynamic subtest: bcs0 [115.491381] Dynamic subtest bcs0: SUCCESS (0.008s) [115.499934] Starting dynamic subtest: vcs0 [115.502199] Dynamic subtest vcs0: SUCCESS (0.009s) [115.510213] Starting dynamic subtest: vcs1 [115.512569] Dynamic subtest vcs1: SUCCESS (0.012s) [115.520314] Starting dynamic subtest: vecs0 [115.522517] Dynamic subtest vecs0: SUCCESS (0.009s) [115.530586] Starting dynamic subtest: ccs0 [115.532769] Dynamic subtest ccs0: SUCCESS (0.010s) [115.534669] Subtest pi-userfault: SUCCESS (0.064s) [115.714216] [008/133] (904s left) gem_mmap_gtt (basic-write-read-distinct) [115.776268] Subtest basic-write-read-distinct: SKIP (0.000s) [115.835644] [009/133] (904s left) kms_prop_blob (basic) [115.899917] Starting subtest: basic [115.902207] Subtest basic: SUCCESS (0.000s) [116.002187] [010/133] (904s left) gem_mmap_offset (mmap-boundaries) [116.057655] Starting subtest: mmap-boundaries [116.060137] Starting dynamic subtest: smem0 [116.351828] Dynamic subtest smem0: SUCCESS (0.294s) [116.354475] Subtest mmap-boundaries: SUCCESS (0.294s) [116.472211] [011/133] (903s left) kms_hdmi_inject (inject-4k) [116.816944] Starting subtest: inject-4k [117.134386] Subtest inject-4k: SUCCESS (0.318s) [117.652247] [012/133] (902s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions) [117.770858] Starting subtest: flip-vs-cursor-atomic-transitions [125.398768] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (7.625s) [126.210437] [013/133] (894s left) gem_madvise (dontneed-before-mmap) [126.258097] Starting subtest: dontneed-before-mmap [126.283809] Subtest dontneed-before-mmap: SUCCESS (0.025s) [126.392216] [014/133] (894s left) gem_pxp (hw-rejects-pxp-context) [126.522201] Starting subtest: hw-rejects-pxp-context [126.526864] Subtest hw-rejects-pxp-context: SKIP (0.000s) [126.625456] [015/133] (893s left) kms_busy (basic-hang) [126.717234] Starting subtest: basic-hang [126.719535] Starting dynamic subtest: flip-pipe-A [127.343026] Dynamic subtest flip-pipe-A: SUCCESS (0.625s) [127.351661] Starting dynamic subtest: modeset-pipe-A [130.738470] Dynamic subtest modeset-pipe-A: SUCCESS (3.394s) [130.747554] Starting dynamic subtest: flip-pipe-D [131.999956] Dynamic subtest flip-pipe-D: SUCCESS (1.258s) [132.010100] Starting dynamic subtest: modeset-pipe-D [135.336524] Dynamic subtest modeset-pipe-D: SUCCESS (3.337s) [135.338959] Subtest basic-hang: SUCCESS (8.620s) [136.213358] [016/133] (884s left) kms_psr (fbc-psr2-primary-page-flip) [136.306187] Starting subtest: fbc-psr2-primary-page-flip [136.308401] Starting dynamic subtest: eDP-1 [136.312787] Dynamic subtest eDP-1: SKIP (0.000s) [136.317265] Subtest fbc-psr2-primary-page-flip: SKIP (0.001s) [136.397751] [017/133] (884s left) kms_invalid_mode (clock-too-high) [136.487172] Starting subtest: clock-too-high [136.489501] Starting dynamic subtest: pipe-A-eDP-1 [136.493738] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [136.505676] Starting dynamic subtest: pipe-B-eDP-1 [136.509875] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [136.518061] Starting dynamic subtest: pipe-C-eDP-1 [136.522154] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [136.530213] Starting dynamic subtest: pipe-D-eDP-1 [136.534363] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [136.538584] Subtest clock-too-high: SKIP (0.003s) [136.574949] [018/133] (884s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-downscaling) [136.668120] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-downscaling [136.670423] Starting dynamic subtest: pipe-A-default-mode [137.842714] Dynamic subtest pipe-A-default-mode: SKIP (1.172s) [137.847207] Subtest flip-32bpp-4tile-to-64bpp-4tile-downscaling: SKIP (1.173s) [138.009399] [019/133] (882s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset) [138.112470] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset [138.114478] Starting dynamic subtest: A-eDP1 [141.744839] Dynamic subtest A-eDP1: SUCCESS (3.631s) [141.754444] Starting dynamic subtest: B-eDP1 [145.035922] Dynamic subtest B-eDP1: SUCCESS (3.289s) [145.045958] Starting dynamic subtest: C-eDP1 [148.332875] Dynamic subtest C-eDP1: SUCCESS (3.296s) [148.342858] Starting dynamic subtest: D-eDP1 [151.637249] Dynamic subtest D-eDP1: SUCCESS (3.305s) [151.639516] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (13.528s) [152.509809] [020/133] (868s left) kms_psr (fbc-pr-cursor-blt) [152.617276] Starting subtest: fbc-pr-cursor-blt [152.621914] Subtest fbc-pr-cursor-blt: SKIP (0.000s) [152.688727] [021/133] (868s left) kms_fbcon_fbt (fbc) [152.742958] Starting subtest: fbc [159.248925] Subtest fbc: SUCCESS (6.504s) [160.389625] [022/133] (860s left) gem_exec_fence (syncobj-stationary-timeline-chain-engines) [160.939447] Starting subtest: syncobj-stationary-timeline-chain-engines [161.043048] Subtest syncobj-stationary-timeline-chain-engines: SUCCESS (0.106s) [162.347861] [023/133] (858s left) i915_suspend (sysfs-reader) [162.395894] Starting subtest: sysfs-reader [180.791996] Subtest sysfs-reader: SUCCESS (3.176s) [180.876364] [024/133] (839s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc) [180.977332] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc [184.978208] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (4.001s) [186.128007] [025/133] (834s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs) [186.191866] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs [186.196627] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SKIP (0.000s) [186.380640] [026/133] (834s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping) [186.489333] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping [186.493505] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping: SKIP (0.000s) [186.573214] [027/133] (834s left) kms_psr (pr-sprite-render) [186.663217] Starting subtest: pr-sprite-render [186.667734] Subtest pr-sprite-render: SKIP (0.000s) [186.736961] [028/133] (834s left) kms_lease (lease-uevent) [186.834528] Starting subtest: lease-uevent [187.842952] Subtest lease-uevent: SUCCESS (1.009s) [187.920266] [029/133] (833s left) kms_flip (flip-vs-panning-interruptible) [188.019474] Starting subtest: flip-vs-panning-interruptible [188.024088] Starting dynamic subtest: A-eDP1 [196.686487] Dynamic subtest A-eDP1: SUCCESS (8.663s) [196.697898] Starting dynamic subtest: B-eDP1 [205.385718] Dynamic subtest B-eDP1: SUCCESS (8.695s) [205.399055] Starting dynamic subtest: C-eDP1 [214.069484] Dynamic subtest C-eDP1: SUCCESS (8.680s) [214.080159] Starting dynamic subtest: D-eDP1 [222.775136] Dynamic subtest D-eDP1: SUCCESS (8.705s) [222.779484] Subtest flip-vs-panning-interruptible: SUCCESS (34.754s) [224.011655] [030/133] (797s left) kms_flip (dpms-vs-vblank-race) [224.109452] Starting subtest: dpms-vs-vblank-race [224.111311] Starting dynamic subtest: A-eDP1 [227.953118] Dynamic subtest A-eDP1: SUCCESS (3.843s) [227.962128] Starting dynamic subtest: B-eDP1 [231.470597] Dynamic subtest B-eDP1: SUCCESS (3.515s) [231.480488] Starting dynamic subtest: C-eDP1 [234.941340] Dynamic subtest C-eDP1: SUCCESS (3.470s) [234.950741] Starting dynamic subtest: D-eDP1 [238.470163] Dynamic subtest D-eDP1: SUCCESS (3.526s) [238.472940] Subtest dpms-vs-vblank-race: SUCCESS (14.364s) [239.298226] [031/133] (781s left) kms_plane_alpha_blend (alpha-basic) [239.393213] Starting subtest: alpha-basic [239.676930] Starting dynamic subtest: pipe-A-eDP-1 [241.606010] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.926s) [241.632907] Starting dynamic subtest: pipe-D-eDP-1 [244.265559] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.638s) [244.267977] Subtest alpha-basic: SUCCESS (4.871s) [245.102924] [032/133] (776s left) syncobj_timeline (multi-wait-available-submitted-signaled) [245.160574] Starting subtest: multi-wait-available-submitted-signaled [245.162959] Subtest multi-wait-available-submitted-signaled: SUCCESS (0.000s) [245.259703] [033/133] (775s left) kms_sequence (get-forked-busy) [245.351672] Starting subtest: get-forked-busy [245.353913] Starting dynamic subtest: pipe-A-eDP-1 [247.302252] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.949s) [247.312210] Starting dynamic subtest: pipe-B-eDP-1 [249.861592] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.561s) [249.871294] Starting dynamic subtest: pipe-C-eDP-1 [252.447409] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.580s) [252.457628] Starting dynamic subtest: pipe-D-eDP-1 [255.055960] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.609s) [255.058182] Subtest get-forked-busy: SUCCESS (9.705s) [255.902667] [034/133] (765s left) sysfs_preempt_timeout (timeout) [255.982270] Starting subtest: timeout [255.984675] Starting dynamic subtest: vecs0 [265.484398] Dynamic subtest vecs0: SUCCESS (9.498s) [265.496175] Starting dynamic subtest: ccs0 [266.792408] Dynamic subtest ccs0: SUCCESS (1.308s) [266.804262] Starting dynamic subtest: vcs0 [276.487900] Dynamic subtest vcs0: SUCCESS (9.692s) [276.506887] Starting dynamic subtest: bcs0 [277.779191] Dynamic subtest bcs0: SUCCESS (1.289s) [277.791037] Starting dynamic subtest: rcs0 [278.995954] Dynamic subtest rcs0: SUCCESS (1.215s) [279.006735] Starting dynamic subtest: vcs1 [287.496463] Dynamic subtest vcs1: SUCCESS (8.498s) [287.498831] Subtest timeout: SUCCESS (31.511s) [287.574074] [035/133] (733s left) kms_scaling_modes (scaling-mode-full) [287.667191] Starting subtest: scaling-mode-full [287.669376] Starting dynamic subtest: pipe-A-eDP-1 [287.761059] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.094s) [287.773123] Starting dynamic subtest: pipe-B-eDP-1 [288.896006] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.134s) [288.905650] Starting dynamic subtest: pipe-C-eDP-1 [290.070534] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.172s) [290.081254] Starting dynamic subtest: pipe-D-eDP-1 [291.266903] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.195s) [291.269250] Subtest scaling-mode-full: SUCCESS (3.603s) [292.494838] [036/133] (728s left) i915_drm_fdinfo (virtual-busy-idle-all) [292.536083] Starting subtest: virtual-busy-idle-all [292.540854] Subtest virtual-busy-idle-all: SKIP (0.000s) [292.617696] [037/133] (728s left) kms_big_fb (4-tiled-addfb-size-offset-overflow) [292.718449] Starting subtest: 4-tiled-addfb-size-offset-overflow [292.720809] Subtest 4-tiled-addfb-size-offset-overflow: SUCCESS (0.000s) [292.817416] [038/133] (728s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-gtt) [292.918942] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-gtt [292.923272] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [293.013303] [039/133] (728s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-gtt) [293.113781] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-gtt [293.118245] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [293.230247] [040/133] (728s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode) [293.614857] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s) [294.387775] [041/133] (727s left) kms_color (ctm-0-25) [294.474367] Starting subtest: ctm-0-25 [294.476509] Starting dynamic subtest: pipe-A-eDP-1 [297.936770] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.464s) [297.946780] Starting dynamic subtest: pipe-B-eDP-1 [302.139435] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.202s) [302.149553] Starting dynamic subtest: pipe-C-eDP-1 [306.196223] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.056s) [306.205982] Starting dynamic subtest: pipe-D-eDP-1 [310.225812] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.028s) [310.228215] Subtest ctm-0-25: SUCCESS (15.754s) [311.100003] [042/133] (710s left) kms_ccs (ccs-on-another-bo-yf-tiled-ccs) [311.207089] Starting subtest: ccs-on-another-bo-yf-tiled-ccs [311.209361] Starting dynamic subtest: pipe-A-eDP-1 [311.231433] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [311.242239] Starting dynamic subtest: pipe-B-eDP-1 [311.263633] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [311.275032] Starting dynamic subtest: pipe-C-eDP-1 [311.296308] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [311.307857] Starting dynamic subtest: pipe-D-eDP-1 [311.330564] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [311.334956] Subtest ccs-on-another-bo-yf-tiled-ccs: SKIP (0.005s) [313.500516] [043/133] (708s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-plflip-blt) [313.596210] Starting subtest: fbc-1p-primscrn-indfb-plflip-blt [318.155750] Subtest fbc-1p-primscrn-indfb-plflip-blt: SUCCESS (4.565s) [319.314361] [044/133] (702s left) gem_vm_create (create-ext) [319.374522] Starting subtest: create-ext [319.380252] Subtest create-ext: SUCCESS (0.004s) [319.503182] [045/133] (702s left) kms_cursor_legacy (cursor-vs-flip-atomic) [319.615315] Starting subtest: cursor-vs-flip-atomic [349.021873] Subtest cursor-vs-flip-atomic: SUCCESS (29.403s) [349.907466] [046/133] (671s left) kms_content_protection (atomic-hdcp14) [350.058437] Starting subtest: atomic-hdcp14 [350.063127] Subtest atomic-hdcp14: SKIP (0.000s) [350.229879] [047/133] (671s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs-cc) [350.328200] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs-cc [350.330376] Starting dynamic subtest: pipe-A-eDP-1 [350.352502] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [350.363254] Starting dynamic subtest: pipe-B-eDP-1 [350.383390] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [350.392264] Starting dynamic subtest: pipe-C-eDP-1 [350.413257] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [350.421827] Starting dynamic subtest: pipe-D-eDP-1 [350.443353] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [350.447327] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.005s) [352.598985] [048/133] (669s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf) [352.692321] Starting subtest: fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf [352.694736] Starting dynamic subtest: pipe-A-eDP-1 [352.764571] Dynamic subtest pipe-A-eDP-1: SKIP (0.077s) [352.774272] Starting dynamic subtest: pipe-B-eDP-1 [353.944525] Dynamic subtest pipe-B-eDP-1: SKIP (1.177s) [353.949127] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf: SKIP (1.257s) [355.194838] [049/133] (666s left) kms_async_flips (crc-atomic) [355.303276] Starting subtest: crc-atomic [355.690531] Starting dynamic subtest: pipe-A-eDP-1 [358.572803] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.880s) [358.952130] Starting dynamic subtest: pipe-B-eDP-1 [361.878528] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.935s) [362.256470] Starting dynamic subtest: pipe-C-eDP-1 [365.151212] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.905s) [365.516623] Starting dynamic subtest: pipe-D-eDP-1 [368.361382] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.852s) [368.363732] Subtest crc-atomic: SUCCESS (13.057s) [369.587916] [050/133] (652s left) kms_addfb_basic (basic-x-tiled-legacy) [369.652533] Starting subtest: basic-x-tiled-legacy [369.656881] Subtest basic-x-tiled-legacy: SKIP (0.000s) [369.796248] [051/133] (652s left) kms_cursor_legacy (single-bo) [369.914465] Starting subtest: single-bo [369.916292] Starting dynamic subtest: pipe-A [375.295367] Dynamic subtest pipe-A: SUCCESS (5.378s) [375.306087] Starting dynamic subtest: pipe-B [380.676912] Dynamic subtest pipe-B: SUCCESS (5.379s) [380.686015] Starting dynamic subtest: pipe-C [386.059000] Dynamic subtest pipe-C: SUCCESS (5.378s) [386.070188] Starting dynamic subtest: pipe-D [391.441113] Dynamic subtest pipe-D: SUCCESS (5.379s) [391.452601] Starting dynamic subtest: all-pipes [396.828892] Dynamic subtest all-pipes: SUCCESS (5.385s) [396.831567] Subtest single-bo: SUCCESS (26.912s) [396.987606] [052/133] (625s left) syncobj_timeline (wait-all-for-submit-delayed-submit) [397.049375] Starting subtest: wait-all-for-submit-delayed-submit [397.151041] Subtest wait-all-for-submit-delayed-submit: SUCCESS (0.103s) [397.233920] [053/133] (624s left) gem_pipe_control_store_loop (reused-buffer) [397.297493] Starting subtest: reused-buffer [399.450592] Subtest reused-buffer: SUCCESS (2.153s) [399.579858] [054/133] (622s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-mc-ccs) [399.678252] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-mc-ccs [399.680441] Starting dynamic subtest: pipe-A-eDP-1 [401.879513] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.202s) [401.888608] Starting dynamic subtest: pipe-B-eDP-1 [404.093681] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.212s) [404.102826] Starting dynamic subtest: pipe-C-eDP-1 [406.262589] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.168s) [406.272156] Starting dynamic subtest: pipe-D-eDP-1 [408.423589] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.160s) [408.425423] Subtest crc-primary-rotation-180-4-tiled-mtl-mc-ccs: SUCCESS (8.748s) [409.596557] [055/133] (612s left) kms_frontbuffer_tracking (fbcpsr-2p-pri-indfb-multidraw) [409.701310] Starting subtest: fbcpsr-2p-pri-indfb-multidraw [409.705311] Subtest fbcpsr-2p-pri-indfb-multidraw: SKIP (0.000s) [409.783172] [056/133] (612s left) kms_cursor_crc (cursor-rapid-movement-256x85) [410.051725] Starting subtest: cursor-rapid-movement-256x85 [410.098807] Subtest cursor-rapid-movement-256x85: SKIP (0.042s) [410.263205] [057/133] (611s left) gem_exec_schedule (submit-late-slice) [410.345389] Starting subtest: submit-late-slice [410.347382] Starting dynamic subtest: rcs0 [410.372786] Dynamic subtest rcs0: SUCCESS (0.036s) [410.384201] Starting dynamic subtest: bcs0 [410.409725] Dynamic subtest bcs0: SUCCESS (0.036s) [410.419307] Starting dynamic subtest: vcs0 [410.449850] Dynamic subtest vcs0: SUCCESS (0.039s) [410.459279] Starting dynamic subtest: vcs1 [410.479511] Dynamic subtest vcs1: SUCCESS (0.029s) [410.492090] Starting dynamic subtest: vecs0 [410.513947] Dynamic subtest vecs0: SUCCESS (0.034s) [410.526002] Starting dynamic subtest: ccs0 [410.547830] Dynamic subtest ccs0: SUCCESS (0.033s) [410.549728] Subtest submit-late-slice: SUCCESS (0.212s) [411.551371] [058/133] (610s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy) [411.682644] Starting subtest: basic-busy-flip-before-cursor-legacy [411.687270] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s) [411.832612] [059/133] (610s left) kms_big_fb (y-tiled-32bpp-rotate-180) [411.933044] Starting subtest: y-tiled-32bpp-rotate-180 [411.937630] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s) [412.026398] [060/133] (610s left) gem_exec_schedule (u-submit-golden-slice) [412.099929] Starting subtest: u-submit-golden-slice [412.102153] Starting dynamic subtest: rcs0 [412.126210] Dynamic subtest rcs0: SUCCESS (0.033s) [412.136472] Starting dynamic subtest: bcs0 [412.159288] Dynamic subtest bcs0: SUCCESS (0.032s) [412.168890] Starting dynamic subtest: vcs0 [412.189755] Dynamic subtest vcs0: SUCCESS (0.030s) [412.199225] Starting dynamic subtest: vcs1 [412.228332] Dynamic subtest vcs1: SUCCESS (0.038s) [412.237585] Starting dynamic subtest: vecs0 [412.256496] Dynamic subtest vecs0: SUCCESS (0.027s) [412.265837] Starting dynamic subtest: ccs0 [412.285433] Dynamic subtest ccs0: SUCCESS (0.028s) [412.287687] Subtest u-submit-golden-slice: SUCCESS (0.193s) [413.593540] [061/133] (608s left) gem_exec_parallel (userptr) [413.670891] Starting subtest: userptr [413.673374] Starting dynamic subtest: rcs0 [415.194635] Dynamic subtest rcs0: SUCCESS (1.523s) [415.206180] Starting dynamic subtest: bcs0 [416.702067] Dynamic subtest bcs0: SUCCESS (1.505s) [416.714379] Starting dynamic subtest: vcs0 [418.443903] Dynamic subtest vcs0: SUCCESS (1.738s) [418.455650] Starting dynamic subtest: vcs1 [420.491534] Dynamic subtest vcs1: SUCCESS (2.045s) [420.504122] Starting dynamic subtest: vecs0 [422.475585] Dynamic subtest vecs0: SUCCESS (1.982s) [422.486452] Starting dynamic subtest: ccs0 [423.949831] Dynamic subtest ccs0: SUCCESS (1.474s) [423.952244] Subtest userptr: SUCCESS (10.280s) [424.137059] [062/133] (598s left) gem_tiled_partial_pwrite_pread (writes-after-reads) [424.192438] Subtest writes-after-reads: SKIP (0.000s) [424.259882] [063/133] (598s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite) [424.359439] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite [424.363346] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [424.453623] [064/133] (598s left) kms_getfb (getfb2-handle-protection) [424.554565] Starting subtest: getfb2-handle-protection [424.579755] Subtest getfb2-handle-protection: SUCCESS (0.027s) [424.711983] [065/133] (597s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt) [424.807332] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt [424.811261] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [424.919942] [066/133] (597s left) gem_gpgpu_fill (basic) [424.973699] Starting subtest: basic [424.976028] Starting dynamic subtest: smem [424.981714] Dynamic subtest smem: SUCCESS (0.008s) [424.983839] Subtest basic: SUCCESS (0.009s) [425.122063] [067/133] (597s left) kms_big_fb (linear-16bpp-rotate-270) [425.218121] Starting subtest: linear-16bpp-rotate-270 [425.240398] Subtest linear-16bpp-rotate-270: SKIP (0.022s) [425.367009] [068/133] (597s left) gem_ctx_sseu (engines) [425.417859] Subtest engines: SKIP (0.000s) [425.498474] [069/133] (597s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling) [425.592449] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling [425.594201] Starting dynamic subtest: pipe-A-default-mode [428.280853] Dynamic subtest pipe-A-default-mode: SUCCESS (2.687s) [428.283214] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SUCCESS (2.689s) [429.086701] [070/133] (593s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt) [429.181964] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt [436.445056] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.265s) [436.593903] [071/133] (586s left) kms_chamelium_frames (hdmi-crc-multiple) [436.987085] Subtest hdmi-crc-multiple: SKIP (0.000s) [437.773564] [072/133] (585s left) syncobj_wait (invalid-signal-illegal-handle) [437.828698] Starting subtest: invalid-signal-illegal-handle [437.830655] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s) [437.941659] [073/133] (584s left) gem_ctx_persistence (heartbeat-hang) [437.998839] Starting subtest: heartbeat-hang [438.003491] Subtest heartbeat-hang: SKIP (0.000s) [438.117815] [074/133] (584s left) perf_pmu (render-node-busy) [438.204784] Starting subtest: render-node-busy [438.207289] Starting dynamic subtest: rcs0 [438.790208] Dynamic subtest rcs0: SUCCESS (0.587s) [438.803749] Starting dynamic subtest: bcs0 [439.356510] Dynamic subtest bcs0: SUCCESS (0.564s) [439.369957] Starting dynamic subtest: vcs0 [440.459861] Dynamic subtest vcs0: SUCCESS (1.100s) [440.472673] Starting dynamic subtest: vcs1 [442.508549] Dynamic subtest vcs1: SUCCESS (2.045s) [442.523018] Starting dynamic subtest: vecs0 [444.492644] Dynamic subtest vecs0: SUCCESS (1.981s) [444.505794] Starting dynamic subtest: ccs0 [445.061726] Dynamic subtest ccs0: SUCCESS (0.567s) [445.064357] Subtest render-node-busy: SUCCESS (6.861s) [445.140263] [075/133] (577s left) gem_ctx_engines (execute-one) [445.200668] Starting subtest: execute-one [448.654679] Subtest execute-one: SUCCESS (3.454s) [448.848743] [076/133] (574s left) syncobj_timeline (invalid-query-zero-handles) [448.906282] Starting subtest: invalid-query-zero-handles [448.908676] Subtest invalid-query-zero-handles: SUCCESS (0.000s) [449.011552] [077/133] (574s left) gem_ccs (block-multicopy-inplace) [449.077740] Starting subtest: block-multicopy-inplace [449.082183] Subtest block-multicopy-inplace: SKIP (0.000s) [449.208512] [078/133] (573s left) gem_partial_pwrite_pread (write) [449.273776] Subtest write: SKIP (0.000s) [449.350032] [079/133] (573s left) kms_pipe_crc_basic (bad-source) [449.450065] Starting subtest: bad-source [449.452046] Subtest bad-source: SUCCESS (0.000s) [449.541061] [080/133] (573s left) core_setmaster (master-drop-set-root) [449.603467] Starting subtest: master-drop-set-root [449.616654] Subtest master-drop-set-root: SUCCESS (0.013s) [449.668726] [081/133] (573s left) kms_cursor_crc (cursor-sliding-512x170) [449.942447] Starting subtest: cursor-sliding-512x170 [449.946233] Subtest cursor-sliding-512x170: SKIP (0.001s) [450.091721] [082/133] (573s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs) [450.182616] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs [450.184454] Starting dynamic subtest: pipe-A-eDP-1 [450.205471] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [450.217992] Starting dynamic subtest: pipe-B-eDP-1 [450.237510] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [450.247197] Starting dynamic subtest: pipe-C-eDP-1 [450.266572] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [450.275536] Starting dynamic subtest: pipe-D-eDP-1 [450.295899] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [450.299570] Subtest random-ccs-data-y-tiled-gen12-rc-ccs: SKIP (0.004s) [452.380995] [083/133] (570s left) kms_frontbuffer_tracking (pipe-fbc-rte) [452.478429] Starting subtest: pipe-fbc-rte [452.484988] Starting dynamic subtest: pipe-B-eDP-1 [457.891203] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.415s) [457.899324] Subtest pipe-fbc-rte: SUCCESS (5.417s) [460.178800] [084/133] (563s left) kms_psr (fbc-psr-cursor-plane-move) [460.271533] Starting subtest: fbc-psr-cursor-plane-move [460.273714] Starting dynamic subtest: eDP-1 [460.278040] Dynamic subtest eDP-1: SKIP (0.000s) [460.282330] Subtest fbc-psr-cursor-plane-move: SKIP (0.001s) [460.362372] [085/133] (563s left) kms_cursor_crc (cursor-offscreen-32x32) [460.518063] Starting subtest: cursor-offscreen-32x32 [460.566653] Subtest cursor-offscreen-32x32: SKIP (0.044s) [460.841431] [086/133] (562s left) gem_mmap_gtt (cpuset-medium-copy) [460.894136] Subtest cpuset-medium-copy: SKIP (0.000s) [460.966426] [087/133] (562s left) syncobj_timeline (etime-single-wait-available-unsubmitted) [461.028541] Starting subtest: etime-single-wait-available-unsubmitted [461.136604] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.107s) [461.214499] [088/133] (562s left) core_setmaster_vs_auth [461.388628] [089/133] (562s left) api_intel_bb (misplaced-blitter) [461.450778] Starting subtest: misplaced-blitter [461.455873] Subtest misplaced-blitter: SUCCESS (0.007s) [461.585268] [090/133] (562s left) kms_psr (psr-basic) [461.675126] Starting subtest: psr-basic [461.677269] Starting dynamic subtest: eDP-1 [463.346038] Dynamic subtest eDP-1: SUCCESS (1.668s) [463.348377] Subtest psr-basic: SUCCESS (1.669s) [464.180217] [091/133] (559s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc) [464.293211] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc [464.297482] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [464.402244] [092/133] (559s left) gem_basic (bad-close) [464.445900] Starting subtest: bad-close [464.450294] Subtest bad-close: SUCCESS (0.000s) [464.547702] [093/133] (559s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-onoff) [464.655191] Starting subtest: fbc-2p-scndscrn-spr-indfb-onoff [464.659241] Subtest fbc-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s) [464.773811] [094/133] (559s left) prime_mmap (test_errors) [464.823312] Starting subtest: test_errors [464.825189] Starting dynamic subtest: test_errors-smem [464.925763] Dynamic subtest test_errors-smem: SUCCESS (0.104s) [464.928304] Subtest test_errors: SUCCESS (0.105s) [465.031008] [095/133] (558s left) prime_self_import (basic-llseek-size) [465.076691] Starting subtest: basic-llseek-size [465.096583] Subtest basic-llseek-size: SUCCESS (0.022s) [465.204575] [096/133] (558s left) syncobj_wait (single-wait-signaled) [465.253911] Starting subtest: single-wait-signaled [465.256090] Subtest single-wait-signaled: SUCCESS (0.000s) [465.341044] [097/133] (558s left) i915_drm_fdinfo (most-busy-check-all) [465.398395] Starting subtest: most-busy-check-all [465.400516] Starting dynamic subtest: rcs0 [465.404847] Dynamic subtest rcs0: SKIP (0.004s) [465.415103] Starting dynamic subtest: bcs0 [465.419290] Dynamic subtest bcs0: SKIP (0.000s) [465.428437] Starting dynamic subtest: vcs0 [465.432715] Dynamic subtest vcs0: SKIP (0.000s) [465.442222] Starting dynamic subtest: vcs1 [465.446287] Dynamic subtest vcs1: SKIP (0.000s) [465.455754] Starting dynamic subtest: vecs0 [465.459895] Dynamic subtest vecs0: SKIP (0.000s) [465.469878] Starting dynamic subtest: ccs0 [465.473907] Dynamic subtest ccs0: SKIP (0.000s) [465.477939] Subtest most-busy-check-all: SKIP (0.009s) [465.516344] [098/133] (558s left) perf (short-reads) [465.651426] Starting subtest: short-reads [465.665352] Subtest short-reads: SUCCESS (0.016s) [465.717278] [099/133] (558s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-onoff) [465.834811] Starting subtest: psr-2p-scndscrn-cur-indfb-onoff [465.839222] Subtest psr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s) [465.962313] [100/133] (558s left) gem_spin_batch (resubmit-new-all) [466.032418] Starting subtest: resubmit-new-all [466.034405] Starting dynamic subtest: rcs0 [466.053104] Dynamic subtest rcs0: SUCCESS (0.020s) [466.063846] Starting dynamic subtest: bcs0 [466.065642] Dynamic subtest bcs0: SUCCESS (0.010s) [466.077905] Starting dynamic subtest: vcs0 [466.079682] Dynamic subtest vcs0: SUCCESS (0.009s) [466.089215] Starting dynamic subtest: vcs1 [466.090771] Dynamic subtest vcs1: SUCCESS (0.008s) [466.100807] Starting dynamic subtest: vecs0 [466.102627] Dynamic subtest vecs0: SUCCESS (0.011s) [466.112378] Starting dynamic subtest: ccs0 [466.113983] Dynamic subtest ccs0: SUCCESS (0.010s) [466.115630] Subtest resubmit-new-all: SUCCESS (0.076s) [467.525974] [101/133] (556s left) kms_dp_link_training (uhbr-sst) [467.611211] Starting subtest: uhbr-sst [467.619406] Subtest uhbr-sst: SKIP (0.000s) [467.684770] [102/133] (556s left) gem_userptr_blits (create-destroy-sync) [467.767045] Starting subtest: create-destroy-sync [472.778786] Subtest create-destroy-sync: SUCCESS (5.010s) [472.920566] [103/133] (551s left) kms_addfb_basic (no-handle) [472.966664] Starting subtest: no-handle [472.969228] Subtest no-handle: SUCCESS (0.000s) [473.118363] [104/133] (551s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt) [473.226646] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt [480.642460] Subtest psr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.417s) [480.772076] [105/133] (543s left) gem_exec_reloc (basic-wc-gtt-active) [480.838453] Subtest basic-wc-gtt-active: SKIP (0.000s) [480.917034] [106/133] (543s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf) [481.010949] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf [481.013207] Starting dynamic subtest: pipe-A-eDP-1 [481.106895] Dynamic subtest pipe-A-eDP-1: SKIP (0.100s) [481.118737] Starting dynamic subtest: pipe-B-eDP-1 [482.232695] Dynamic subtest pipe-B-eDP-1: SKIP (1.123s) [482.236924] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (1.225s) [483.487307] [107/133] (540s left) api_intel_bb (blit-noreloc-purge-cache) [483.540732] Starting subtest: blit-noreloc-purge-cache [483.548650] Subtest blit-noreloc-purge-cache: SUCCESS (0.011s) [483.674396] [108/133] (540s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-cpu) [483.770545] Starting subtest: fbc-rgb565-draw-mmap-cpu [487.774821] Subtest fbc-rgb565-draw-mmap-cpu: SUCCESS (4.008s) [488.904107] [109/133] (535s left) kms_pm_dc (dc5-psr) [490.025335] Starting subtest: dc5-psr [492.910982] Subtest dc5-psr: SUCCESS (2.884s) [493.781606] [110/133] (530s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-cpu) [493.885580] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-cpu [493.889770] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [493.972039] [111/133] (530s left) gem_ctx_param (invalid-set-ringsize) [494.022984] Starting subtest: invalid-set-ringsize [494.025389] Subtest invalid-set-ringsize: SUCCESS (0.000s) [494.111002] [112/133] (530s left) kms_vrr (flip-suspend) [494.201422] Starting subtest: flip-suspend [494.207904] Subtest flip-suspend: SKIP (0.000s) [494.275388] [113/133] (530s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc) [494.372519] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc [494.374868] Starting dynamic subtest: pipe-A-eDP-1 [494.915570] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.519s) [494.926682] Starting dynamic subtest: pipe-B-eDP-1 [496.373883] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.453s) [496.388052] Starting dynamic subtest: pipe-C-eDP-1 [497.736781] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.363s) [497.749161] Starting dynamic subtest: pipe-D-eDP-1 [499.168064] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.431s) [499.170014] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc: SUCCESS (4.771s) [500.394928] [114/133] (524s left) kms_plane_scaling (plane-downscale-factor-0-5-with-rotation) [500.494301] Starting subtest: plane-downscale-factor-0-5-with-rotation [500.496576] Starting dynamic subtest: pipe-A [500.515348] Dynamic subtest pipe-A: SKIP (0.017s) [500.526187] Starting dynamic subtest: pipe-B [500.546215] Dynamic subtest pipe-B: SKIP (0.031s) [500.556263] Starting dynamic subtest: pipe-C [500.575721] Dynamic subtest pipe-C: SKIP (0.030s) [500.585688] Starting dynamic subtest: pipe-D [500.607905] Dynamic subtest pipe-D: SKIP (0.030s) [500.611513] Subtest plane-downscale-factor-0-5-with-rotation: SKIP (0.110s) [500.716402] [115/133] (524s left) syncobj_wait (multi-wait-for-submit-submitted-signaled) [500.772065] Starting subtest: multi-wait-for-submit-submitted-signaled [500.774369] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.000s) [500.882517] [116/133] (523s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip) [500.980717] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip [501.594296] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.615s) [501.770928] [117/133] (523s left) gem_exec_balancer (bonded-false-hang) [502.033709] Starting subtest: bonded-false-hang [502.038347] Subtest bonded-false-hang: SKIP (0.000s) [502.147081] [118/133] (522s left) gen9_exec_parse (bb-secure) [502.221738] Subtest bb-secure: SKIP (0.000s) [502.301283] [119/133] (522s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180) [502.402729] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180 [502.407119] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s) [502.506528] [120/133] (522s left) kms_flip (blocking-absolute-wf_vblank) [502.602267] Starting subtest: blocking-absolute-wf_vblank [502.604573] Starting dynamic subtest: A-eDP1 [511.307065] Dynamic subtest A-eDP1: SUCCESS (8.705s) [511.326714] Starting dynamic subtest: B-eDP1 [520.106039] Dynamic subtest B-eDP1: SUCCESS (8.796s) [520.116856] Starting dynamic subtest: C-eDP1 [528.797719] Dynamic subtest C-eDP1: SUCCESS (8.688s) [528.809502] Starting dynamic subtest: D-eDP1 [537.499033] Dynamic subtest D-eDP1: SUCCESS (8.700s) [537.504224] Subtest blocking-absolute-wf_vblank: SUCCESS (34.903s) [538.676868] [121/133] (486s left) kms_addfb_basic (bo-too-small-due-to-tiling) [538.775914] Starting subtest: bo-too-small-due-to-tiling [538.780251] Subtest bo-too-small-due-to-tiling: SKIP (0.000s) [538.877594] [122/133] (486s left) gem_exec_params (sol-reset-not-gen7) [538.932744] Starting subtest: sol-reset-not-gen7 [538.935207] Subtest sol-reset-not-gen7: SUCCESS (0.003s) [539.074617] [123/133] (486s left) kms_plane_cursor (viewport) [539.168610] Starting subtest: viewport [539.173075] Starting dynamic subtest: pipe-A-eDP-1-size-64 [541.713191] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.544s) [541.774802] Starting dynamic subtest: pipe-A-eDP-1-size-128 [544.313844] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.549s) [544.377952] Starting dynamic subtest: pipe-A-eDP-1-size-256 [546.938136] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.571s) [547.287330] Starting dynamic subtest: pipe-B-eDP-1-size-64 [550.468591] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.192s) [550.530853] Starting dynamic subtest: pipe-B-eDP-1-size-128 [553.003396] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.482s) [553.064698] Starting dynamic subtest: pipe-B-eDP-1-size-256 [555.627079] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.571s) [555.976904] Starting dynamic subtest: pipe-C-eDP-1-size-64 [558.822919] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.858s) [558.869237] Starting dynamic subtest: pipe-C-eDP-1-size-128 [561.045541] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.191s) [561.084577] Starting dynamic subtest: pipe-C-eDP-1-size-256 [563.256269] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.180s) [563.593246] Starting dynamic subtest: pipe-D-eDP-1-size-64 [566.414855] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.831s) [566.452837] Starting dynamic subtest: pipe-D-eDP-1-size-128 [568.626105] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.180s) [568.664675] Starting dynamic subtest: pipe-D-eDP-1-size-256 [570.791610] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.136s) [571.107797] Subtest viewport: SUCCESS (31.939s) [571.977956] [124/133] (453s left) prime_vgem (coherency-gtt) [572.062446] Starting subtest: coherency-gtt [572.066619] Subtest coherency-gtt: SKIP (0.000s) [572.157016] [125/133] (453s left) kms_vrr (flip-basic) [572.259891] Starting subtest: flip-basic [572.266220] Subtest flip-basic: SKIP (0.000s) [572.332612] [126/133] (452s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-factor-0-25) [572.423888] Starting subtest: planes-downscale-factor-0-75-upscale-factor-0-25 [572.426699] Starting dynamic subtest: pipe-A [572.488973] Dynamic subtest pipe-A: SUCCESS (0.066s) [572.501964] Starting dynamic subtest: pipe-B [573.672236] Dynamic subtest pipe-B: SUCCESS (1.183s) [573.683227] Starting dynamic subtest: pipe-C [574.838963] Dynamic subtest pipe-C: SUCCESS (1.166s) [574.848895] Starting dynamic subtest: pipe-D [575.938484] Dynamic subtest pipe-D: SUCCESS (1.098s) [575.940810] Subtest planes-downscale-factor-0-75-upscale-factor-0-25: SUCCESS (3.517s) [577.071597] [127/133] (448s left) gem_exec_flush (basic-batch-kernel-default-wb) [577.135747] Starting subtest: basic-batch-kernel-default-wb [584.123706] Subtest basic-batch-kernel-default-wb: SUCCESS (6.988s) [584.316741] [128/133] (441s left) kms_frontbuffer_tracking (fbcpsr-slowdraw) [584.416486] Starting subtest: fbcpsr-slowdraw [609.601261] Subtest fbcpsr-slowdraw: SUCCESS (25.185s) [609.731667] [129/133] (415s left) gem_pwrite (basic-random) [609.798342] Subtest basic-random: SKIP (0.000s) [609.880647] [130/133] (415s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt) [609.981071] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt [609.985436] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [610.087305] [131/133] (415s left) syncobj_eventfd (invalid-bad-pad) [610.148325] Starting subtest: invalid-bad-pad [610.150602] Subtest invalid-bad-pad: SUCCESS (0.000s) [610.252401] [132/133] (415s left) syncobj_wait (wait-any-interrupted) [610.312685] Starting subtest: wait-any-interrupted [610.413995] Subtest wait-any-interrupted: SUCCESS (0.102s) [610.490075] [133/133] (415s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt) [610.582160] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt [610.585468] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [610.684728] Closing watchdogs results: parsing output: 0/ for test: gem_exec_balancer results: parsing output: 1/ for test: sriov_basic results: parsing output: 2/ for test: i915_pm_rpm results: parsing output: 3/ for test: prime_vgem results: parsing output: 4/ for test: kms_big_fb results: parsing output: 5/ for test: kms_cursor_legacy results: parsing output: 6/ for test: gem_exec_schedule results: parsing output: 7/ for test: gem_mmap_gtt results: parsing output: 8/ for test: kms_prop_blob results: parsing output: 9/ for test: gem_mmap_offset results: parsing output: 10/ for test: kms_hdmi_inject results: parsing output: 11/ for test: kms_cursor_legacy results: parsing output: 12/ for test: gem_madvise results: parsing output: 13/ for test: gem_pxp results: parsing output: 14/ for test: kms_busy results: parsing output: 15/ for test: kms_psr results: parsing output: 16/ for test: kms_invalid_mode results: parsing output: 17/ for test: kms_flip_scaled_crc results: parsing output: 18/ for test: kms_flip results: parsing output: 19/ for test: kms_psr results: parsing output: 20/ for test: kms_fbcon_fbt results: parsing output: 21/ for test: gem_exec_fence results: parsing output: 22/ for test: i915_suspend results: parsing output: 23/ for test: kms_frontbuffer_tracking results: parsing output: 24/ for test: gem_render_copy results: parsing output: 25/ for test: kms_plane results: parsing output: 26/ for test: kms_psr results: parsing output: 27/ for test: kms_lease results: parsing output: 28/ for test: kms_flip results: parsing output: 29/ for test: kms_flip results: parsing output: 30/ for test: kms_plane_alpha_blend results: parsing output: 31/ for test: syncobj_timeline results: parsing output: 32/ for test: kms_sequence results: parsing output: 33/ for test: sysfs_preempt_timeout results: parsing output: 34/ for test: kms_scaling_modes results: parsing output: 35/ for test: i915_drm_fdinfo results: parsing output: 36/ for test: kms_big_fb results: parsing output: 37/ for test: kms_frontbuffer_tracking results: parsing output: 38/ for test: kms_frontbuffer_tracking results: parsing output: 39/ for test: kms_chamelium_hpd results: parsing output: 40/ for test: kms_color results: parsing output: 41/ for test: kms_ccs results: parsing output: 42/ for test: kms_frontbuffer_tracking results: parsing output: 43/ for test: gem_vm_create results: parsing output: 44/ for test: kms_cursor_legacy results: parsing output: 45/ for test: kms_content_protection results: parsing output: 46/ for test: kms_ccs results: parsing output: 47/ for test: kms_psr2_sf results: parsing output: 48/ for test: kms_async_flips results: parsing output: 49/ for test: kms_addfb_basic results: parsing output: 50/ for test: kms_cursor_legacy results: parsing output: 51/ for test: syncobj_timeline results: parsing output: 52/ for test: gem_pipe_control_store_loop results: parsing output: 53/ for test: kms_ccs results: parsing output: 54/ for test: kms_frontbuffer_tracking results: parsing output: 55/ for test: kms_cursor_crc results: parsing output: 56/ for test: gem_exec_schedule results: parsing output: 57/ for test: kms_cursor_legacy results: parsing output: 58/ for test: kms_big_fb results: parsing output: 59/ for test: gem_exec_schedule results: parsing output: 60/ for test: gem_exec_parallel results: parsing output: 61/ for test: gem_tiled_partial_pwrite_pread results: parsing output: 62/ for test: kms_frontbuffer_tracking results: parsing output: 63/ for test: kms_getfb results: parsing output: 64/ for test: kms_frontbuffer_tracking results: parsing output: 65/ for test: gem_gpgpu_fill results: parsing output: 66/ for test: kms_big_fb results: parsing output: 67/ for test: gem_ctx_sseu results: parsing output: 68/ for test: kms_flip_scaled_crc results: parsing output: 69/ for test: kms_frontbuffer_tracking results: parsing output: 70/ for test: kms_chamelium_frames results: parsing output: 71/ for test: syncobj_wait results: parsing output: 72/ for test: gem_ctx_persistence results: parsing output: 73/ for test: perf_pmu results: parsing output: 74/ for test: gem_ctx_engines results: parsing output: 75/ for test: syncobj_timeline results: parsing output: 76/ for test: gem_ccs results: parsing output: 77/ for test: gem_partial_pwrite_pread results: parsing output: 78/ for test: kms_pipe_crc_basic results: parsing output: 79/ for test: core_setmaster results: parsing output: 80/ for test: kms_cursor_crc results: parsing output: 81/ for test: kms_ccs results: parsing output: 82/ for test: kms_frontbuffer_tracking results: parsing output: 83/ for test: kms_psr results: parsing output: 84/ for test: kms_cursor_crc results: parsing output: 85/ for test: gem_mmap_gtt results: parsing output: 86/ for test: syncobj_timeline results: parsing output: 87/ for test: core_setmaster_vs_auth results: parsing output: 88/ for test: api_intel_bb results: parsing output: 89/ for test: kms_psr results: parsing output: 90/ for test: kms_frontbuffer_tracking results: parsing output: 91/ for test: gem_basic results: parsing output: 92/ for test: kms_frontbuffer_tracking results: parsing output: 93/ for test: prime_mmap results: parsing output: 94/ for test: prime_self_import results: parsing output: 95/ for test: syncobj_wait results: parsing output: 96/ for test: i915_drm_fdinfo results: parsing output: 97/ for test: perf results: parsing output: 98/ for test: kms_frontbuffer_tracking results: parsing output: 99/ for test: gem_spin_batch results: parsing output: 100/ for test: kms_dp_link_training results: parsing output: 101/ for test: gem_userptr_blits results: parsing output: 102/ for test: kms_addfb_basic results: parsing output: 103/ for test: kms_frontbuffer_tracking results: parsing output: 104/ for test: gem_exec_reloc results: parsing output: 105/ for test: kms_psr2_sf results: parsing output: 106/ for test: api_intel_bb results: parsing output: 107/ for test: kms_frontbuffer_tracking results: parsing output: 108/ for test: kms_pm_dc results: parsing output: 109/ for test: kms_frontbuffer_tracking results: parsing output: 110/ for test: gem_ctx_param results: parsing output: 111/ for test: kms_vrr results: parsing output: 112/ for test: kms_ccs results: parsing output: 113/ for test: kms_plane_scaling results: parsing output: 114/ for test: syncobj_wait results: parsing output: 115/ for test: kms_big_fb results: parsing output: 116/ for test: gem_exec_balancer results: parsing output: 117/ for test: gen9_exec_parse results: parsing output: 118/ for test: kms_big_fb results: parsing output: 119/ for test: kms_flip results: parsing output: 120/ for test: kms_addfb_basic results: parsing output: 121/ for test: gem_exec_params results: parsing output: 122/ for test: kms_plane_cursor results: parsing output: 123/ for test: prime_vgem results: parsing output: 124/ for test: kms_vrr results: parsing output: 125/ for test: kms_plane_scaling results: parsing output: 126/ for test: gem_exec_flush results: parsing output: 127/ for test: kms_frontbuffer_tracking results: parsing output: 128/ for test: gem_pwrite results: parsing output: 129/ for test: kms_frontbuffer_tracking results: parsing output: 130/ for test: syncobj_eventfd results: parsing output: 131/ for test: syncobj_wait results: parsing output: 132/ for test: kms_frontbuffer_tracking Done.