[61.865242] Initializing watchdogs [61.865289] /dev/watchdog0 [61.921822] [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.926409] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [61.928754] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [61.932276] [001/132] (960s left) kms_properties (invalid-properties-legacy) [62.068737] Starting subtest: invalid-properties-legacy [62.177592] Subtest invalid-properties-legacy: SUCCESS (0.109s) [62.279197] [002/132] (960s left) gem_ringfill (legacy-basic) [67.925818] Starting subtest: legacy-basic [67.928273] Starting dynamic subtest: default [68.076804] Dynamic subtest default: SUCCESS (0.149s) [68.087249] Starting dynamic subtest: render [68.119145] Dynamic subtest render: SUCCESS (0.042s) [68.128790] Starting dynamic subtest: bsd [68.162785] Dynamic subtest bsd: SUCCESS (0.042s) [68.170504] Starting dynamic subtest: bsd1 [68.201964] Dynamic subtest bsd1: SUCCESS (0.038s) [68.212121] Starting dynamic subtest: bsd2 [68.245090] Dynamic subtest bsd2: SUCCESS (0.042s) [68.254738] Starting dynamic subtest: blt [68.289996] Dynamic subtest blt: SUCCESS (0.044s) [68.299671] Starting dynamic subtest: vebox [68.331969] Dynamic subtest vebox: SUCCESS (0.041s) [68.334334] Subtest legacy-basic: SUCCESS (0.407s) [68.429968] [FACT gem_ringfill (legacy-basic)] new: kernel.kmod_is_loaded.vgem: true [68.433051] [003/132] (954s left) kms_cursor_legacy (2x-flip-vs-cursor-legacy) [68.566064] Starting subtest: 2x-flip-vs-cursor-legacy [68.570616] Subtest 2x-flip-vs-cursor-legacy: SKIP (0.001s) [68.734747] [004/132] (953s left) kms_cursor_crc (cursor-rapid-movement-512x170) [69.005696] Starting subtest: cursor-rapid-movement-512x170 [69.010251] Subtest cursor-rapid-movement-512x170: SKIP (0.001s) [69.183756] [005/132] (953s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc) [69.278727] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc [69.280607] Starting dynamic subtest: pipe-A-eDP-1 [69.299589] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [69.309705] Starting dynamic subtest: pipe-B-eDP-1 [69.327597] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [69.334692] Starting dynamic subtest: pipe-C-eDP-1 [69.351761] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [69.362850] Starting dynamic subtest: pipe-D-eDP-1 [69.384094] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [69.387584] Subtest crc-primary-rotation-180-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s) [71.631775] [006/132] (951s left) api_intel_bb (blit-noreloc-purge-cache) [71.694712] Starting subtest: blit-noreloc-purge-cache [71.703676] Subtest blit-noreloc-purge-cache: SUCCESS (0.010s) [71.861628] [007/132] (950s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-blt) [71.961670] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-blt [71.965894] Subtest psr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s) [72.091023] [008/132] (950s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-downscaling) [72.191354] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-downscaling [72.193644] Starting dynamic subtest: pipe-A-default-mode [72.495452] Dynamic subtest pipe-A-default-mode: SKIP (0.299s) [72.500174] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-downscaling: SKIP (0.300s) [73.370133] [009/132] (949s left) gem_partial_pwrite_pread (writes-after-reads-snoop) [73.427894] Subtest writes-after-reads-snoop: SKIP (0.000s) [73.507415] [010/132] (949s left) gem_ctx_isolation (preservation) [73.577596] Starting subtest: preservation [73.579745] Starting dynamic subtest: rcs0 [73.722232] Dynamic subtest rcs0: SUCCESS (0.146s) [73.734625] Starting dynamic subtest: bcs0 [73.905486] Dynamic subtest bcs0: SUCCESS (0.182s) [73.915873] Starting dynamic subtest: vcs0 [74.070590] Dynamic subtest vcs0: SUCCESS (0.165s) [74.080954] Starting dynamic subtest: vcs1 [76.074532] Dynamic subtest vcs1: SUCCESS (2.003s) [76.085713] Starting dynamic subtest: vecs0 [78.046638] Dynamic subtest vecs0: SUCCESS (1.972s) [78.057451] Starting dynamic subtest: ccs0 [80.060630] Dynamic subtest ccs0: SUCCESS (2.013s) [80.063581] Subtest preservation: SUCCESS (6.484s) [80.327845] [011/132] (942s left) i915_power (sanity) [80.387625] Starting subtest: sanity [84.449334] Subtest sanity: SUCCESS (4.037s) [86.038488] [012/132] (936s left) gem_exec_fence (syncobj-timeline-invalid-flags) [86.584657] Starting subtest: syncobj-timeline-invalid-flags [86.587073] Subtest syncobj-timeline-invalid-flags: SUCCESS (0.000s) [87.988170] [013/132] (934s left) gem_exec_schedule (submit-golden-slice) [88.065697] Starting subtest: submit-golden-slice [88.068058] Starting dynamic subtest: rcs0 [88.114651] Dynamic subtest rcs0: SUCCESS (0.056s) [88.123925] Starting dynamic subtest: bcs0 [88.160645] Dynamic subtest bcs0: SUCCESS (0.045s) [88.173096] Starting dynamic subtest: vcs0 [88.216992] Dynamic subtest vcs0: SUCCESS (0.056s) [88.227419] Starting dynamic subtest: vcs1 [88.272787] Dynamic subtest vcs1: SUCCESS (0.055s) [88.283166] Starting dynamic subtest: vecs0 [88.321027] Dynamic subtest vecs0: SUCCESS (0.048s) [88.331417] Starting dynamic subtest: ccs0 [88.364021] Dynamic subtest ccs0: SUCCESS (0.043s) [88.366302] Subtest submit-golden-slice: SUCCESS (0.306s) [90.076592] [014/132] (932s left) gem_exec_gttfill (basic) [90.148909] Starting subtest: basic [93.351859] Subtest basic: SUCCESS (3.203s) [93.559253] [015/132] (929s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-render) [93.701325] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-render [98.197462] Subtest fbc-1p-primscrn-pri-indfb-draw-render: SUCCESS (4.500s) [99.383583] [016/132] (923s left) gem_spin_batch (user-each) [99.452763] Starting subtest: user-each [102.723806] Subtest user-each: SUCCESS (3.264s) [103.031313] [017/132] (920s left) syncobj_wait (invalid-single-wait-unsubmitted) [103.114519] Starting subtest: invalid-single-wait-unsubmitted [103.116980] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s) [103.218222] [018/132] (919s left) gem_exec_schedule (pi-userfault) [103.402559] Starting subtest: pi-userfault [103.404573] Starting dynamic subtest: rcs0 [103.414683] Dynamic subtest rcs0: SUCCESS (0.015s) [103.425460] Starting dynamic subtest: bcs0 [103.431218] Dynamic subtest bcs0: SUCCESS (0.016s) [103.439803] Starting dynamic subtest: vcs0 [103.442083] Dynamic subtest vcs0: SUCCESS (0.010s) [103.451088] Starting dynamic subtest: vcs1 [103.453548] Dynamic subtest vcs1: SUCCESS (0.011s) [103.461988] Starting dynamic subtest: vecs0 [103.466576] Dynamic subtest vecs0: SUCCESS (0.013s) [103.474883] Starting dynamic subtest: ccs0 [103.479518] Dynamic subtest ccs0: SUCCESS (0.012s) [103.481713] Subtest pi-userfault: SUCCESS (0.079s) [103.689151] [019/132] (919s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted-signaled) [103.745675] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled [103.747985] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.000s) [103.869839] [020/132] (919s left) fbdev (eof) [103.908564] Starting subtest: eof [103.910905] Subtest eof: SUCCESS (0.000s) [104.015012] [021/132] (919s left) kms_atomic (plane-overlay-legacy) [104.118068] Starting subtest: plane-overlay-legacy [104.120374] Starting dynamic subtest: pipe-A-eDP-1 [104.580113] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.459s) [104.582051] Subtest plane-overlay-legacy: SUCCESS (0.460s) [105.396689] [022/132] (917s left) kms_chamelium_frames (hdmi-crc-multiple) [105.796998] Subtest hdmi-crc-multiple: SKIP (0.000s) [106.579791] [023/132] (916s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip) [106.687944] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip [106.692123] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s) [106.804647] [024/132] (916s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area-big-fb) [111.772864] Starting subtest: psr2-primary-plane-update-sf-dmg-area-big-fb [111.775329] Starting dynamic subtest: pipe-A-eDP-1 [118.711500] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.938s) [118.736530] Starting dynamic subtest: pipe-B-eDP-1 [125.684109] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.966s) [125.685991] Subtest psr2-primary-plane-update-sf-dmg-area-big-fb: SUCCESS (13.907s) [126.584593] [025/132] (896s left) core_auth (many-magics) [126.647080] Starting subtest: many-magics [127.647353] Subtest many-magics: SUCCESS (1.000s) [127.803419] [026/132] (895s left) kms_cursor_legacy (cursora-vs-flipb-legacy) [127.931210] Starting subtest: cursorA-vs-flipB-legacy [127.935778] Subtest cursorA-vs-flipB-legacy: SKIP (0.001s) [128.099940] [027/132] (895s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt) [128.198372] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt [128.202320] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [128.332981] [028/132] (895s left) sysfs_timeslice_duration (duration) [128.403446] Starting subtest: duration [128.405805] Starting dynamic subtest: vecs0 [141.810756] Dynamic subtest vecs0: SUCCESS (13.404s) [141.822736] Starting dynamic subtest: ccs0 [154.967825] Dynamic subtest ccs0: SUCCESS (13.155s) [154.978697] Starting dynamic subtest: vcs0 [168.818773] Dynamic subtest vcs0: SUCCESS (13.846s) [168.829742] Starting dynamic subtest: bcs0 [181.982345] Dynamic subtest bcs0: SUCCESS (13.162s) [181.993928] Starting dynamic subtest: rcs0 [195.153249] Dynamic subtest rcs0: SUCCESS (13.169s) [195.164366] Starting dynamic subtest: vcs1 [208.819908] Dynamic subtest vcs1: SUCCESS (13.662s) [208.823087] Subtest duration: SUCCESS (80.409s) [208.921867] [029/132] (814s left) i915_drm_fdinfo (context-close-stress) [208.971727] Starting subtest: context-close-stress [219.715961] Subtest context-close-stress: SUCCESS (10.743s) [219.823869] [030/132] (803s left) gem_pipe_control_store_loop (reused-buffer) [220.014958] Starting subtest: reused-buffer [222.169584] Subtest reused-buffer: SUCCESS (2.153s) [222.329187] [031/132] (801s left) kms_hdr (bpc-switch-suspend) [222.433202] Starting subtest: bpc-switch-suspend [223.516926] Starting dynamic subtest: pipe-A-eDP-1 [242.588914] Dynamic subtest pipe-A-eDP-1: SUCCESS (8.512s) [242.591226] Subtest bpc-switch-suspend: SUCCESS (9.596s) [242.740196] [032/132] (780s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc) [242.867404] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc [242.871379] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [242.995734] [033/132] (780s left) gem_madvise (dontneed-before-pwrite) [243.034316] Starting subtest: dontneed-before-pwrite [243.059434] Subtest dontneed-before-pwrite: SKIP (0.020s) [243.121331] [034/132] (780s left) gem_exec_flush (basic-uc-prw-default) [243.187050] Starting subtest: basic-uc-prw-default [248.665127] Subtest basic-uc-prw-default: SUCCESS (5.475s) [248.872928] [035/132] (774s left) kms_big_fb (yf-tiled-32bpp-rotate-90) [248.981810] Starting subtest: yf-tiled-32bpp-rotate-90 [248.986294] Subtest yf-tiled-32bpp-rotate-90: SKIP (0.000s) [249.142122] [036/132] (774s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-pixel-formats) [249.237466] Starting subtest: plane-scaler-with-clipping-clamping-pixel-formats [249.239601] Starting dynamic subtest: pipe-A [249.363515] Dynamic subtest pipe-A: SKIP (0.120s) [249.382521] Starting dynamic subtest: pipe-B [250.537384] Dynamic subtest pipe-B: SKIP (1.172s) [250.549131] Starting dynamic subtest: pipe-C [251.753370] Dynamic subtest pipe-C: SUCCESS (1.221s) [251.764815] Starting dynamic subtest: pipe-D [252.992440] Dynamic subtest pipe-D: SUCCESS (1.238s) [252.994737] Subtest plane-scaler-with-clipping-clamping-pixel-formats: SUCCESS (3.754s) [254.215507] [037/132] (769s left) kms_vrr (seamless-rr-switch-drrs) [254.309129] Starting subtest: seamless-rr-switch-drrs [254.315557] Subtest seamless-rr-switch-drrs: SKIP (0.000s) [254.401436] [038/132] (769s left) syncobj_wait (invalid-signal-one-illegal-handle) [254.464195] Starting subtest: invalid-signal-one-illegal-handle [254.466536] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s) [254.596512] [039/132] (769s left) kms_ccs (bad-rotation-90-y-tiled-ccs) [254.711280] Starting subtest: bad-rotation-90-y-tiled-ccs [254.713748] Starting dynamic subtest: pipe-A-eDP-1 [254.737133] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [254.749278] Starting dynamic subtest: pipe-B-eDP-1 [254.771035] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [254.780286] Starting dynamic subtest: pipe-C-eDP-1 [254.801812] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [254.810323] Starting dynamic subtest: pipe-D-eDP-1 [254.832249] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [254.837276] Subtest bad-rotation-90-y-tiled-ccs: SKIP (0.004s) [256.973739] [040/132] (767s left) syncobj_wait (wait-for-submit-snapshot) [257.045712] Starting subtest: wait-for-submit-snapshot [257.126289] Subtest wait-for-submit-snapshot: SUCCESS (0.081s) [257.224614] [041/132] (766s left) gem_exec_params (invalid-flag) [257.277511] Starting subtest: invalid-flag [257.279844] Subtest invalid-flag: SUCCESS (0.000s) [257.417552] [042/132] (766s left) syncobj_wait (invalid-reset-zero-handles) [257.468403] Starting subtest: invalid-reset-zero-handles [257.470556] Subtest invalid-reset-zero-handles: SUCCESS (0.000s) [257.602028] [043/132] (766s left) syncobj_timeline (wait-all-delayed-signal) [257.664261] Starting subtest: wait-all-delayed-signal [257.769251] Subtest wait-all-delayed-signal: SUCCESS (0.103s) [257.867455] [044/132] (766s left) gem_gpgpu_fill (offset-16x16) [257.927457] Starting subtest: offset-16x16 [257.933014] Subtest offset-16x16: SUCCESS (0.008s) [258.110143] [045/132] (766s left) gem_exec_params (secure-non-master) [258.179642] Starting subtest: secure-non-master [258.184219] Subtest secure-non-master: SKIP (0.000s) [258.308679] [046/132] (766s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt) [258.404818] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt [258.408868] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [258.539753] [047/132] (765s left) kms_big_fb (y-tiled-32bpp-rotate-90) [258.649221] Starting subtest: y-tiled-32bpp-rotate-90 [258.653729] Subtest y-tiled-32bpp-rotate-90: SKIP (0.000s) [258.783470] [048/132] (765s left) kms_cursor_legacy (basic-flip-before-cursor-atomic) [258.898237] Starting subtest: basic-flip-before-cursor-atomic [259.814978] Subtest basic-flip-before-cursor-atomic: SUCCESS (0.915s) [260.709674] [049/132] (763s left) kms_color (invalid-gamma-lut-sizes) [260.808038] Starting subtest: invalid-gamma-lut-sizes [260.810248] Starting dynamic subtest: pipe-A [261.099912] Dynamic subtest pipe-A: SUCCESS (0.292s) [261.109585] Starting dynamic subtest: pipe-B [261.111899] Dynamic subtest pipe-B: SUCCESS (0.001s) [261.123810] Starting dynamic subtest: pipe-C [261.126074] Dynamic subtest pipe-C: SUCCESS (0.001s) [261.135471] Starting dynamic subtest: pipe-D [261.137317] Dynamic subtest pipe-D: SUCCESS (0.001s) [261.139145] Subtest invalid-gamma-lut-sizes: SUCCESS (0.295s) [261.938203] [050/132] (762s left) kms_chamelium_hpd (hdmi-hpd-storm-disable) [262.336517] Subtest hdmi-hpd-storm-disable: SKIP (0.000s) [263.125462] [051/132] (761s left) kms_pm_rpm (system-suspend-modeset) [264.665456] Starting subtest: system-suspend-modeset [283.978266] Subtest system-suspend-modeset: SUCCESS (4.587s) [284.367243] [052/132] (740s left) kms_big_fb (4-tiled-8bpp-rotate-90) [284.480099] Starting subtest: 4-tiled-8bpp-rotate-90 [284.502137] Subtest 4-tiled-8bpp-rotate-90: SKIP (0.021s) [284.639054] [053/132] (739s left) gem_pread (display) [284.705005] Subtest display: SKIP (0.000s) [284.774680] [054/132] (739s left) syncobj_timeline (32bits-limit) [284.828141] Starting subtest: 32bits-limit [284.831130] Subtest 32bits-limit: SUCCESS (0.001s) [284.960615] [055/132] (739s left) gem_flink_basic (bad-flink) [285.020189] Starting subtest: bad-flink [285.022550] Subtest bad-flink: SUCCESS (0.000s) [285.150348] [056/132] (739s left) syncobj_timeline (invalid-wait-illegal-handle) [285.211517] Starting subtest: invalid-wait-illegal-handle [285.214266] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s) [285.343021] [057/132] (739s left) prime_busy (hang) [285.407583] Starting subtest: hang [285.409975] Starting dynamic subtest: rcs0 [311.737263] Dynamic subtest rcs0: SUCCESS (26.315s) [311.748102] Starting dynamic subtest: bcs0 [318.828123] Dynamic subtest bcs0: SUCCESS (7.089s) [318.837765] Starting dynamic subtest: vcs0 [325.868924] Dynamic subtest vcs0: SUCCESS (7.041s) [325.879029] Starting dynamic subtest: vcs1 [332.837559] Dynamic subtest vcs1: SUCCESS (6.970s) [332.847310] Starting dynamic subtest: vecs0 [339.879113] Dynamic subtest vecs0: SUCCESS (7.039s) [339.889297] Starting dynamic subtest: ccs0 [353.716071] Dynamic subtest ccs0: SUCCESS (13.835s) [353.718619] Subtest hang: SUCCESS (68.294s) [353.885460] [058/132] (670s left) kms_pipe_stress (stress-xrgb8888-untiled) [353.974760] Starting subtest: stress-xrgb8888-untiled [359.884005] Subtest stress-xrgb8888-untiled: SUCCESS (5.910s) [359.939827] [059/132] (664s left) kms_pm_rpm (modeset-lpsp-stress-no-wait) [361.482765] Starting subtest: modeset-lpsp-stress-no-wait [371.661146] Subtest modeset-lpsp-stress-no-wait: SUCCESS (10.178s) [371.764722] [060/132] (653s left) kms_vblank (accuracy-idle) [371.862500] Starting subtest: accuracy-idle [371.865178] Starting dynamic subtest: pipe-A-eDP-1 [373.626178] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.764s) [373.640844] Starting dynamic subtest: pipe-D-eDP-1 [376.048098] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.420s) [376.051168] Subtest accuracy-idle: SUCCESS (4.188s) [376.901027] [061/132] (648s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted-signa [376.961271] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled [377.062010] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.102s) [377.180431] [062/132] (647s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-cpu) [377.293113] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-cpu [384.333728] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (7.045s) [384.457720] [063/132] (640s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-render) [384.571959] Starting subtest: psr-2p-primscrn-pri-indfb-draw-render [384.577016] Subtest psr-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s) [384.713114] [064/132] (640s left) kms_big_fb (linear-addfb) [384.817305] Starting subtest: linear-addfb [384.820000] Subtest linear-addfb: SUCCESS (0.000s) [384.933414] [065/132] (640s left) gem_spin_batch (engines) [384.987881] Starting subtest: engines [384.990466] Starting dynamic subtest: rcs0 [388.225854] Dynamic subtest rcs0: SUCCESS (3.234s) [388.238116] Starting dynamic subtest: bcs0 [391.460899] Dynamic subtest bcs0: SUCCESS (3.232s) [391.471133] Starting dynamic subtest: vcs0 [394.699941] Dynamic subtest vcs0: SUCCESS (3.236s) [394.711562] Starting dynamic subtest: vcs1 [397.938365] Dynamic subtest vcs1: SUCCESS (3.236s) [397.950069] Starting dynamic subtest: vecs0 [401.175919] Dynamic subtest vecs0: SUCCESS (3.235s) [401.188883] Starting dynamic subtest: ccs0 [404.414375] Dynamic subtest ccs0: SUCCESS (3.235s) [404.417273] Subtest engines: SUCCESS (19.425s) [404.677705] [066/132] (620s left) kms_flip (nonexisting-fb-interruptible) [404.793690] Starting subtest: nonexisting-fb-interruptible [404.796318] Starting dynamic subtest: A-eDP1 [405.975715] Dynamic subtest A-eDP1: SUCCESS (1.181s) [405.986654] Starting dynamic subtest: B-eDP1 [407.110230] Dynamic subtest B-eDP1: SUCCESS (1.134s) [407.120177] Starting dynamic subtest: C-eDP1 [408.235976] Dynamic subtest C-eDP1: SUCCESS (1.124s) [408.252226] Starting dynamic subtest: D-eDP1 [409.378100] Dynamic subtest D-eDP1: SUCCESS (1.140s) [409.383106] Subtest nonexisting-fb-interruptible: SUCCESS (4.589s) [410.583386] [067/132] (614s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions) [410.707758] Starting subtest: cursorB-vs-flipA-atomic-transitions [410.712955] Subtest cursorB-vs-flipA-atomic-transitions: SKIP (0.001s) [410.875664] [068/132] (614s left) syncobj_timeline (reset-during-wait-for-submit) [410.944242] Starting subtest: reset-during-wait-for-submit [411.045732] Subtest reset-during-wait-for-submit: SUCCESS (0.103s) [411.147015] [069/132] (614s left) kms_draw_crc (fill-fb) [411.238148] Starting subtest: fill-fb [411.665937] Subtest fill-fb: SUCCESS (0.431s) [411.794960] [070/132] (613s left) kms_big_fb (x-tiled-addfb) [411.909008] Starting subtest: x-tiled-addfb [411.911318] Subtest x-tiled-addfb: SUCCESS (0.000s) [412.052034] [071/132] (613s left) perf_pmu (frequency) [412.095534] Starting subtest: frequency [412.097987] Starting dynamic subtest: gt0 [414.286295] Dynamic subtest gt0: SUCCESS (2.182s) [414.299563] Starting dynamic subtest: idle-gt0 [414.791060] Dynamic subtest idle-gt0: SUCCESS (0.504s) [414.802046] Starting dynamic subtest: gt1 [419.184255] Dynamic subtest gt1: SUCCESS (4.387s) [419.195055] Starting dynamic subtest: idle-gt1 [419.688693] Dynamic subtest idle-gt1: SUCCESS (0.504s) [419.691212] Subtest frequency: SUCCESS (7.596s) [419.840273] [072/132] (605s left) kms_fbcon_fbt (psr) [419.904699] Starting subtest: psr [427.221242] Subtest psr: SUCCESS (7.315s) [427.303833] [073/132] (598s left) gem_exec_schedule (u-submit-golden-slice) [427.375910] Starting subtest: u-submit-golden-slice [427.378587] Starting dynamic subtest: rcs0 [427.404867] Dynamic subtest rcs0: SUCCESS (0.038s) [427.417775] Starting dynamic subtest: bcs0 [427.432096] Dynamic subtest bcs0: SUCCESS (0.027s) [427.445089] Starting dynamic subtest: vcs0 [427.467225] Dynamic subtest vcs0: SUCCESS (0.034s) [427.477826] Starting dynamic subtest: vcs1 [427.501456] Dynamic subtest vcs1: SUCCESS (0.033s) [427.511906] Starting dynamic subtest: vecs0 [427.530963] Dynamic subtest vecs0: SUCCESS (0.029s) [427.544943] Starting dynamic subtest: ccs0 [427.562845] Dynamic subtest ccs0: SUCCESS (0.031s) [427.565139] Subtest u-submit-golden-slice: SUCCESS (0.196s) [429.349459] [074/132] (596s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt) [429.452053] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt [429.457269] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s) [429.601059] [075/132] (595s left) gem_mmap (bad-size) [429.671514] Subtest bad-size: SKIP (0.000s) [429.741180] [076/132] (595s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu) [429.846239] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu [436.428451] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (6.584s) [436.604879] [077/132] (589s left) gen9_exec_parse (bb-large) [436.662047] Subtest bb-large: SKIP (0.000s) [436.732760] [078/132] (588s left) dmabuf_sync_file (export-multiwait) [436.779030] Starting subtest: export-multiwait [436.781779] Subtest export-multiwait: SUCCESS (0.000s) [436.864872] [079/132] (588s left) i915_pm_freq_api (freq-suspend) [436.932280] Starting subtest: freq-suspend [436.934783] Starting dynamic subtest: gt0 [453.443280] Dynamic subtest gt0: SUCCESS (1.221s) [453.456014] Starting dynamic subtest: gt1 [469.446722] Dynamic subtest gt1: SUCCESS (1.197s) [469.448749] Subtest freq-suspend: SUCCESS (2.420s) [469.553507] [080/132] (556s left) kms_cursor_legacy (torture-bo) [469.681516] Starting subtest: torture-bo [469.683595] Starting dynamic subtest: pipe-A [475.870400] Dynamic subtest pipe-A: SUCCESS (6.175s) [475.883217] Starting dynamic subtest: pipe-B [482.502652] Dynamic subtest pipe-B: SUCCESS (6.624s) [482.514239] Starting dynamic subtest: pipe-C [489.318124] Dynamic subtest pipe-C: SUCCESS (6.809s) [489.334791] Starting dynamic subtest: pipe-D [496.226815] Dynamic subtest pipe-D: SUCCESS (6.902s) [496.240111] Starting dynamic subtest: all-pipes [504.253515] Dynamic subtest all-pipes: SUCCESS (8.024s) [504.255985] Subtest torture-bo: SUCCESS (34.546s) [504.450086] [081/132] (521s left) kms_async_flips (async-flip-with-page-flip-events-tiled) [504.545790] Starting subtest: async-flip-with-page-flip-events-tiled [504.920954] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs [507.700086] Dynamic subtest pipe-A-eDP-1-4-rc-ccs: SUCCESS (2.780s) [507.722111] Starting dynamic subtest: pipe-A-eDP-1-4 [509.908130] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.205s) [509.921350] Starting dynamic subtest: pipe-A-eDP-1-4 [511.917972] Dynamic subtest pipe-A-eDP-1-4: SUCCESS (2.008s) [511.929390] Starting dynamic subtest: pipe-A-eDP-1-x [514.106460] Dynamic subtest pipe-A-eDP-1-x: SUCCESS (2.189s) [514.486453] Starting dynamic subtest: pipe-B-eDP-1-4-rc-ccs [517.229431] Dynamic subtest pipe-B-eDP-1-4-rc-ccs: SUCCESS (2.753s) [517.240040] Starting dynamic subtest: pipe-B-eDP-1-4 [519.421656] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.185s) [519.431930] Starting dynamic subtest: pipe-B-eDP-1-4 [521.427754] Dynamic subtest pipe-B-eDP-1-4: SUCCESS (2.009s) [521.449097] Starting dynamic subtest: pipe-B-eDP-1-x [523.638375] Dynamic subtest pipe-B-eDP-1-x: SUCCESS (2.209s) [524.005354] Starting dynamic subtest: pipe-C-eDP-1-4-rc-ccs [526.753193] Dynamic subtest pipe-C-eDP-1-4-rc-ccs: SUCCESS (2.755s) [526.764024] Starting dynamic subtest: pipe-C-eDP-1-4 [528.938231] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.184s) [528.948807] Starting dynamic subtest: pipe-C-eDP-1-4 [530.948287] Dynamic subtest pipe-C-eDP-1-4: SUCCESS (2.008s) [530.958611] Starting dynamic subtest: pipe-C-eDP-1-x [533.149865] Dynamic subtest pipe-C-eDP-1-x: SUCCESS (2.200s) [533.514517] Starting dynamic subtest: pipe-D-eDP-1-4-rc-ccs [536.284167] Dynamic subtest pipe-D-eDP-1-4-rc-ccs: SUCCESS (2.777s) [536.300815] Starting dynamic subtest: pipe-D-eDP-1-4 [538.459213] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.173s) [538.470621] Starting dynamic subtest: pipe-D-eDP-1-4 [540.469692] Dynamic subtest pipe-D-eDP-1-4: SUCCESS (2.009s) [540.480085] Starting dynamic subtest: pipe-D-eDP-1-x [542.649113] Dynamic subtest pipe-D-eDP-1-x: SUCCESS (2.178s) [542.652003] Subtest async-flip-with-page-flip-events-tiled: SUCCESS (38.102s) [543.887588] [082/132] (481s left) kms_content_protection (lic-type-1) [544.034910] Starting subtest: lic-type-1 [544.040520] Subtest lic-type-1: SKIP (0.000s) [544.196285] [083/132] (481s left) syncobj_wait (invalid-signal-zero-handles) [544.261216] Starting subtest: invalid-signal-zero-handles [544.263724] Subtest invalid-signal-zero-handles: SUCCESS (0.000s) [544.391492] [084/132] (481s left) kms_rotation_crc (primary-x-tiled-reflect-x-0) [544.486068] Starting subtest: primary-x-tiled-reflect-x-0 [551.758414] Subtest primary-x-tiled-reflect-x-0: SUCCESS (7.272s) [552.959787] [085/132] (473s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-mc-ccs) [553.049140] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-mc-ccs [553.051825] Starting dynamic subtest: pipe-A-eDP-1 [553.119953] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [553.135747] Starting dynamic subtest: pipe-B-eDP-1 [553.203601] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [553.214934] Starting dynamic subtest: pipe-C-eDP-1 [553.281604] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [553.292351] Starting dynamic subtest: pipe-D-eDP-1 [553.358911] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [553.364166] Subtest crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.008s) [555.332323] [086/132] (470s left) gem_exec_balancer (nohangcheck) [555.591919] Starting subtest: nohangcheck [556.487738] Subtest nohangcheck: SUCCESS (0.893s) [556.654049] [087/132] (469s left) gem_ccs (large-ctrl-surf-copy) [556.714764] Starting subtest: large-ctrl-surf-copy [556.719539] Subtest large-ctrl-surf-copy: SKIP (0.000s) [556.873531] [088/132] (469s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling) [556.983211] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling [556.985445] Starting dynamic subtest: pipe-A-default-mode [557.271726] Dynamic subtest pipe-A-default-mode: SKIP (0.286s) [557.276193] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.288s) [558.155394] [089/132] (468s left) gem_ctx_param (basic-default) [558.211187] Starting subtest: basic-default [558.213933] Subtest basic-default: SUCCESS (0.000s) [558.310779] [090/132] (467s left) kms_psr2_sf (fbc-psr2-overlay-plane-update-sf-dmg-area) [563.331205] Starting subtest: fbc-psr2-overlay-plane-update-sf-dmg-area [563.334082] Starting dynamic subtest: pipe-A-eDP-1 [564.135682] Dynamic subtest pipe-A-eDP-1: SKIP (0.801s) [564.146213] Starting dynamic subtest: pipe-B-eDP-1 [565.261013] Dynamic subtest pipe-B-eDP-1: SKIP (1.122s) [565.266063] Subtest fbc-psr2-overlay-plane-update-sf-dmg-area: SKIP (1.927s) [566.472616] [091/132] (459s left) kms_flip (2x-flip-vs-blocking-wf-vblank) [566.564669] Starting subtest: 2x-flip-vs-blocking-wf-vblank [566.572908] Subtest 2x-flip-vs-blocking-wf-vblank: SKIP (0.010s) [566.721215] [092/132] (459s left) gem_exec_params (no-vebox) [566.775082] Starting subtest: no-vebox [566.778102] Subtest no-vebox: SUCCESS (0.003s) [568.378563] [093/132] (457s left) kms_invalid_mode (bad-vtotal) [568.492696] Starting subtest: bad-vtotal [568.495175] Starting dynamic subtest: pipe-A-eDP-1 [568.777873] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.289s) [568.789006] Starting dynamic subtest: pipe-B-eDP-1 [568.791711] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [568.802036] Starting dynamic subtest: pipe-C-eDP-1 [568.804577] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [568.813867] Starting dynamic subtest: pipe-D-eDP-1 [568.816026] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [568.818196] Subtest bad-vtotal: SUCCESS (0.294s) [569.599661] [094/132] (456s left) gem_mmap_gtt (fault-concurrent-y) [569.670031] Subtest fault-concurrent-Y: SKIP (0.000s) [569.735959] [095/132] (456s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt) [569.839979] Starting subtest: psr-rgb565-draw-mmap-gtt [569.844789] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s) [569.971772] [096/132] (456s left) gem_exec_params (rel-constants-invalid-ring) [570.036102] Starting subtest: rel-constants-invalid-ring [570.038894] Subtest rel-constants-invalid-ring: SUCCESS (0.000s) [570.152124] [097/132] (456s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs-cc) [570.261127] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs-cc [570.263919] Starting dynamic subtest: pipe-A-eDP-1 [570.274235] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [570.285956] Starting dynamic subtest: pipe-B-eDP-1 [570.296706] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [570.307170] Starting dynamic subtest: pipe-C-eDP-1 [570.317799] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [570.327749] Starting dynamic subtest: pipe-D-eDP-1 [570.338947] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [570.344777] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s) [572.550592] [098/132] (453s left) kms_cdclk (mode-transition-all-outputs) [572.662656] Starting subtest: mode-transition-all-outputs [572.961606] Subtest mode-transition-all-outputs: SKIP (0.296s) [573.786365] [099/132] (452s left) kms_frontbuffer_tracking (fbcpsr-tiling-linear) [573.879983] Starting subtest: fbcpsr-tiling-linear [580.562325] Subtest fbcpsr-tiling-linear: SUCCESS (6.686s) [580.710020] [100/132] (445s left) gem_pread (self) [580.774980] Subtest self: SKIP (0.000s) [580.841352] [101/132] (445s left) gem_exec_schedule (fairslice-all) [580.922648] Starting subtest: fairslice-all [582.977292] Subtest fairslice-all: SUCCESS (2.063s) [584.355131] [102/132] (442s left) kms_lease (page-flip-implicit-plane) [584.456214] Starting subtest: page-flip-implicit-plane [584.458598] Starting dynamic subtest: pipe-A-eDP-1 [584.928434] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.472s) [584.938979] Starting dynamic subtest: pipe-B-eDP-1 [586.108921] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.180s) [586.119836] Starting dynamic subtest: pipe-C-eDP-1 [587.239740] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.127s) [587.250696] Starting dynamic subtest: pipe-D-eDP-1 [588.364617] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.124s) [588.367357] Subtest page-flip-implicit-plane: SUCCESS (3.910s) [589.224448] [103/132] (437s left) syncobj_wait (invalid-multi-wait-all-unsubmitted) [589.277174] Starting subtest: invalid-multi-wait-all-unsubmitted [589.279627] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s) [589.392492] [104/132] (437s left) gem_caching (writes) [589.454018] Subtest writes: SKIP (0.000s) [589.532700] [105/132] (437s left) gem_exec_balancer (parallel-contexts) [589.797212] Starting subtest: parallel-contexts [592.429363] Subtest parallel-contexts: SUCCESS (2.632s) [593.369379] [106/132] (433s left) syncobj_wait (multi-wait-all-for-submit-signaled) [593.446770] Starting subtest: multi-wait-all-for-submit-signaled [593.449505] Subtest multi-wait-all-for-submit-signaled: SUCCESS (0.000s) [593.597951] [107/132] (433s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted) [593.653329] Starting subtest: invalid-multi-wait-unsubmitted-submitted [593.656179] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s) [593.782741] [108/132] (433s left) perf_pmu (idle) [593.834890] Starting subtest: idle [593.837636] Starting dynamic subtest: rcs0 [594.361576] Dynamic subtest rcs0: SUCCESS (0.528s) [594.393894] Starting dynamic subtest: bcs0 [594.877336] Dynamic subtest bcs0: SUCCESS (0.513s) [594.891215] Starting dynamic subtest: vcs0 [595.403840] Dynamic subtest vcs0: SUCCESS (0.524s) [595.417214] Starting dynamic subtest: vcs1 [595.924904] Dynamic subtest vcs1: SUCCESS (0.518s) [595.937186] Starting dynamic subtest: vecs0 [596.455344] Dynamic subtest vecs0: SUCCESS (0.528s) [596.469181] Starting dynamic subtest: ccs0 [596.980503] Dynamic subtest ccs0: SUCCESS (0.522s) [596.983118] Subtest idle: SUCCESS (3.148s) [597.116683] [109/132] (429s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-pwrite) [597.216721] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-pwrite [597.222051] Subtest fbc-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s) [597.357864] [110/132] (429s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180) [597.468216] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180 [597.473182] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s) [597.584650] [111/132] (429s left) kms_psr (psr-cursor-plane-move) [597.676925] Starting subtest: psr-cursor-plane-move [597.679241] Starting dynamic subtest: eDP-1 [599.407176] Dynamic subtest eDP-1: SUCCESS (1.732s) [599.410038] Subtest psr-cursor-plane-move: SUCCESS (1.733s) [600.281260] [112/132] (426s left) gem_ctx_persistence (userptr) [600.338541] Starting subtest: userptr [600.560664] Subtest userptr: SUCCESS (0.222s) [600.663880] [113/132] (426s left) perf (invalid-oa-format-id) [600.828458] Starting subtest: invalid-oa-format-id [600.839127] Subtest invalid-oa-format-id: SUCCESS (0.011s) [600.885511] [114/132] (426s left) kms_psr (fbc-pr-primary-page-flip) [600.987007] Starting subtest: fbc-pr-primary-page-flip [600.992196] Subtest fbc-pr-primary-page-flip: SKIP (0.000s) [601.084354] [115/132] (426s left) kms_dsc (dsc-with-output-formats-with-bpc) [601.185214] Starting subtest: dsc-with-output-formats-with-bpc [601.241948] Subtest dsc-with-output-formats-with-bpc: SKIP (0.001s) [601.281620] [116/132] (426s left) kms_flip (nonexisting-fb) [601.381896] Starting subtest: nonexisting-fb [601.383783] Starting dynamic subtest: A-eDP1 [602.545910] Dynamic subtest A-eDP1: SUCCESS (1.165s) [602.556880] Starting dynamic subtest: B-eDP1 [603.678001] Dynamic subtest B-eDP1: SUCCESS (1.131s) [603.689211] Starting dynamic subtest: C-eDP1 [604.812301] Dynamic subtest C-eDP1: SUCCESS (1.134s) [604.826005] Starting dynamic subtest: D-eDP1 [605.948690] Dynamic subtest D-eDP1: SUCCESS (1.135s) [605.953879] Subtest nonexisting-fb: SUCCESS (4.573s) [607.242725] [117/132] (420s left) gem_pxp (verify-pxp-execution-after-suspend-resume) [607.375674] Starting subtest: verify-pxp-execution-after-suspend-resume [614.415179] Subtest verify-pxp-execution-after-suspend-resume: SUCCESS (7.039s) [614.575258] [118/132] (412s left) gem_exec_alignment (pi-isolated) [614.641481] Starting subtest: pi-isolated [666.799942] Subtest pi-isolated: SUCCESS (52.148s) [667.972777] [119/132] (359s left) kms_pm_dc (dc5-retention-flops) [669.136191] Starting subtest: dc5-retention-flops [669.142066] Subtest dc5-retention-flops: SKIP (0.000s) [669.240825] [120/132] (358s left) kms_cursor_crc (cursor-offscreen-64x21) [669.464054] Starting subtest: cursor-offscreen-64x21 [669.526838] Subtest cursor-offscreen-64x21: SKIP (0.059s) [669.821991] [121/132] (357s left) gem_ppgtt (flink-and-close-vma-leak) [669.891480] Starting subtest: flink-and-close-vma-leak [669.933188] Subtest flink-and-close-vma-leak: SUCCESS (0.041s) [670.088231] [122/132] (357s left) kms_psr (fbc-psr-cursor-plane-move) [670.188553] Starting subtest: fbc-psr-cursor-plane-move [670.191045] Starting dynamic subtest: eDP-1 [670.195752] Dynamic subtest eDP-1: SKIP (0.000s) [670.199825] Subtest fbc-psr-cursor-plane-move: SKIP (0.001s) [670.287013] [123/132] (357s left) api_intel_bb (destroy-bb) [670.360591] Starting subtest: destroy-bb [670.374388] Subtest destroy-bb: SUCCESS (0.015s) [670.542557] [124/132] (357s left) kms_plane_multiple (2x-tiling-4) [670.649861] Starting subtest: 2x-tiling-4 [670.653952] Subtest 2x-tiling-4: SKIP (0.000s) [670.746513] [125/132] (357s left) kms_rotation_crc (multiplane-rotation-cropping-top) [670.837023] Starting subtest: multiplane-rotation-cropping-top [688.430594] Subtest multiplane-rotation-cropping-top: SUCCESS (17.594s) [688.592921] [126/132] (339s left) kms_psr (fbc-psr-sprite-mmap-gtt) [688.696633] Starting subtest: fbc-psr-sprite-mmap-gtt [688.698997] Starting dynamic subtest: eDP-1 [688.702970] Dynamic subtest eDP-1: SKIP (0.000s) [688.706945] Subtest fbc-psr-sprite-mmap-gtt: SKIP (0.001s) [688.792942] [127/132] (339s left) kms_flip (dpms-off-confusion-interruptible) [688.895608] Starting subtest: dpms-off-confusion-interruptible [688.897793] Starting dynamic subtest: A-eDP1 [697.561720] Dynamic subtest A-eDP1: SUCCESS (8.664s) [697.572954] Starting dynamic subtest: B-eDP1 [706.198053] Dynamic subtest B-eDP1: SUCCESS (8.634s) [706.210132] Starting dynamic subtest: C-eDP1 [714.824926] Dynamic subtest C-eDP1: SUCCESS (8.624s) [714.835757] Starting dynamic subtest: D-eDP1 [723.459390] Dynamic subtest D-eDP1: SUCCESS (8.631s) [723.465808] Subtest dpms-off-confusion-interruptible: SUCCESS (34.564s) [724.685956] [128/132] (303s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-pgflip-blt) [724.799094] Starting subtest: psr-1p-primscrn-shrfb-pgflip-blt [732.131656] Subtest psr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.333s) [732.302177] [129/132] (295s left) kms_cursor_edge_walk (128x128-left-edge) [732.401659] Starting subtest: 128x128-left-edge [732.403864] Starting dynamic subtest: pipe-A-eDP-1 [735.850698] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.448s) [735.861632] Starting dynamic subtest: pipe-D-eDP-1 [738.978133] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.124s) [738.980961] Subtest 128x128-left-edge: SUCCESS (6.575s) [739.802119] [130/132] (288s left) i915_pm_rpm (gem-execbuf) [741.423605] Starting subtest: gem-execbuf [741.426490] Starting dynamic subtest: smem0 [743.457987] Dynamic subtest smem0: SUCCESS (2.033s) [743.460381] Subtest gem-execbuf: SUCCESS (2.035s) [743.568180] [131/132] (284s left) kms_psr (pr-sprite-blt) [743.673985] Starting subtest: pr-sprite-blt [743.678986] Subtest pr-sprite-blt: SKIP (0.000s) [743.770936] [132/132] (284s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt) [743.868998] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt [743.873993] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s) [743.985683] Closing watchdogs results: parsing output: 0/ for test: kms_properties results: parsing output: 1/ for test: gem_ringfill results: parsing output: 2/ for test: kms_cursor_legacy results: parsing output: 3/ for test: kms_cursor_crc results: parsing output: 4/ for test: kms_ccs results: parsing output: 5/ for test: api_intel_bb results: parsing output: 6/ for test: kms_frontbuffer_tracking results: parsing output: 7/ for test: kms_flip_scaled_crc results: parsing output: 8/ for test: gem_partial_pwrite_pread results: parsing output: 9/ for test: gem_ctx_isolation results: parsing output: 10/ for test: i915_power results: parsing output: 11/ for test: gem_exec_fence results: parsing output: 12/ for test: gem_exec_schedule results: parsing output: 13/ for test: gem_exec_gttfill results: parsing output: 14/ for test: kms_frontbuffer_tracking results: parsing output: 15/ for test: gem_spin_batch results: parsing output: 16/ for test: syncobj_wait results: parsing output: 17/ for test: gem_exec_schedule results: parsing output: 18/ for test: syncobj_timeline results: parsing output: 19/ for test: fbdev results: parsing output: 20/ for test: kms_atomic results: parsing output: 21/ for test: kms_chamelium_frames results: parsing output: 22/ for test: kms_big_fb results: parsing output: 23/ for test: kms_psr2_sf results: parsing output: 24/ for test: core_auth results: parsing output: 25/ for test: kms_cursor_legacy results: parsing output: 26/ for test: kms_frontbuffer_tracking results: parsing output: 27/ for test: sysfs_timeslice_duration results: parsing output: 28/ for test: i915_drm_fdinfo results: parsing output: 29/ for test: gem_pipe_control_store_loop results: parsing output: 30/ for test: kms_hdr results: parsing output: 31/ for test: kms_frontbuffer_tracking results: parsing output: 32/ for test: gem_madvise results: parsing output: 33/ for test: gem_exec_flush results: parsing output: 34/ for test: kms_big_fb results: parsing output: 35/ for test: kms_plane_scaling results: parsing output: 36/ for test: kms_vrr results: parsing output: 37/ for test: syncobj_wait results: parsing output: 38/ for test: kms_ccs results: parsing output: 39/ for test: syncobj_wait results: parsing output: 40/ for test: gem_exec_params results: parsing output: 41/ for test: syncobj_wait results: parsing output: 42/ for test: syncobj_timeline results: parsing output: 43/ for test: gem_gpgpu_fill results: parsing output: 44/ for test: gem_exec_params results: parsing output: 45/ for test: kms_frontbuffer_tracking results: parsing output: 46/ for test: kms_big_fb results: parsing output: 47/ for test: kms_cursor_legacy results: parsing output: 48/ for test: kms_color results: parsing output: 49/ for test: kms_chamelium_hpd results: parsing output: 50/ for test: kms_pm_rpm results: parsing output: 51/ for test: kms_big_fb results: parsing output: 52/ for test: gem_pread results: parsing output: 53/ for test: syncobj_timeline results: parsing output: 54/ for test: gem_flink_basic results: parsing output: 55/ for test: syncobj_timeline results: parsing output: 56/ for test: prime_busy results: parsing output: 57/ for test: kms_pipe_stress results: parsing output: 58/ for test: kms_pm_rpm results: parsing output: 59/ for test: kms_vblank results: parsing output: 60/ for test: syncobj_timeline results: parsing output: 61/ for test: kms_frontbuffer_tracking results: parsing output: 62/ for test: kms_frontbuffer_tracking results: parsing output: 63/ for test: kms_big_fb results: parsing output: 64/ for test: gem_spin_batch results: parsing output: 65/ for test: kms_flip results: parsing output: 66/ for test: kms_cursor_legacy results: parsing output: 67/ for test: syncobj_timeline results: parsing output: 68/ for test: kms_draw_crc results: parsing output: 69/ for test: kms_big_fb results: parsing output: 70/ for test: perf_pmu results: parsing output: 71/ for test: kms_fbcon_fbt results: parsing output: 72/ for test: gem_exec_schedule results: parsing output: 73/ for test: kms_frontbuffer_tracking results: parsing output: 74/ for test: gem_mmap results: parsing output: 75/ for test: kms_frontbuffer_tracking results: parsing output: 76/ for test: gen9_exec_parse results: parsing output: 77/ for test: dmabuf_sync_file results: parsing output: 78/ for test: i915_pm_freq_api results: parsing output: 79/ for test: kms_cursor_legacy results: parsing output: 80/ for test: kms_async_flips results: parsing output: 81/ for test: kms_content_protection results: parsing output: 82/ for test: syncobj_wait results: parsing output: 83/ for test: kms_rotation_crc results: parsing output: 84/ for test: kms_ccs results: parsing output: 85/ for test: gem_exec_balancer results: parsing output: 86/ for test: gem_ccs results: parsing output: 87/ for test: kms_flip_scaled_crc results: parsing output: 88/ for test: gem_ctx_param results: parsing output: 89/ for test: kms_psr2_sf results: parsing output: 90/ for test: kms_flip results: parsing output: 91/ for test: gem_exec_params results: parsing output: 92/ for test: kms_invalid_mode results: parsing output: 93/ for test: gem_mmap_gtt results: parsing output: 94/ for test: kms_frontbuffer_tracking results: parsing output: 95/ for test: gem_exec_params results: parsing output: 96/ for test: kms_ccs results: parsing output: 97/ for test: kms_cdclk results: parsing output: 98/ for test: kms_frontbuffer_tracking results: parsing output: 99/ for test: gem_pread results: parsing output: 100/ for test: gem_exec_schedule results: parsing output: 101/ for test: kms_lease results: parsing output: 102/ for test: syncobj_wait results: parsing output: 103/ for test: gem_caching results: parsing output: 104/ for test: gem_exec_balancer results: parsing output: 105/ for test: syncobj_wait results: parsing output: 106/ for test: syncobj_wait results: parsing output: 107/ for test: perf_pmu results: parsing output: 108/ for test: kms_frontbuffer_tracking results: parsing output: 109/ for test: kms_big_fb results: parsing output: 110/ for test: kms_psr results: parsing output: 111/ for test: gem_ctx_persistence results: parsing output: 112/ for test: perf results: parsing output: 113/ for test: kms_psr results: parsing output: 114/ for test: kms_dsc results: parsing output: 115/ for test: kms_flip results: parsing output: 116/ for test: gem_pxp results: parsing output: 117/ for test: gem_exec_alignment results: parsing output: 118/ for test: kms_pm_dc results: parsing output: 119/ for test: kms_cursor_crc results: parsing output: 120/ for test: gem_ppgtt results: parsing output: 121/ for test: kms_psr results: parsing output: 122/ for test: api_intel_bb results: parsing output: 123/ for test: kms_plane_multiple results: parsing output: 124/ for test: kms_rotation_crc results: parsing output: 125/ for test: kms_psr results: parsing output: 126/ for test: kms_flip results: parsing output: 127/ for test: kms_frontbuffer_tracking results: parsing output: 128/ for test: kms_cursor_edge_walk results: parsing output: 129/ for test: i915_pm_rpm results: parsing output: 130/ for test: kms_psr results: parsing output: 131/ for test: kms_frontbuffer_tracking Done.