[61.469369] Initializing watchdogs [61.469416] /dev/watchdog0 [61.483032] [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] [61.487293] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [61.489614] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [61.492907] [001/133] (960s left) gem_exec_balancer (parallel-keep-submit-fence) [61.775425] Starting subtest: parallel-keep-submit-fence [62.875420] Subtest parallel-keep-submit-fence: SUCCESS (1.102s) [63.003423] [002/133] (959s left) sriov_basic (enable-vfs-autoprobe-off) [63.058948] Starting subtest: enable-vfs-autoprobe-off [63.061209] Starting dynamic subtest: numvfs-1 [63.140581] Dynamic subtest numvfs-1: FAIL (0.036s) [63.146883] Starting dynamic subtest: numvfs-2 [63.218026] Dynamic subtest numvfs-2: FAIL (0.004s) [63.225701] Starting dynamic subtest: numvfs-3 [63.294661] Dynamic subtest numvfs-3: FAIL (0.004s) [63.301594] Starting dynamic subtest: numvfs-4 [63.370167] Dynamic subtest numvfs-4: FAIL (0.007s) [63.377568] Starting dynamic subtest: numvfs-5 [63.446067] Dynamic subtest numvfs-5: FAIL (0.004s) [63.453264] Starting dynamic subtest: numvfs-6 [63.521588] Dynamic subtest numvfs-6: FAIL (0.004s) [63.528545] Starting dynamic subtest: numvfs-7 [63.597983] Dynamic subtest numvfs-7: FAIL (0.003s) [63.605273] Starting dynamic subtest: numvfs-random [63.675731] Dynamic subtest numvfs-random: FAIL (0.004s) [63.683727] Starting dynamic subtest: numvfs-all [63.755224] Dynamic subtest numvfs-all: FAIL (0.004s) [63.757220] Subtest enable-vfs-autoprobe-off: FAIL (0.071s) [63.793734] [003/133] (958s left) i915_pm_rpm (system-suspend) [66.140749] Starting subtest: system-suspend [84.231668] Subtest system-suspend: SUCCESS (3.258s) [84.611921] [004/133] (937s left) prime_vgem (fence-flip-hang) [84.728881] Subtest fence-flip-hang: SKIP (0.000s) [84.828287] [FACT prime_vgem (fence-flip-hang)] new: kernel.kmod_is_loaded.vgem: true [84.831010] [005/133] (937s left) kms_big_fb (x-tiled-32bpp-rotate-180) [84.931681] Starting subtest: x-tiled-32bpp-rotate-180 [86.228295] Subtest x-tiled-32bpp-rotate-180: SUCCESS (1.311s) [86.387087] [006/133] (935s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions) [86.510831] Starting subtest: cursor-vs-flip-atomic-transitions [116.336565] Subtest cursor-vs-flip-atomic-transitions: SUCCESS (29.900s) [117.148004] [007/133] (905s left) gem_exec_schedule (pi-userfault) [117.345029] Starting subtest: pi-userfault [117.347253] Starting dynamic subtest: rcs0 [117.353093] Dynamic subtest rcs0: SUCCESS (0.013s) [117.363937] Starting dynamic subtest: bcs0 [117.366207] Dynamic subtest bcs0: SUCCESS (0.008s) [117.374578] Starting dynamic subtest: vcs0 [117.376411] Dynamic subtest vcs0: SUCCESS (0.008s) [117.385163] Starting dynamic subtest: vcs1 [117.387343] Dynamic subtest vcs1: SUCCESS (0.011s) [117.395753] Starting dynamic subtest: vecs0 [117.397749] Dynamic subtest vecs0: SUCCESS (0.008s) [117.405699] Starting dynamic subtest: ccs0 [117.407873] Dynamic subtest ccs0: SUCCESS (0.008s) [117.410094] Subtest pi-userfault: SUCCESS (0.058s) [117.589351] [008/133] (904s left) gem_mmap_gtt (basic-write-read-distinct) [117.642409] Subtest basic-write-read-distinct: SKIP (0.000s) [117.699578] [009/133] (904s left) kms_prop_blob (basic) [117.747400] Starting subtest: basic [117.749673] Subtest basic: SUCCESS (0.000s) [117.842523] [010/133] (904s left) gem_mmap_offset (mmap-boundaries) [117.892224] Starting subtest: mmap-boundaries [117.894253] Starting dynamic subtest: smem0 [118.172190] Dynamic subtest smem0: SUCCESS (0.282s) [118.174723] Subtest mmap-boundaries: SUCCESS (0.282s) [118.275347] [011/133] (904s left) kms_hdmi_inject (inject-4k) [118.622026] Starting subtest: inject-4k [118.938614] Subtest inject-4k: SUCCESS (0.319s) [119.503094] [012/133] (902s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions) [119.628037] Starting subtest: flip-vs-cursor-atomic-transitions [127.127934] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (7.497s) [127.961408] [013/133] (894s left) gem_madvise (dontneed-before-mmap) [128.000782] Starting subtest: dontneed-before-mmap [128.022044] Subtest dontneed-before-mmap: SUCCESS (0.022s) [128.123508] [014/133] (894s left) gem_pxp (hw-rejects-pxp-context) [128.248427] Starting subtest: hw-rejects-pxp-context [128.253068] Subtest hw-rejects-pxp-context: SKIP (0.000s) [128.375073] [015/133] (894s left) kms_busy (basic-hang) [128.472450] Starting subtest: basic-hang [128.474812] Starting dynamic subtest: flip-pipe-A [129.056756] Dynamic subtest flip-pipe-A: SUCCESS (0.584s) [129.067015] Starting dynamic subtest: modeset-pipe-A [132.393998] Dynamic subtest modeset-pipe-A: SUCCESS (3.339s) [132.405535] Starting dynamic subtest: flip-pipe-D [133.670403] Dynamic subtest flip-pipe-D: SUCCESS (1.274s) [133.680265] Starting dynamic subtest: modeset-pipe-D [137.006818] Dynamic subtest modeset-pipe-D: SUCCESS (3.336s) [137.009230] Subtest basic-hang: SUCCESS (8.537s) [137.867651] [016/133] (884s left) kms_psr (fbc-psr2-primary-page-flip) [137.964348] Starting subtest: fbc-psr2-primary-page-flip [137.966500] Starting dynamic subtest: eDP-1 [137.970733] Dynamic subtest eDP-1: SKIP (0.000s) [137.975090] Subtest fbc-psr2-primary-page-flip: SKIP (0.001s) [138.034205] [017/133] (884s left) kms_invalid_mode (clock-too-high) [138.128662] Starting subtest: clock-too-high [138.130946] Starting dynamic subtest: pipe-A-eDP-1 [138.135274] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [138.143614] Starting dynamic subtest: pipe-B-eDP-1 [138.147645] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [138.155779] Starting dynamic subtest: pipe-C-eDP-1 [138.160064] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [138.168119] Starting dynamic subtest: pipe-D-eDP-1 [138.172615] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [138.176987] Subtest clock-too-high: SKIP (0.003s) [138.213688] [018/133] (884s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-downscaling) [138.306227] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-downscaling [138.308521] Starting dynamic subtest: pipe-A-default-mode [139.491456] Dynamic subtest pipe-A-default-mode: SKIP (1.184s) [139.495855] Subtest flip-32bpp-4tile-to-64bpp-4tile-downscaling: SKIP (1.185s) [139.647728] [019/133] (883s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset) [139.746750] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset [139.748954] Starting dynamic subtest: A-eDP1 [143.397523] Dynamic subtest A-eDP1: SUCCESS (3.650s) [143.407541] Starting dynamic subtest: B-eDP1 [146.681418] Dynamic subtest B-eDP1: SUCCESS (3.284s) [146.691677] Starting dynamic subtest: C-eDP1 [149.991012] Dynamic subtest C-eDP1: SUCCESS (3.309s) [150.001048] Starting dynamic subtest: D-eDP1 [153.281457] Dynamic subtest D-eDP1: SUCCESS (3.294s) [153.283801] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (13.545s) [154.154730] [020/133] (868s left) kms_psr (fbc-pr-cursor-blt) [154.267693] Starting subtest: fbc-pr-cursor-blt [154.272444] Subtest fbc-pr-cursor-blt: SKIP (0.000s) [154.347941] [021/133] (868s left) kms_fbcon_fbt (fbc) [154.430254] Starting subtest: fbc [161.976703] Subtest fbc: SUCCESS (7.546s) [163.138279] [022/133] (859s left) gem_exec_fence (syncobj-stationary-timeline-chain-engines) [163.781381] Starting subtest: syncobj-stationary-timeline-chain-engines [163.891811] Subtest syncobj-stationary-timeline-chain-engines: SUCCESS (0.114s) [164.875161] [023/133] (858s left) i915_suspend (sysfs-reader) [164.927255] Starting subtest: sysfs-reader [183.415061] Subtest sysfs-reader: SUCCESS (3.936s) [183.494192] [024/133] (839s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc) [183.595733] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc [187.589479] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (4.032s) [188.724657] [025/133] (834s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs) [188.784291] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs [188.789441] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SKIP (0.000s) [188.970458] [026/133] (834s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping) [189.056333] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping [189.061431] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier-source-clamping: SKIP (0.000s) [189.130238] [027/133] (833s left) kms_psr (pr-sprite-render) [189.226214] Starting subtest: pr-sprite-render [189.231417] Subtest pr-sprite-render: SKIP (0.000s) [189.301041] [028/133] (833s left) kms_lease (lease-uevent) [189.388490] Starting subtest: lease-uevent [190.398506] Subtest lease-uevent: SUCCESS (1.015s) [190.477433] [029/133] (832s left) kms_flip (flip-vs-panning-interruptible) [190.582797] Starting subtest: flip-vs-panning-interruptible [190.585345] Starting dynamic subtest: A-eDP1 [199.282946] Dynamic subtest A-eDP1: SUCCESS (8.725s) [199.294993] Starting dynamic subtest: B-eDP1 [207.950135] Dynamic subtest B-eDP1: SUCCESS (8.677s) [207.959222] Starting dynamic subtest: C-eDP1 [216.630455] Dynamic subtest C-eDP1: SUCCESS (8.683s) [216.642018] Starting dynamic subtest: D-eDP1 [225.341103] Dynamic subtest D-eDP1: SUCCESS (8.702s) [225.345693] Subtest flip-vs-panning-interruptible: SUCCESS (34.798s) [226.578131] [030/133] (796s left) kms_flip (dpms-vs-vblank-race) [226.669988] Starting subtest: dpms-vs-vblank-race [226.672929] Starting dynamic subtest: A-eDP1 [230.541410] Dynamic subtest A-eDP1: SUCCESS (3.868s) [230.552463] Starting dynamic subtest: B-eDP1 [234.042247] Dynamic subtest B-eDP1: SUCCESS (3.497s) [234.051488] Starting dynamic subtest: C-eDP1 [237.529458] Dynamic subtest C-eDP1: SUCCESS (3.487s) [237.538281] Starting dynamic subtest: D-eDP1 [241.015626] Dynamic subtest D-eDP1: SUCCESS (3.485s) [241.021004] Subtest dpms-vs-vblank-race: SUCCESS (14.351s) [241.875002] [031/133] (781s left) kms_plane_alpha_blend (alpha-basic) [241.972376] Starting subtest: alpha-basic [242.266003] Starting dynamic subtest: pipe-A-eDP-1 [244.189256] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.922s) [244.218651] Starting dynamic subtest: pipe-D-eDP-1 [246.900182] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.688s) [246.903063] Subtest alpha-basic: SUCCESS (4.930s) [247.776428] [032/133] (775s left) syncobj_timeline (multi-wait-available-submitted-signaled) [247.835687] Starting subtest: multi-wait-available-submitted-signaled [247.838336] Subtest multi-wait-available-submitted-signaled: SUCCESS (0.000s) [247.944251] [033/133] (775s left) kms_sequence (get-forked-busy) [248.035931] Starting subtest: get-forked-busy [248.038443] Starting dynamic subtest: pipe-A-eDP-1 [249.976237] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.943s) [249.989423] Starting dynamic subtest: pipe-B-eDP-1 [252.547948] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.571s) [252.558127] Starting dynamic subtest: pipe-C-eDP-1 [255.093720] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.544s) [255.105486] Starting dynamic subtest: pipe-D-eDP-1 [257.706794] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.611s) [257.709485] Subtest get-forked-busy: SUCCESS (9.674s) [258.568935] [034/133] (764s left) sysfs_preempt_timeout (timeout) [258.627129] Starting subtest: timeout [258.630301] Starting dynamic subtest: vecs0 [268.337293] Dynamic subtest vecs0: SUCCESS (9.712s) [268.348239] Starting dynamic subtest: ccs0 [269.624941] Dynamic subtest ccs0: SUCCESS (1.283s) [269.635434] Starting dynamic subtest: vcs0 [279.279220] Dynamic subtest vcs0: SUCCESS (9.655s) [279.291216] Starting dynamic subtest: bcs0 [280.498261] Dynamic subtest bcs0: SUCCESS (1.218s) [280.512382] Starting dynamic subtest: rcs0 [281.742217] Dynamic subtest rcs0: SUCCESS (1.242s) [281.752448] Starting dynamic subtest: vcs1 [291.310422] Dynamic subtest vcs1: SUCCESS (9.567s) [291.313383] Subtest timeout: SUCCESS (32.690s) [291.393967] [035/133] (732s left) kms_scaling_modes (scaling-mode-full) [291.497467] Starting subtest: scaling-mode-full [291.500458] Starting dynamic subtest: pipe-A-eDP-1 [291.590163] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.095s) [291.600349] Starting dynamic subtest: pipe-B-eDP-1 [292.736048] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.144s) [292.745362] Starting dynamic subtest: pipe-C-eDP-1 [293.920167] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.183s) [293.929916] Starting dynamic subtest: pipe-D-eDP-1 [295.036345] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.112s) [295.039243] Subtest scaling-mode-full: SUCCESS (3.542s) [296.249740] [036/133] (727s left) i915_drm_fdinfo (virtual-busy-idle-all) [296.292356] Starting subtest: virtual-busy-idle-all [296.298019] Subtest virtual-busy-idle-all: SKIP (0.000s) [296.359942] [037/133] (727s left) kms_big_fb (4-tiled-addfb-size-offset-overflow) [296.453259] Starting subtest: 4-tiled-addfb-size-offset-overflow [296.455793] Subtest 4-tiled-addfb-size-offset-overflow: SUCCESS (0.000s) [296.555493] [038/133] (726s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-gtt) [296.658252] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-gtt [296.663068] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [296.757568] [039/133] (726s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-gtt) [296.863326] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-gtt [296.868668] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [296.961850] [040/133] (726s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode) [297.344158] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s) [298.129285] [041/133] (725s left) kms_color (ctm-0-25) [298.215759] Starting subtest: ctm-0-25 [298.218333] Starting dynamic subtest: pipe-A-eDP-1 [301.708211] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.495s) [301.718736] Starting dynamic subtest: pipe-B-eDP-1 [305.887945] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.181s) [305.898447] Starting dynamic subtest: pipe-C-eDP-1 [309.940733] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.052s) [309.950031] Starting dynamic subtest: pipe-D-eDP-1 [313.930756] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.990s) [313.933444] Subtest ctm-0-25: SUCCESS (15.721s) [314.738024] [042/133] (708s left) kms_ccs (ccs-on-another-bo-yf-tiled-ccs) [314.849264] Starting subtest: ccs-on-another-bo-yf-tiled-ccs [314.851943] Starting dynamic subtest: pipe-A-eDP-1 [314.878357] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [314.888350] Starting dynamic subtest: pipe-B-eDP-1 [314.913225] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [314.921965] Starting dynamic subtest: pipe-C-eDP-1 [314.947144] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [314.955436] Starting dynamic subtest: pipe-D-eDP-1 [314.981460] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [314.986812] Subtest ccs-on-another-bo-yf-tiled-ccs: SKIP (0.005s) [317.148890] [043/133] (706s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-plflip-blt) [317.244282] Starting subtest: fbc-1p-primscrn-indfb-plflip-blt [321.823247] Subtest fbc-1p-primscrn-indfb-plflip-blt: SUCCESS (4.585s) [322.979003] [044/133] (700s left) gem_vm_create (create-ext) [323.036951] Starting subtest: create-ext [323.042701] Subtest create-ext: SUCCESS (0.005s) [323.160164] [045/133] (700s left) kms_cursor_legacy (cursor-vs-flip-atomic) [323.278840] Starting subtest: cursor-vs-flip-atomic [352.634257] Subtest cursor-vs-flip-atomic: SUCCESS (29.364s) [353.425870] [046/133] (670s left) kms_content_protection (atomic-hdcp14) [353.578415] Starting subtest: atomic-hdcp14 [353.584314] Subtest atomic-hdcp14: SKIP (0.000s) [353.701824] [047/133] (670s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs-cc) [353.799003] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs-cc [353.801300] Starting dynamic subtest: pipe-A-eDP-1 [353.824377] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [353.834917] Starting dynamic subtest: pipe-B-eDP-1 [353.859552] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [353.868937] Starting dynamic subtest: pipe-C-eDP-1 [353.894245] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [353.903234] Starting dynamic subtest: pipe-D-eDP-1 [353.929245] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [353.934003] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s) [356.025550] [048/133] (667s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf) [356.132871] Starting subtest: fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf [356.135176] Starting dynamic subtest: pipe-A-eDP-1 [356.208198] Dynamic subtest pipe-A-eDP-1: SKIP (0.077s) [356.217333] Starting dynamic subtest: pipe-B-eDP-1 [357.368991] Dynamic subtest pipe-B-eDP-1: SKIP (1.158s) [357.374033] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf: SKIP (1.238s) [358.531825] [049/133] (665s left) kms_async_flips (crc-atomic) [358.638106] Starting subtest: crc-atomic [359.021944] Starting dynamic subtest: pipe-A-eDP-1 [361.910371] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.886s) [362.292676] Starting dynamic subtest: pipe-B-eDP-1 [365.207189] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.925s) [365.578442] Starting dynamic subtest: pipe-C-eDP-1 [368.477477] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.908s) [368.840461] Starting dynamic subtest: pipe-D-eDP-1 [371.694934] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.865s) [371.697554] Subtest crc-atomic: SUCCESS (13.063s) [372.922746] [050/133] (651s left) kms_addfb_basic (basic-x-tiled-legacy) [372.994358] Starting subtest: basic-x-tiled-legacy [372.999901] Subtest basic-x-tiled-legacy: SKIP (0.000s) [373.125388] [051/133] (650s left) kms_cursor_legacy (single-bo) [373.242330] Starting subtest: single-bo [373.245266] Starting dynamic subtest: pipe-A [378.624619] Dynamic subtest pipe-A: SUCCESS (5.378s) [378.634449] Starting dynamic subtest: pipe-B [384.009337] Dynamic subtest pipe-B: SUCCESS (5.380s) [384.021440] Starting dynamic subtest: pipe-C [389.393458] Dynamic subtest pipe-C: SUCCESS (5.379s) [389.405168] Starting dynamic subtest: pipe-D [394.777245] Dynamic subtest pipe-D: SUCCESS (5.379s) [394.789450] Starting dynamic subtest: all-pipes [400.168436] Dynamic subtest all-pipes: SUCCESS (5.387s) [400.171379] Subtest single-bo: SUCCESS (26.916s) [400.311124] [052/133] (623s left) syncobj_timeline (wait-all-for-submit-delayed-submit) [400.365445] Starting subtest: wait-all-for-submit-delayed-submit [400.468007] Subtest wait-all-for-submit-delayed-submit: SUCCESS (0.104s) [400.550963] [053/133] (623s left) gem_pipe_control_store_loop (reused-buffer) [400.611090] Starting subtest: reused-buffer [402.765766] Subtest reused-buffer: SUCCESS (2.155s) [402.880967] [054/133] (621s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-mc-ccs) [402.974943] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-mc-ccs [402.977492] Starting dynamic subtest: pipe-A-eDP-1 [405.097425] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.123s) [405.106210] Starting dynamic subtest: pipe-B-eDP-1 [407.265167] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.165s) [407.274171] Starting dynamic subtest: pipe-C-eDP-1 [409.307470] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.041s) [409.316910] Starting dynamic subtest: pipe-D-eDP-1 [411.386658] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.078s) [411.388484] Subtest crc-primary-rotation-180-4-tiled-mtl-mc-ccs: SUCCESS (8.413s) [412.633690] [055/133] (611s left) kms_frontbuffer_tracking (fbcpsr-2p-pri-indfb-multidraw) [412.739241] Starting subtest: fbcpsr-2p-pri-indfb-multidraw [412.744170] Subtest fbcpsr-2p-pri-indfb-multidraw: SKIP (0.000s) [412.835324] [056/133] (611s left) kms_cursor_crc (cursor-rapid-movement-256x85) [413.099091] Starting subtest: cursor-rapid-movement-256x85 [413.149353] Subtest cursor-rapid-movement-256x85: SKIP (0.043s) [413.322313] [057/133] (611s left) gem_exec_schedule (submit-late-slice) [413.397838] Starting subtest: submit-late-slice [413.400278] Starting dynamic subtest: rcs0 [413.427447] Dynamic subtest rcs0: SUCCESS (0.037s) [413.440082] Starting dynamic subtest: bcs0 [413.462446] Dynamic subtest bcs0: SUCCESS (0.035s) [413.473711] Starting dynamic subtest: vcs0 [413.492313] Dynamic subtest vcs0: SUCCESS (0.029s) [413.502022] Starting dynamic subtest: vcs1 [413.528702] Dynamic subtest vcs1: SUCCESS (0.035s) [413.540307] Starting dynamic subtest: vecs0 [413.556014] Dynamic subtest vecs0: SUCCESS (0.027s) [413.565171] Starting dynamic subtest: ccs0 [413.584350] Dynamic subtest ccs0: SUCCESS (0.028s) [413.587364] Subtest submit-late-slice: SUCCESS (0.195s) [415.373335] [058/133] (609s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy) [415.496830] Starting subtest: basic-busy-flip-before-cursor-legacy [415.501731] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s) [415.646779] [059/133] (608s left) kms_big_fb (y-tiled-32bpp-rotate-180) [415.740426] Starting subtest: y-tiled-32bpp-rotate-180 [415.745715] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s) [415.870649] [060/133] (608s left) gem_exec_schedule (u-submit-golden-slice) [415.948876] Starting subtest: u-submit-golden-slice [415.951218] Starting dynamic subtest: rcs0 [415.971282] Dynamic subtest rcs0: SUCCESS (0.034s) [415.982232] Starting dynamic subtest: bcs0 [415.999006] Dynamic subtest bcs0: SUCCESS (0.027s) [416.008312] Starting dynamic subtest: vcs0 [416.031159] Dynamic subtest vcs0: SUCCESS (0.031s) [416.042754] Starting dynamic subtest: vcs1 [416.058064] Dynamic subtest vcs1: SUCCESS (0.026s) [416.067091] Starting dynamic subtest: vecs0 [416.094111] Dynamic subtest vecs0: SUCCESS (0.035s) [416.103459] Starting dynamic subtest: ccs0 [416.127246] Dynamic subtest ccs0: SUCCESS (0.032s) [416.130285] Subtest u-submit-golden-slice: SUCCESS (0.190s) [417.430810] [061/133] (607s left) gem_exec_parallel (userptr) [417.492157] Starting subtest: userptr [417.494840] Starting dynamic subtest: rcs0 [419.210021] Dynamic subtest rcs0: SUCCESS (1.716s) [419.220127] Starting dynamic subtest: bcs0 [421.009932] Dynamic subtest bcs0: SUCCESS (1.798s) [421.021579] Starting dynamic subtest: vcs0 [424.243002] Dynamic subtest vcs0: SUCCESS (3.229s) [424.252848] Starting dynamic subtest: vcs1 [426.292029] Dynamic subtest vcs1: SUCCESS (2.046s) [426.304226] Starting dynamic subtest: vecs0 [428.339306] Dynamic subtest vecs0: SUCCESS (2.043s) [428.350966] Starting dynamic subtest: ccs0 [430.162650] Dynamic subtest ccs0: SUCCESS (1.821s) [430.165728] Subtest userptr: SUCCESS (12.669s) [430.349557] [062/133] (594s left) gem_tiled_partial_pwrite_pread (writes-after-reads) [430.418340] Subtest writes-after-reads: SKIP (0.000s) [430.480340] [063/133] (594s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite) [430.586128] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite [430.591338] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [430.686790] [064/133] (593s left) kms_getfb (getfb2-handle-protection) [430.774217] Starting subtest: getfb2-handle-protection [430.789261] Subtest getfb2-handle-protection: SUCCESS (0.018s) [430.897003] [065/133] (593s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt) [430.989122] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt [430.993863] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [431.087703] [066/133] (593s left) gem_gpgpu_fill (basic) [431.132363] Starting subtest: basic [431.135076] Starting dynamic subtest: smem [431.141106] Dynamic subtest smem: SUCCESS (0.010s) [431.143440] Subtest basic: SUCCESS (0.011s) [431.292777] [067/133] (593s left) kms_big_fb (linear-16bpp-rotate-270) [431.393083] Starting subtest: linear-16bpp-rotate-270 [431.413286] Subtest linear-16bpp-rotate-270: SKIP (0.020s) [431.531594] [068/133] (593s left) gem_ctx_sseu (engines) [431.586236] Subtest engines: SKIP (0.000s) [431.644996] [069/133] (593s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling) [431.732133] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling [431.734212] Starting dynamic subtest: pipe-A-default-mode [434.397376] Dynamic subtest pipe-A-default-mode: SUCCESS (2.663s) [434.400368] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SUCCESS (2.664s) [435.228078] [070/133] (589s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt) [435.326427] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt [442.620035] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SUCCESS (7.298s) [442.755267] [071/133] (582s left) kms_chamelium_frames (hdmi-crc-multiple) [443.159249] Subtest hdmi-crc-multiple: SKIP (0.000s) [443.992057] [072/133] (581s left) syncobj_wait (invalid-signal-illegal-handle) [444.053428] Starting subtest: invalid-signal-illegal-handle [444.056067] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s) [444.150009] [073/133] (580s left) gem_ctx_persistence (heartbeat-hang) [444.204166] Starting subtest: heartbeat-hang [444.209585] Subtest heartbeat-hang: SKIP (0.000s) [444.308980] [074/133] (580s left) perf_pmu (render-node-busy) [444.376192] Starting subtest: render-node-busy [444.378341] Starting dynamic subtest: rcs0 [444.975108] Dynamic subtest rcs0: SUCCESS (0.600s) [444.988246] Starting dynamic subtest: bcs0 [445.533232] Dynamic subtest bcs0: SUCCESS (0.555s) [445.546043] Starting dynamic subtest: vcs0 [447.282982] Dynamic subtest vcs0: SUCCESS (1.746s) [447.296453] Starting dynamic subtest: vcs1 [449.331493] Dynamic subtest vcs1: SUCCESS (2.045s) [449.344735] Starting dynamic subtest: vecs0 [451.315630] Dynamic subtest vecs0: SUCCESS (1.981s) [451.326774] Starting dynamic subtest: ccs0 [451.881463] Dynamic subtest ccs0: SUCCESS (0.564s) [451.884417] Subtest render-node-busy: SUCCESS (7.509s) [451.975960] [075/133] (573s left) gem_ctx_engines (execute-one) [452.044001] Starting subtest: execute-one [455.911773] Subtest execute-one: SUCCESS (3.868s) [456.099482] [076/133] (569s left) syncobj_timeline (invalid-query-zero-handles) [456.160243] Starting subtest: invalid-query-zero-handles [456.163108] Subtest invalid-query-zero-handles: SUCCESS (0.000s) [456.258996] [077/133] (568s left) gem_ccs (block-multicopy-inplace) [456.306734] Starting subtest: block-multicopy-inplace [456.311204] Subtest block-multicopy-inplace: SKIP (0.000s) [456.400795] [078/133] (568s left) gem_partial_pwrite_pread (write) [456.460609] Subtest write: SKIP (0.000s) [456.533427] [079/133] (568s left) kms_pipe_crc_basic (bad-source) [456.638315] Starting subtest: bad-source [456.640608] Subtest bad-source: SUCCESS (0.000s) [456.722379] [080/133] (568s left) core_setmaster (master-drop-set-root) [456.803159] Starting subtest: master-drop-set-root [456.815467] Subtest master-drop-set-root: SUCCESS (0.013s) [456.865125] [081/133] (568s left) kms_cursor_crc (cursor-sliding-512x170) [457.166198] Starting subtest: cursor-sliding-512x170 [457.171125] Subtest cursor-sliding-512x170: SKIP (0.001s) [457.316103] [082/133] (568s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs) [457.406105] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs [457.408454] Starting dynamic subtest: pipe-A-eDP-1 [457.433030] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [457.443298] Starting dynamic subtest: pipe-B-eDP-1 [457.467191] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [457.476219] Starting dynamic subtest: pipe-C-eDP-1 [457.500125] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [457.509130] Starting dynamic subtest: pipe-D-eDP-1 [457.533446] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [457.537983] Subtest random-ccs-data-y-tiled-gen12-rc-ccs: SKIP (0.005s) [459.615440] [083/133] (565s left) kms_frontbuffer_tracking (pipe-fbc-rte) [459.703384] Starting subtest: pipe-fbc-rte [459.710481] Starting dynamic subtest: pipe-B-eDP-1 [465.113419] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.413s) [465.122189] Subtest pipe-fbc-rte: SUCCESS (5.416s) [467.429336] [084/133] (558s left) kms_psr (fbc-psr-cursor-plane-move) [467.521016] Starting subtest: fbc-psr-cursor-plane-move [467.523798] Starting dynamic subtest: eDP-1 [467.529070] Dynamic subtest eDP-1: SKIP (0.000s) [467.534301] Subtest fbc-psr-cursor-plane-move: SKIP (0.001s) [467.594832] [085/133] (557s left) kms_cursor_crc (cursor-offscreen-32x32) [467.728498] Starting subtest: cursor-offscreen-32x32 [467.773183] Subtest cursor-offscreen-32x32: SKIP (0.039s) [468.081626] [086/133] (557s left) gem_mmap_gtt (cpuset-medium-copy) [468.130075] Subtest cpuset-medium-copy: SKIP (0.000s) [468.188143] [087/133] (557s left) syncobj_timeline (etime-single-wait-available-unsubmitted) [468.254931] Starting subtest: etime-single-wait-available-unsubmitted [468.359612] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.105s) [468.439242] [088/133] (557s left) core_setmaster_vs_auth [468.603866] [089/133] (557s left) api_intel_bb (misplaced-blitter) [468.661645] Starting subtest: misplaced-blitter [468.666906] Subtest misplaced-blitter: SUCCESS (0.008s) [468.785067] [090/133] (556s left) kms_psr (psr-basic) [468.880617] Starting subtest: psr-basic [468.882913] Starting dynamic subtest: eDP-1 [470.469228] Dynamic subtest eDP-1: SUCCESS (1.589s) [470.472234] Subtest psr-basic: SUCCESS (1.590s) [471.322350] [091/133] (554s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc) [471.420122] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc [471.424580] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [471.519178] [092/133] (554s left) gem_basic (bad-close) [471.573893] Starting subtest: bad-close [471.578433] Subtest bad-close: SUCCESS (0.000s) [471.692775] [093/133] (554s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-onoff) [471.785266] Starting subtest: fbc-2p-scndscrn-spr-indfb-onoff [471.790239] Subtest fbc-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s) [471.879149] [094/133] (554s left) prime_mmap (test_errors) [471.948570] Starting subtest: test_errors [471.950711] Starting dynamic subtest: test_errors-smem [472.039905] Dynamic subtest test_errors-smem: SUCCESS (0.094s) [472.042630] Subtest test_errors: SUCCESS (0.095s) [472.139337] [095/133] (553s left) prime_self_import (basic-llseek-size) [472.173667] Starting subtest: basic-llseek-size [472.197987] Subtest basic-llseek-size: SUCCESS (0.021s) [472.292629] [096/133] (553s left) syncobj_wait (single-wait-signaled) [472.344841] Starting subtest: single-wait-signaled [472.346868] Subtest single-wait-signaled: SUCCESS (0.000s) [472.453973] [097/133] (553s left) i915_drm_fdinfo (most-busy-check-all) [472.492853] Starting subtest: most-busy-check-all [472.495145] Starting dynamic subtest: rcs0 [472.499230] Dynamic subtest rcs0: SKIP (0.004s) [472.509598] Starting dynamic subtest: bcs0 [472.514272] Dynamic subtest bcs0: SKIP (0.000s) [472.523447] Starting dynamic subtest: vcs0 [472.527806] Dynamic subtest vcs0: SKIP (0.000s) [472.536910] Starting dynamic subtest: vcs1 [472.540954] Dynamic subtest vcs1: SKIP (0.001s) [472.550087] Starting dynamic subtest: vecs0 [472.554170] Dynamic subtest vecs0: SKIP (0.001s) [472.563334] Starting dynamic subtest: ccs0 [472.567812] Dynamic subtest ccs0: SKIP (0.000s) [472.572090] Subtest most-busy-check-all: SKIP (0.011s) [472.611374] [098/133] (553s left) perf (short-reads) [472.740051] Starting subtest: short-reads [472.754193] Subtest short-reads: SUCCESS (0.016s) [472.797131] [099/133] (553s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-onoff) [472.915263] Starting subtest: psr-2p-scndscrn-cur-indfb-onoff [472.919467] Subtest psr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s) [473.020302] [100/133] (553s left) gem_spin_batch (resubmit-new-all) [473.075980] Starting subtest: resubmit-new-all [473.078312] Starting dynamic subtest: rcs0 [473.096666] Dynamic subtest rcs0: SUCCESS (0.020s) [473.106958] Starting dynamic subtest: bcs0 [473.108817] Dynamic subtest bcs0: SUCCESS (0.011s) [473.117547] Starting dynamic subtest: vcs0 [473.119274] Dynamic subtest vcs0: SUCCESS (0.010s) [473.128183] Starting dynamic subtest: vcs1 [473.130283] Dynamic subtest vcs1: SUCCESS (0.008s) [473.139716] Starting dynamic subtest: vecs0 [473.142123] Dynamic subtest vecs0: SUCCESS (0.010s) [473.151297] Starting dynamic subtest: ccs0 [473.156133] Dynamic subtest ccs0: SUCCESS (0.015s) [473.158199] Subtest resubmit-new-all: SUCCESS (0.079s) [474.337686] [101/133] (551s left) kms_dp_link_training (uhbr-sst) [474.426317] Starting subtest: uhbr-sst [474.436200] Subtest uhbr-sst: SKIP (0.000s) [474.496436] [102/133] (551s left) gem_userptr_blits (create-destroy-sync) [474.557706] Starting subtest: create-destroy-sync [479.601441] Subtest create-destroy-sync: SUCCESS (5.015s) [479.715309] [103/133] (546s left) kms_addfb_basic (no-handle) [479.768226] Starting subtest: no-handle [479.770890] Subtest no-handle: SUCCESS (0.000s) [479.920205] [104/133] (546s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt) [480.013059] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt [487.224247] Subtest psr-1p-primscrn-shrfb-msflip-blt: SUCCESS (7.212s) [487.337348] [105/133] (539s left) gem_exec_reloc (basic-wc-gtt-active) [487.407999] Subtest basic-wc-gtt-active: SKIP (0.000s) [487.482755] [106/133] (538s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf) [487.580425] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf [487.583263] Starting dynamic subtest: pipe-A-eDP-1 [487.685978] Dynamic subtest pipe-A-eDP-1: SKIP (0.110s) [487.696261] Starting dynamic subtest: pipe-B-eDP-1 [488.866344] Dynamic subtest pipe-B-eDP-1: SKIP (1.178s) [488.871278] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (1.291s) [490.117612] [107/133] (536s left) api_intel_bb (blit-noreloc-purge-cache) [490.176686] Starting subtest: blit-noreloc-purge-cache [490.186479] Subtest blit-noreloc-purge-cache: SUCCESS (0.012s) [490.309001] [108/133] (536s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-cpu) [490.400121] Starting subtest: fbc-rgb565-draw-mmap-cpu [494.355983] Subtest fbc-rgb565-draw-mmap-cpu: SUCCESS (3.960s) [495.541261] [109/133] (531s left) kms_pm_dc (dc5-psr) [496.648815] Starting subtest: dc5-psr [499.614728] Subtest dc5-psr: SUCCESS (2.968s) [500.413180] [110/133] (526s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-cpu) [500.520329] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-cpu [500.525986] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [500.624359] [111/133] (526s left) gem_ctx_param (invalid-set-ringsize) [500.670287] Starting subtest: invalid-set-ringsize [500.672915] Subtest invalid-set-ringsize: SUCCESS (0.000s) [500.743710] [112/133] (525s left) kms_vrr (flip-suspend) [500.847325] Starting subtest: flip-suspend [500.854338] Subtest flip-suspend: SKIP (0.000s) [500.919719] [113/133] (525s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc) [501.005387] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc [501.008375] Starting dynamic subtest: pipe-A-eDP-1 [501.483272] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.452s) [501.494231] Starting dynamic subtest: pipe-B-eDP-1 [502.878454] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.392s) [502.890435] Starting dynamic subtest: pipe-C-eDP-1 [504.244915] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.360s) [504.255225] Starting dynamic subtest: pipe-D-eDP-1 [505.578270] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.334s) [505.580980] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc: SUCCESS (4.544s) [506.709058] [114/133] (520s left) kms_plane_scaling (plane-downscale-factor-0-5-with-rotation) [506.804159] Starting subtest: plane-downscale-factor-0-5-with-rotation [506.806575] Starting dynamic subtest: pipe-A [506.825094] Dynamic subtest pipe-A: SKIP (0.016s) [506.839593] Starting dynamic subtest: pipe-B [506.860812] Dynamic subtest pipe-B: SKIP (0.035s) [506.876097] Starting dynamic subtest: pipe-C [506.888629] Dynamic subtest pipe-C: SKIP (0.030s) [506.897847] Starting dynamic subtest: pipe-D [506.919461] Dynamic subtest pipe-D: SKIP (0.029s) [506.924586] Subtest plane-downscale-factor-0-5-with-rotation: SKIP (0.113s) [507.011160] [115/133] (519s left) syncobj_wait (multi-wait-for-submit-submitted-signaled) [507.060251] Starting subtest: multi-wait-for-submit-submitted-signaled [507.063032] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.000s) [507.146602] [116/133] (519s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip) [507.248260] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip [507.872990] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.626s) [508.013914] [117/133] (518s left) gem_exec_balancer (bonded-false-hang) [508.263262] Starting subtest: bonded-false-hang [508.269062] Subtest bonded-false-hang: SKIP (0.000s) [508.389712] [118/133] (518s left) gen9_exec_parse (bb-secure) [508.450454] Subtest bb-secure: SKIP (0.000s) [508.511113] [119/133] (518s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180) [508.609457] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180 [508.614529] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s) [508.699413] [120/133] (518s left) kms_flip (blocking-absolute-wf_vblank) [508.790335] Starting subtest: blocking-absolute-wf_vblank [508.792748] Starting dynamic subtest: A-eDP1 [517.534013] Dynamic subtest A-eDP1: SUCCESS (8.746s) [517.547239] Starting dynamic subtest: B-eDP1 [526.237383] Dynamic subtest B-eDP1: SUCCESS (8.704s) [526.250462] Starting dynamic subtest: C-eDP1 [534.922013] Dynamic subtest C-eDP1: SUCCESS (8.683s) [534.937271] Starting dynamic subtest: D-eDP1 [543.618192] Dynamic subtest D-eDP1: SUCCESS (8.696s) [543.624367] Subtest blocking-absolute-wf_vblank: SUCCESS (34.842s) [544.812344] [121/133] (482s left) kms_addfb_basic (bo-too-small-due-to-tiling) [544.912238] Starting subtest: bo-too-small-due-to-tiling [544.917324] Subtest bo-too-small-due-to-tiling: SKIP (0.000s) [545.014284] [122/133] (482s left) gem_exec_params (sol-reset-not-gen7) [545.068378] Starting subtest: sol-reset-not-gen7 [545.071170] Subtest sol-reset-not-gen7: SUCCESS (0.003s) [545.199307] [123/133] (482s left) kms_plane_cursor (viewport) [545.287150] Starting subtest: viewport [545.291932] Starting dynamic subtest: pipe-A-eDP-1-size-64 [547.842219] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.556s) [547.904152] Starting dynamic subtest: pipe-A-eDP-1-size-128 [550.321267] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.426s) [550.382844] Starting dynamic subtest: pipe-A-eDP-1-size-256 [552.889026] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.515s) [553.240652] Starting dynamic subtest: pipe-B-eDP-1-size-64 [556.368318] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.142s) [556.429369] Starting dynamic subtest: pipe-B-eDP-1-size-128 [558.835283] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.418s) [558.897713] Starting dynamic subtest: pipe-B-eDP-1-size-256 [561.312007] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.425s) [561.663943] Starting dynamic subtest: pipe-C-eDP-1-size-64 [564.484238] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.834s) [564.522848] Starting dynamic subtest: pipe-C-eDP-1-size-128 [566.640477] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.125s) [566.679470] Starting dynamic subtest: pipe-C-eDP-1-size-256 [568.806453] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.136s) [569.139266] Starting dynamic subtest: pipe-D-eDP-1-size-64 [571.928161] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.801s) [571.966682] Starting dynamic subtest: pipe-D-eDP-1-size-128 [574.051211] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.091s) [574.088426] Starting dynamic subtest: pipe-D-eDP-1-size-256 [576.171277] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.091s) [576.497501] Subtest viewport: SUCCESS (31.216s) [577.295768] [124/133] (449s left) prime_vgem (coherency-gtt) [577.385177] Starting subtest: coherency-gtt [577.390604] Subtest coherency-gtt: SKIP (0.000s) [577.498136] [125/133] (449s left) kms_vrr (flip-basic) [577.597588] Starting subtest: flip-basic [577.605034] Subtest flip-basic: SKIP (0.000s) [577.670891] [126/133] (449s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-factor-0-25) [577.768141] Starting subtest: planes-downscale-factor-0-75-upscale-factor-0-25 [577.770468] Starting dynamic subtest: pipe-A [577.831566] Dynamic subtest pipe-A: SUCCESS (0.065s) [577.849351] Starting dynamic subtest: pipe-B [578.973887] Dynamic subtest pipe-B: SUCCESS (1.142s) [578.984427] Starting dynamic subtest: pipe-C [580.069712] Dynamic subtest pipe-C: SUCCESS (1.095s) [580.079817] Starting dynamic subtest: pipe-D [581.176193] Dynamic subtest pipe-D: SUCCESS (1.106s) [581.179091] Subtest planes-downscale-factor-0-75-upscale-factor-0-25: SUCCESS (3.412s) [582.401897] [127/133] (444s left) gem_exec_flush (basic-batch-kernel-default-wb) [582.463673] Starting subtest: basic-batch-kernel-default-wb [589.732498] Subtest basic-batch-kernel-default-wb: SUCCESS (7.271s) [589.923052] [128/133] (437s left) kms_frontbuffer_tracking (fbcpsr-slowdraw) [590.024806] Starting subtest: fbcpsr-slowdraw [615.175426] Subtest fbcpsr-slowdraw: SUCCESS (25.159s) [615.277003] [129/133] (412s left) gem_pwrite (basic-random) [615.337203] Subtest basic-random: SKIP (0.000s) [615.404003] [130/133] (412s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt) [615.498463] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt [615.503935] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [615.593156] [131/133] (411s left) syncobj_eventfd (invalid-bad-pad) [615.648229] Starting subtest: invalid-bad-pad [615.650350] Subtest invalid-bad-pad: SUCCESS (0.000s) [615.742105] [132/133] (411s left) syncobj_wait (wait-any-interrupted) [615.796587] Starting subtest: wait-any-interrupted [615.906141] Subtest wait-any-interrupted: SUCCESS (0.106s) [615.992760] [133/133] (411s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt) [616.097098] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt [616.102251] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [616.188881] 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.