[63.606826] Initializing watchdogs [63.606874] /dev/watchdog0 [63.621486] [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] [63.625856] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [63.628145] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [63.631617] [001/133] (960s left) syncobj_basic (bad-create-flags) [63.714929] Starting subtest: bad-create-flags [63.717216] Subtest bad-create-flags: SUCCESS (0.000s) [63.849398] [002/133] (960s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area-big-fb) [68.943140] Starting subtest: psr2-primary-plane-update-sf-dmg-area-big-fb [68.945569] Starting dynamic subtest: pipe-A-eDP-1 [76.014353] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.076s) [76.022433] Starting dynamic subtest: pipe-B-eDP-1 [82.970321] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.956s) [82.972617] Subtest psr2-primary-plane-update-sf-dmg-area-big-fb: SUCCESS (14.035s) [83.842436] [003/133] (940s left) gem_ccs (block-copy-compressed) [83.900998] Starting subtest: block-copy-compressed [83.905553] Subtest block-copy-compressed: SKIP (0.000s) [84.025194] [004/133] (940s left) kms_sequence (get-forked-busy) [84.129635] Starting subtest: get-forked-busy [84.131997] Starting dynamic subtest: pipe-A-eDP-1 [86.081221] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.950s) [86.090527] Starting dynamic subtest: pipe-B-eDP-1 [88.719742] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.638s) [88.728643] Starting dynamic subtest: pipe-C-eDP-1 [91.327122] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.607s) [91.338453] Starting dynamic subtest: pipe-D-eDP-1 [93.890812] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.561s) [93.893214] Subtest get-forked-busy: SUCCESS (9.759s) [94.781572] [005/133] (929s left) sysfs_preempt_timeout (timeout) [94.848760] Starting subtest: timeout [94.851570] Starting dynamic subtest: vecs0 [104.922027] Dynamic subtest vecs0: SUCCESS (10.072s) [104.932069] Starting dynamic subtest: ccs0 [106.299708] Dynamic subtest ccs0: SUCCESS (1.374s) [106.309662] Starting dynamic subtest: vcs0 [115.923951] Dynamic subtest vcs0: SUCCESS (9.622s) [115.933833] Starting dynamic subtest: bcs0 [117.378809] Dynamic subtest bcs0: SUCCESS (1.454s) [117.389061] Starting dynamic subtest: rcs0 [118.732613] Dynamic subtest rcs0: SUCCESS (1.353s) [118.742713] Starting dynamic subtest: vcs1 [127.909327] Dynamic subtest vcs1: SUCCESS (9.174s) [127.911900] Subtest timeout: SUCCESS (33.057s) [128.003048] [006/133] (896s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-pgflip-blt) [128.116117] Starting subtest: psr-2p-scndscrn-indfb-pgflip-blt [128.120268] Subtest psr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s) [128.238227] [007/133] (896s left) gem_ctx_persistence (legacy-engines-queued) [128.297438] Starting subtest: legacy-engines-queued [128.299748] Starting dynamic subtest: render [128.414620] Dynamic subtest render: SUCCESS (0.116s) [128.424732] Starting dynamic subtest: bsd1 [129.906780] Dynamic subtest bsd1: SUCCESS (1.488s) [129.916038] Starting dynamic subtest: bsd2 [131.893044] Dynamic subtest bsd2: SUCCESS (1.984s) [131.904294] Starting dynamic subtest: blt [131.984354] Dynamic subtest blt: SUCCESS (0.090s) [131.993462] Starting dynamic subtest: vebox [133.875596] Dynamic subtest vebox: SUCCESS (1.888s) [133.878852] Subtest legacy-engines-queued: SUCCESS (5.577s) [133.977809] [008/133] (890s left) drm_read (short-buffer-block) [134.159070] Starting subtest: short-buffer-block [134.161523] Subtest short-buffer-block: SUCCESS (0.000s) [134.328175] [009/133] (890s left) gem_render_copy_redux (normal) [134.398472] Starting subtest: normal [134.670764] Subtest normal: SUCCESS (0.273s) [134.823667] [010/133] (889s left) kms_big_fb (y-tiled-32bpp-rotate-90) [134.929141] Starting subtest: y-tiled-32bpp-rotate-90 [134.932729] Subtest y-tiled-32bpp-rotate-90: SKIP (0.000s) [135.040600] [011/133] (889s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-blt) [135.142486] Starting subtest: psr-1p-primscrn-pri-indfb-draw-blt [142.575874] Subtest psr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.436s) [142.742813] [012/133] (881s left) gem_exec_suspend (basic) [142.823279] Starting subtest: basic [142.825546] Starting dynamic subtest: smem [144.852374] Dynamic subtest smem: SUCCESS (2.027s) [144.855086] Subtest basic: SUCCESS (2.028s) [145.054160] [013/133] (879s left) kms_hdmi_inject (inject-audio) [145.412071] Starting subtest: inject-audio [145.698434] Subtest inject-audio: SUCCESS (0.288s) [146.264489] [014/133] (878s left) kms_cursor_crc (cursor-sliding-32x10) [146.422627] Starting subtest: cursor-sliding-32x10 [146.470933] Subtest cursor-sliding-32x10: SKIP (0.043s) [146.773215] [015/133] (877s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc) [146.885761] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc [153.361178] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (6.479s) [153.493901] [016/133] (871s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite) [153.599576] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite [153.604244] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [153.704456] [017/133] (871s left) gem_render_copy (y-tiled-ccs-to-linear) [153.765787] Starting subtest: y-tiled-ccs-to-linear [153.770387] Subtest y-tiled-ccs-to-linear: SKIP (0.000s) [153.965235] [018/133] (870s left) kms_big_fb (4-tiled-16bpp-rotate-90) [154.061374] Starting subtest: 4-tiled-16bpp-rotate-90 [154.079993] Subtest 4-tiled-16bpp-rotate-90: SKIP (0.018s) [154.216430] [019/133] (870s left) syncobj_timeline (transfer-timeline-point) [154.275020] Starting subtest: transfer-timeline-point [154.277348] Subtest transfer-timeline-point: SUCCESS (0.001s) [154.415911] [020/133] (870s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted) [154.483213] Starting subtest: invalid-multi-wait-unsubmitted-submitted [154.485555] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s) [154.619786] [021/133] (870s left) kms_ccs (random-ccs-data-y-tiled-gen12-rc-ccs-cc) [154.706085] Starting subtest: random-ccs-data-y-tiled-gen12-rc-ccs-cc [154.708385] Starting dynamic subtest: pipe-A-eDP-1 [154.733708] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [154.743978] Starting dynamic subtest: pipe-B-eDP-1 [154.768070] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [154.776128] Starting dynamic subtest: pipe-C-eDP-1 [154.800142] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [154.808078] Starting dynamic subtest: pipe-D-eDP-1 [154.832179] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [154.836300] Subtest random-ccs-data-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s) [156.934958] [022/133] (867s left) kms_pm_rpm (dpms-mode-unset-non-lpsp) [159.060472] Starting subtest: dpms-mode-unset-non-lpsp [160.226217] Subtest dpms-mode-unset-non-lpsp: SKIP (1.165s) [160.610126] [023/133] (864s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-wc) [160.728530] Starting subtest: psr-rgb565-draw-mmap-wc [167.504675] Subtest psr-rgb565-draw-mmap-wc: SUCCESS (6.781s) [167.641223] [024/133] (857s left) kms_chamelium_edid (vga-edid-read) [168.023997] Subtest vga-edid-read: SKIP (0.000s) [168.789623] [025/133] (856s left) gem_render_copy (yf-tiled-to-vebox-y-tiled) [168.851585] Starting subtest: yf-tiled-to-vebox-y-tiled [168.856161] Subtest yf-tiled-to-vebox-y-tiled: SKIP (0.000s) [169.054406] [026/133] (856s left) kms_flip (dpms-off-confusion) [169.148295] Starting subtest: dpms-off-confusion [169.150238] Starting dynamic subtest: A-eDP1 [177.825544] Dynamic subtest A-eDP1: SUCCESS (8.643s) [177.833182] Starting dynamic subtest: B-eDP1 [186.515160] Dynamic subtest B-eDP1: SUCCESS (8.689s) [186.522991] Starting dynamic subtest: C-eDP1 [195.215621] Dynamic subtest C-eDP1: SUCCESS (8.689s) [195.225284] Starting dynamic subtest: D-eDP1 [203.915350] Dynamic subtest D-eDP1: SUCCESS (8.695s) [203.917403] Subtest dpms-off-confusion: SUCCESS (34.725s) [205.128260] [027/133] (819s left) gem_exec_big (single) [205.205297] Starting subtest: single [207.647444] Subtest single: SUCCESS (2.393s) [207.835300] [028/133] (817s left) gem_exec_flush (basic-wb-ro-default) [207.950388] Starting subtest: basic-wb-ro-default [213.413612] Subtest basic-wb-ro-default: SUCCESS (5.464s) [213.622452] [029/133] (811s left) kms_async_flips (async-flip-with-page-flip-events-linear) [213.738790] Starting subtest: async-flip-with-page-flip-events-linear [214.126193] Starting dynamic subtest: pipe-A-eDP-1 [216.855279] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.728s) [217.242577] Starting dynamic subtest: pipe-B-eDP-1 [220.054505] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.817s) [220.425060] Starting dynamic subtest: pipe-C-eDP-1 [223.151691] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.739s) [223.511581] Starting dynamic subtest: pipe-D-eDP-1 [226.241391] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.737s) [226.243829] Subtest async-flip-with-page-flip-events-linear: SUCCESS (12.503s) [227.428450] [030/133] (797s left) kms_plane_scaling (planes-downscale-factor-0-75) [227.527542] Starting subtest: planes-downscale-factor-0-75 [227.529935] Starting dynamic subtest: pipe-A [227.548787] Dynamic subtest pipe-A: SKIP (0.019s) [227.557602] Starting dynamic subtest: pipe-B [227.583423] Dynamic subtest pipe-B: SKIP (0.033s) [227.591984] Starting dynamic subtest: pipe-C [227.619188] Dynamic subtest pipe-C: SKIP (0.033s) [227.628567] Starting dynamic subtest: pipe-D [227.651333] Dynamic subtest pipe-D: SKIP (0.033s) [227.655620] Subtest planes-downscale-factor-0-75: SKIP (0.121s) [227.776827] [031/133] (797s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-pwrite) [227.885057] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-pwrite [227.889072] Subtest psr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [228.011171] [032/133] (797s left) kms_properties (colorop-properties-legacy) [228.105963] Starting subtest: colorop-properties-legacy [228.107826] Starting dynamic subtest: pipe-A-eDP-1 [228.468677] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.362s) [228.477207] Starting dynamic subtest: pipe-B-eDP-1 [229.537742] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.067s) [229.547080] Starting dynamic subtest: pipe-C-eDP-1 [230.639901] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.103s) [230.650680] Starting dynamic subtest: pipe-D-eDP-1 [231.749288] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.107s) [231.751569] Subtest colorop-properties-legacy: SUCCESS (3.645s) [232.631885] [033/133] (792s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu) [232.735843] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu [232.739962] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [232.850334] [034/133] (792s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs) [232.951286] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs [232.953861] Starting dynamic subtest: pipe-A-eDP-1 [232.974060] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.002s) [232.982911] Starting dynamic subtest: pipe-B-eDP-1 [233.002283] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [233.010096] Starting dynamic subtest: pipe-C-eDP-1 [233.028771] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [233.036283] Starting dynamic subtest: pipe-D-eDP-1 [233.055099] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [233.057017] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs: SUCCESS (0.011s) [235.223700] [035/133] (790s left) gem_wait (wait) [235.294062] Starting subtest: wait [235.296229] Starting dynamic subtest: all-engines [236.883919] Dynamic subtest all-engines: SUCCESS (1.591s) [236.893111] Starting dynamic subtest: rcs0 [237.930407] Dynamic subtest rcs0: SUCCESS (1.045s) [237.941263] Starting dynamic subtest: bcs0 [238.978200] Dynamic subtest bcs0: SUCCESS (1.046s) [238.988290] Starting dynamic subtest: vcs0 [240.023949] Dynamic subtest vcs0: SUCCESS (1.043s) [240.034800] Starting dynamic subtest: vcs1 [241.069407] Dynamic subtest vcs1: SUCCESS (1.044s) [241.080275] Starting dynamic subtest: vecs0 [242.113538] Dynamic subtest vecs0: SUCCESS (1.042s) [242.124748] Starting dynamic subtest: ccs0 [243.161687] Dynamic subtest ccs0: SUCCESS (1.046s) [243.164321] Subtest wait: SUCCESS (7.871s) [243.381522] [036/133] (782s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc) [243.492272] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc [243.496212] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [243.630446] [037/133] (781s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip) [243.737796] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip [244.739522] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.002s) [244.905918] [038/133] (780s left) gem_exec_reloc (basic-concurrent0) [244.968152] Subtest basic-concurrent0: SKIP (0.000s) [245.050904] [039/133] (780s left) kms_big_fb (yf-tiled-32bpp-rotate-180) [245.161941] Starting subtest: yf-tiled-32bpp-rotate-180 [245.165508] Subtest yf-tiled-32bpp-rotate-180: SKIP (0.000s) [245.273781] [040/133] (780s left) kms_lease (cursor-implicit-plane) [245.373532] Starting subtest: cursor-implicit-plane [245.375466] Starting dynamic subtest: pipe-A-eDP-1 [245.847758] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.472s) [245.856076] Starting dynamic subtest: pipe-B-eDP-1 [247.006375] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.158s) [247.015679] Starting dynamic subtest: pipe-C-eDP-1 [248.079945] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.071s) [248.088171] Starting dynamic subtest: pipe-D-eDP-1 [249.179434] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.098s) [249.181672] Subtest cursor-implicit-plane: SUCCESS (3.806s) [250.021894] [041/133] (775s left) gem_exec_schedule (u-semaphore-resolve) [250.107470] Starting subtest: u-semaphore-resolve [250.134794] Subtest u-semaphore-resolve: SUCCESS (0.037s) [250.514080] [042/133] (775s left) gem_exec_whisper (basic-fds-priority) [250.585991] Starting subtest: basic-fds-priority [274.481493] Subtest basic-fds-priority: SUCCESS (23.894s) [274.685762] [043/133] (751s left) i915_query (query-topology-known-pci-ids) [274.758269] Starting subtest: query-topology-known-pci-ids [274.762771] Subtest query-topology-known-pci-ids: SKIP (0.000s) [274.902200] [044/133] (750s left) kms_big_fb (yf-tiled-64bpp-rotate-90) [274.996478] Starting subtest: yf-tiled-64bpp-rotate-90 [275.000536] Subtest yf-tiled-64bpp-rotate-90: SKIP (0.000s) [275.120306] [045/133] (750s left) perf_pmu (idle) [275.160537] Starting subtest: idle [275.162877] Starting dynamic subtest: rcs0 [275.728416] Dynamic subtest rcs0: SUCCESS (0.565s) [275.738614] Starting dynamic subtest: bcs0 [276.249623] Dynamic subtest bcs0: SUCCESS (0.519s) [276.261033] Starting dynamic subtest: vcs0 [276.776058] Dynamic subtest vcs0: SUCCESS (0.524s) [276.787203] Starting dynamic subtest: vcs1 [277.309086] Dynamic subtest vcs1: SUCCESS (0.531s) [277.319852] Starting dynamic subtest: vecs0 [277.836021] Dynamic subtest vecs0: SUCCESS (0.524s) [277.847863] Starting dynamic subtest: ccs0 [278.364617] Dynamic subtest ccs0: SUCCESS (0.526s) [278.367335] Subtest idle: SUCCESS (3.204s) [278.500258] [046/133] (747s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-pwrite) [278.594182] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-pwrite [278.598129] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s) [278.715350] [047/133] (747s left) gem_exec_flush (basic-uc-pro-default) [278.779442] Starting subtest: basic-uc-pro-default [284.250778] Subtest basic-uc-pro-default: SUCCESS (5.467s) [284.459221] [048/133] (741s left) gem_basic (bad-close) [284.516878] Starting subtest: bad-close [284.521096] Subtest bad-close: SUCCESS (0.000s) [284.654682] [049/133] (741s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc) [284.765741] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc [284.770243] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [284.877609] [050/133] (741s left) kms_plane (pixel-format) [284.974015] Starting subtest: pixel-format [285.002091] Starting dynamic subtest: pipe-A-plane-0 [289.801717] Dynamic subtest pipe-A-plane-0: SUCCESS (4.800s) [289.812872] Starting dynamic subtest: pipe-A-plane-3 [292.280491] Dynamic subtest pipe-A-plane-3: SUCCESS (2.477s) [292.289691] Starting dynamic subtest: pipe-A-plane-5 [292.490862] Dynamic subtest pipe-A-plane-5: SUCCESS (0.210s) [293.562819] Starting dynamic subtest: pipe-B-plane-0 [298.354742] Dynamic subtest pipe-B-plane-0: SUCCESS (4.800s) [298.365704] Starting dynamic subtest: pipe-B-plane-3 [300.698944] Dynamic subtest pipe-B-plane-3: SUCCESS (2.340s) [300.707546] Starting dynamic subtest: pipe-B-plane-5 [300.921240] Dynamic subtest pipe-B-plane-5: SUCCESS (0.222s) [301.243094] Subtest pixel-format: SUCCESS (16.268s) [302.114837] [051/133] (723s left) kms_psr (fbc-psr2-no-drrs) [302.222138] Starting subtest: fbc-psr2-no-drrs [302.224401] Starting dynamic subtest: eDP-1 [302.228644] Dynamic subtest eDP-1: SKIP (0.000s) [302.232824] Subtest fbc-psr2-no-drrs: SKIP (0.001s) [302.323394] [052/133] (723s left) gem_mmap (bad-size) [302.377660] Subtest bad-size: SKIP (0.000s) [302.442143] [053/133] (723s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt) [302.544656] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt [302.548789] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [302.667130] [054/133] (723s left) api_intel_bb (crc32) [302.718805] Starting subtest: crc32 [302.720803] Starting dynamic subtest: rcs0-smem0 [302.988186] Dynamic subtest rcs0-smem0: SUCCESS (0.270s) [303.000309] Starting dynamic subtest: bcs0-smem0 [303.316382] Dynamic subtest bcs0-smem0: SUCCESS (0.324s) [303.328420] Starting dynamic subtest: vcs0-smem0 [303.635223] Dynamic subtest vcs0-smem0: SUCCESS (0.318s) [303.646088] Starting dynamic subtest: vcs1-smem0 [303.946405] Dynamic subtest vcs1-smem0: SUCCESS (0.308s) [303.958679] Starting dynamic subtest: vecs0-smem0 [304.244038] Dynamic subtest vecs0-smem0: SUCCESS (0.295s) [304.255334] Starting dynamic subtest: ccs0-smem0 [304.558372] Dynamic subtest ccs0-smem0: SUCCESS (0.311s) [304.561248] Subtest crc32: SUCCESS (1.841s) [304.721993] [055/133] (721s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt) [304.833657] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt [304.837746] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [304.967603] [056/133] (721s left) kms_psr (psr2-cursor-render) [305.070195] Starting subtest: psr2-cursor-render [305.072455] Starting dynamic subtest: eDP-1 [306.757041] Dynamic subtest eDP-1: SUCCESS (1.688s) [306.759260] Subtest psr2-cursor-render: SUCCESS (1.688s) [307.629134] [057/133] (718s left) kms_flip (2x-flip-vs-wf_vblank-interruptible) [307.732350] Starting subtest: 2x-flip-vs-wf_vblank-interruptible [307.744290] Subtest 2x-flip-vs-wf_vblank-interruptible: SKIP (0.011s) [307.843956] [058/133] (718s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs) [307.933976] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs [307.936175] Starting dynamic subtest: pipe-A-eDP-1 [308.430110] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.470s) [308.440103] Starting dynamic subtest: pipe-B-eDP-1 [309.949067] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.516s) [309.959867] Starting dynamic subtest: pipe-C-eDP-1 [311.357100] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.404s) [311.367783] Starting dynamic subtest: pipe-D-eDP-1 [312.761262] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.406s) [312.763496] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SUCCESS (4.802s) [314.019214] [059/133] (712s left) kms_dp_linktrain_fallback (dp-fallback) [314.129899] Starting subtest: dp-fallback [314.140673] Subtest dp-fallback: SKIP (0.000s) [314.227641] [060/133] (712s left) gem_readwrite (beyond-eob) [314.290880] Subtest beyond-EOB: SKIP (0.000s) [314.360158] [061/133] (712s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt) [314.450860] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt [318.913039] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (4.465s) [320.135432] [062/133] (706s left) prime_vgem (basic-fence-read) [320.262935] Starting subtest: basic-fence-read [320.273256] Subtest basic-fence-read: SKIP (0.008s) [320.417568] [FACT prime_vgem (basic-fence-read)] new: kernel.kmod_is_loaded.vgem: true [320.421656] [063/133] (706s left) perf_pmu (interrupts) [320.469602] Starting subtest: interrupts [321.517389] Subtest interrupts: SUCCESS (1.047s) [321.663509] [064/133] (704s left) i915_pm_rpm (system-suspend-devices) [323.192663] Starting subtest: system-suspend-devices [330.984090] Subtest system-suspend-devices: SUCCESS (7.796s) [331.381542] [065/133] (695s left) kms_flip (flip-vs-dpms-on-nop-interruptible) [331.500612] Starting subtest: flip-vs-dpms-on-nop-interruptible [331.502956] Starting dynamic subtest: A-eDP1 [333.352257] Dynamic subtest A-eDP1: SUCCESS (1.850s) [333.364742] Starting dynamic subtest: B-eDP1 [335.258826] Dynamic subtest B-eDP1: SUCCESS (1.903s) [335.271626] Starting dynamic subtest: C-eDP1 [337.148559] Dynamic subtest C-eDP1: SUCCESS (1.886s) [337.158316] Starting dynamic subtest: D-eDP1 [338.940162] Dynamic subtest D-eDP1: SUCCESS (1.791s) [338.945548] Subtest flip-vs-dpms-on-nop-interruptible: SUCCESS (7.444s) [340.215743] [066/133] (686s left) kms_ccs (crc-primary-basic-y-tiled-ccs) [340.310217] Starting subtest: crc-primary-basic-y-tiled-ccs [340.312514] Starting dynamic subtest: pipe-A-eDP-1 [340.335096] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [340.350265] Starting dynamic subtest: pipe-B-eDP-1 [340.372449] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [340.383471] Starting dynamic subtest: pipe-C-eDP-1 [340.405252] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [340.414227] Starting dynamic subtest: pipe-D-eDP-1 [340.436580] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [340.440999] Subtest crc-primary-basic-y-tiled-ccs: SKIP (0.006s) [342.629365] [067/133] (684s left) kms_color (ctm-0-75) [342.744248] Starting subtest: ctm-0-75 [342.746491] Starting dynamic subtest: pipe-A-eDP-1 [347.744273] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.998s) [347.754933] Starting dynamic subtest: pipe-B-eDP-1 [353.353454] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.607s) [353.363827] Starting dynamic subtest: pipe-C-eDP-1 [358.715626] Dynamic subtest pipe-C-eDP-1: SUCCESS (5.362s) [358.725611] Starting dynamic subtest: pipe-D-eDP-1 [364.006134] Dynamic subtest pipe-D-eDP-1: SUCCESS (5.288s) [364.008500] Subtest ctm-0-75: SUCCESS (21.260s) [364.834398] [068/133] (661s left) gem_mmap_offset (partial-mmap) [364.915086] Starting subtest: partial-mmap [364.917427] Starting dynamic subtest: smem0 [364.922478] Dynamic subtest smem0: SUCCESS (0.005s) [364.924829] Subtest partial-mmap: SUCCESS (0.007s) [365.050251] [069/133] (661s left) syncobj_timeline (device-signal-unordered) [365.111618] Starting subtest: device-signal-unordered [365.113911] Subtest device-signal-unordered: SUCCESS (0.000s) [365.247802] [070/133] (661s left) kms_pm_dc (dc6-psr) [366.355028] Starting subtest: dc6-psr [369.237547] Subtest dc6-psr: SUCCESS (2.880s) [370.115416] [071/133] (656s left) kms_cursor_legacy (cursorb-vs-flipb-varying-size) [370.250536] Starting subtest: cursorB-vs-flipB-varying-size [370.255138] Subtest cursorB-vs-flipB-varying-size: SKIP (0.001s) [370.420046] [072/133] (656s left) kms_addfb_basic (no-handle) [370.481420] Starting subtest: no-handle [370.483599] Subtest no-handle: SUCCESS (0.000s) [370.674821] [073/133] (656s left) gem_pxp (create-regular-buffer) [370.806011] Starting subtest: create-regular-buffer [370.808444] Subtest create-regular-buffer: SUCCESS (0.000s) [370.982569] [074/133] (656s left) kms_flip (2x-dpms-vs-vblank-race) [371.085389] Starting subtest: 2x-dpms-vs-vblank-race [371.097541] Subtest 2x-dpms-vs-vblank-race: SKIP (0.013s) [371.224943] [075/133] (655s left) kms_psr (psr-dpms) [371.323529] Starting subtest: psr-dpms [371.325513] Starting dynamic subtest: eDP-1 [374.269128] Dynamic subtest eDP-1: SUCCESS (2.945s) [374.271387] Subtest psr-dpms: SUCCESS (2.946s) [375.113905] [076/133] (651s left) gem_lmem_swapping (massive-random) [375.162426] Subtest massive-random: SKIP (0.000s) [375.210105] [077/133] (651s left) gen9_exec_parse (bb-secure) [375.272803] Subtest bb-secure: SKIP (0.000s) [375.342859] [078/133] (651s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-render) [375.440785] Starting subtest: psr-2p-primscrn-pri-indfb-draw-render [375.444791] Subtest psr-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s) [375.581588] [079/133] (651s left) i915_suspend (fence-restore-untiled) [375.638247] Starting subtest: fence-restore-untiled [375.642737] Subtest fence-restore-untiled: SKIP (0.000s) [375.754337] [080/133] (651s left) syncobj_wait (wait-delayed-signal) [375.817165] Starting subtest: wait-delayed-signal [375.920199] Subtest wait-delayed-signal: SUCCESS (0.104s) [376.025860] [081/133] (651s left) kms_ccs (bad-pixel-format-yf-tiled-ccs) [376.122360] Starting subtest: bad-pixel-format-yf-tiled-ccs [376.124651] Starting dynamic subtest: pipe-A-eDP-1 [376.148324] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [376.160465] Starting dynamic subtest: pipe-B-eDP-1 [376.182305] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [376.192095] Starting dynamic subtest: pipe-C-eDP-1 [376.213839] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [376.223017] Starting dynamic subtest: pipe-D-eDP-1 [376.245242] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [376.249283] Subtest bad-pixel-format-yf-tiled-ccs: SKIP (0.004s) [378.414784] [082/133] (648s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-render) [378.510998] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-render [378.515316] Subtest fbc-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s) [378.622934] [083/133] (648s left) kms_chamelium_hpd (dp-hpd-fast) [379.021297] Subtest dp-hpd-fast: SKIP (0.000s) [379.870360] [084/133] (647s left) gem_exec_balancer (bonded-false-hang) [380.129477] Starting subtest: bonded-false-hang [380.134591] Subtest bonded-false-hang: SKIP (0.000s) [380.281177] [085/133] (647s left) kms_ccs (crc-primary-suspend-yf-tiled-ccs) [380.371038] Starting subtest: crc-primary-suspend-yf-tiled-ccs [380.373212] Starting dynamic subtest: pipe-A-eDP-1 [380.382061] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [380.392423] Starting dynamic subtest: pipe-B-eDP-1 [380.401293] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [380.411117] Starting dynamic subtest: pipe-C-eDP-1 [380.419124] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [380.427790] Starting dynamic subtest: pipe-D-eDP-1 [380.435777] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [380.439619] Subtest crc-primary-suspend-yf-tiled-ccs: SKIP (0.005s) [382.616130] [086/133] (644s left) gem_exec_fence (syncobj-timeline-invalid-flags) [383.163448] Starting subtest: syncobj-timeline-invalid-flags [383.165518] Subtest syncobj-timeline-invalid-flags: SUCCESS (0.000s) [385.041813] [087/133] (642s left) kms_plane_cursor (overlay) [385.135044] Starting subtest: overlay [385.139376] Starting dynamic subtest: pipe-A-eDP-1-size-64 [387.700219] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.566s) [387.763706] Starting dynamic subtest: pipe-A-eDP-1-size-128 [390.378097] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.626s) [390.437305] Starting dynamic subtest: pipe-A-eDP-1-size-256 [393.034908] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.604s) [393.384712] Starting dynamic subtest: pipe-B-eDP-1-size-64 [396.633602] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.262s) [396.696244] Starting dynamic subtest: pipe-B-eDP-1-size-128 [399.237103] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.548s) [399.298195] Starting dynamic subtest: pipe-B-eDP-1-size-256 [401.849381] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.559s) [402.202649] Starting dynamic subtest: pipe-C-eDP-1-size-64 [405.088445] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.896s) [405.130248] Starting dynamic subtest: pipe-C-eDP-1-size-128 [407.323751] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.204s) [407.364295] Starting dynamic subtest: pipe-C-eDP-1-size-256 [409.577199] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.224s) [409.911373] Starting dynamic subtest: pipe-D-eDP-1-size-64 [412.760384] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.860s) [412.798458] Starting dynamic subtest: pipe-D-eDP-1-size-128 [414.993395] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.202s) [415.037215] Starting dynamic subtest: pipe-D-eDP-1-size-256 [417.194792] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.169s) [417.513630] Subtest overlay: SUCCESS (32.379s) [418.415417] [088/133] (609s left) gem_ctx_param (basic-default) [418.486891] Starting subtest: basic-default [418.489382] Subtest basic-default: SUCCESS (0.000s) [418.586480] [089/133] (609s left) api_intel_allocator (two-level-inception-interruptible) [418.645505] Starting subtest: two-level-inception-interruptible [424.101273] Subtest two-level-inception-interruptible: SUCCESS (5.405s) [424.209279] [090/133] (603s left) kms_dsc (dsc-with-bpc-formats) [424.309947] Starting subtest: dsc-with-bpc-formats [424.416324] Subtest dsc-with-bpc-formats: SKIP (0.004s) [424.459991] [091/133] (603s left) kms_cursor_crc (cursor-alpha-opaque) [424.566314] Starting subtest: cursor-alpha-opaque [424.568487] Starting dynamic subtest: pipe-A-eDP-1 [425.185253] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.618s) [425.195180] Starting dynamic subtest: pipe-D-eDP-1 [426.426772] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.242s) [426.429086] Subtest cursor-alpha-opaque: SUCCESS (1.863s) [427.305234] [092/133] (600s left) syncobj_timeline (multi-wait-all-signaled) [427.367447] Starting subtest: multi-wait-all-signaled [427.369816] Subtest multi-wait-all-signaled: SUCCESS (0.000s) [427.487294] [093/133] (600s left) i915_drm_fdinfo (isolation) [427.530567] Starting subtest: isolation [427.532917] Starting dynamic subtest: rcs0 [427.551643] Dynamic subtest rcs0: SKIP (0.019s) [427.561507] Starting dynamic subtest: bcs0 [427.565885] Dynamic subtest bcs0: SKIP (0.000s) [427.575043] Starting dynamic subtest: vcs0 [427.579271] Dynamic subtest vcs0: SKIP (0.000s) [427.588596] Starting dynamic subtest: vcs1 [427.592696] Dynamic subtest vcs1: SKIP (0.000s) [427.601896] Starting dynamic subtest: vecs0 [427.606072] Dynamic subtest vecs0: SKIP (0.000s) [427.615084] Starting dynamic subtest: ccs0 [427.619198] Dynamic subtest ccs0: SKIP (0.000s) [427.623201] Subtest isolation: SKIP (0.024s) [427.659284] [094/133] (600s left) kms_flip_scaled_crc (flip-p016-linear-to-p016-linear-reflect-x) [427.750407] Starting subtest: flip-P016-linear-to-P016-linear-reflect-x [427.752656] Starting dynamic subtest: pipe-A-default-mode [428.921577] Dynamic subtest pipe-A-default-mode: SKIP (1.168s) [428.926225] Subtest flip-P016-linear-to-P016-linear-reflect-x: SKIP (1.170s) [429.107814] [095/133] (598s left) gem_ctx_isolation (preservation-s3) [429.172755] Starting subtest: preservation-S3 [429.175102] Starting dynamic subtest: rcs0 [445.287225] Dynamic subtest rcs0: SUCCESS (1.369s) [445.297689] Starting dynamic subtest: bcs0 [461.256727] Dynamic subtest bcs0: SUCCESS (1.317s) [461.267171] Starting dynamic subtest: vcs0 [477.276678] Dynamic subtest vcs0: SUCCESS (3.173s) [477.292729] Starting dynamic subtest: vcs1 [495.284171] Dynamic subtest vcs1: SUCCESS (5.203s) [495.295033] Starting dynamic subtest: vecs0 [513.276780] Dynamic subtest vecs0: SUCCESS (5.025s) [513.289753] Starting dynamic subtest: ccs0 [531.312058] Dynamic subtest ccs0: SUCCESS (3.336s) [531.318332] Subtest preservation-S3: SUCCESS (19.429s) [531.591594] [096/133] (496s left) gem_eio (reset-stress) [531.836941] Starting subtest: reset-stress [531.839179] Starting dynamic subtest: render [537.062110] Dynamic subtest render: SUCCESS (5.330s) [537.080867] Starting dynamic subtest: bsd1 [555.565296] Dynamic subtest bsd1: SUCCESS (18.605s) [555.582783] Starting dynamic subtest: bsd2 [573.577589] Dynamic subtest bsd2: SUCCESS (18.016s) [573.594057] Starting dynamic subtest: blt [573.598428] Dynamic subtest blt: SKIP (0.000s) [573.609055] Starting dynamic subtest: vebox [591.631174] Dynamic subtest vebox: SUCCESS (18.053s) [591.633761] Subtest reset-stress: SUCCESS (60.011s) [593.084677] [097/133] (434s left) gem_softpin (evict-snoop-interruptible) [593.168558] Starting subtest: evict-snoop-interruptible [593.174207] Subtest evict-snoop-interruptible: SKIP (0.000s) [593.338748] [098/133] (434s left) i915_module_load (reload-no-display) [593.370223] Starting subtest: reload-no-display [599.432023] Subtest reload-no-display: SUCCESS (6.062s) [599.466383] [FACT i915_module_load (reload-no-display)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [599.467104] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true [599.471609] [099/133] (428s left) kms_flip (2x-flip-vs-modeset) [602.444408] Starting subtest: 2x-flip-vs-modeset [602.455711] Subtest 2x-flip-vs-modeset: SKIP (0.011s) [602.590902] [FACT kms_flip (2x-flip-vs-modeset)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [602.592167] [FACT kms_flip (2x-flip-vs-modeset)] new: kernel.kmod_is_loaded.i915: true [602.596407] [100/133] (425s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling) [602.700907] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling [602.703121] Starting dynamic subtest: pipe-A-default-mode [602.996312] Dynamic subtest pipe-A-default-mode: SKIP (0.292s) [603.001881] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.293s) [603.879771] [101/133] (424s left) kms_content_protection (type1) [604.045804] Starting subtest: type1 [604.051396] Subtest type1: SKIP (0.000s) [604.215883] [102/133] (423s left) kms_big_fb (4-tiled-16bpp-rotate-180) [604.320552] Starting subtest: 4-tiled-16bpp-rotate-180 [605.597045] Subtest 4-tiled-16bpp-rotate-180: SUCCESS (1.278s) [605.748764] [103/133] (422s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render) [605.851184] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render [605.855641] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s) [605.982832] [104/133] (422s left) gem_ppgtt (flink-and-close-vma-leak) [606.039179] Starting subtest: flink-and-close-vma-leak [606.083885] Subtest flink-and-close-vma-leak: SUCCESS (0.045s) [606.233905] [105/133] (422s left) syncobj_wait (signal) [606.300071] Starting subtest: signal [606.302134] Subtest signal: SUCCESS (0.000s) [606.437547] [106/133] (421s left) kms_cursor_crc (cursor-rapid-movement-128x128) [606.635037] Starting subtest: cursor-rapid-movement-128x128 [606.640136] Starting dynamic subtest: pipe-A-eDP-1 [607.271106] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.629s) [607.304214] Starting dynamic subtest: pipe-D-eDP-1 [608.693940] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.396s) [608.696388] Subtest cursor-rapid-movement-128x128: SUCCESS (2.058s) [609.549006] [107/133] (418s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf) [614.598193] Starting subtest: fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf [614.601077] Starting dynamic subtest: pipe-A-eDP-1 [615.395223] Dynamic subtest pipe-A-eDP-1: SKIP (0.797s) [615.406117] Starting dynamic subtest: pipe-B-eDP-1 [616.528519] Dynamic subtest pipe-B-eDP-1: SKIP (1.129s) [616.534016] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf: SKIP (1.930s) [617.742995] [108/133] (410s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc) [617.855386] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc [624.453702] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (6.602s) [624.626830] [109/133] (403s left) kms_vblank (query-forked-busy) [624.719026] Starting subtest: query-forked-busy [624.721432] Starting dynamic subtest: pipe-A-eDP-1 [626.596339] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.877s) [626.613177] Starting dynamic subtest: pipe-D-eDP-1 [629.207428] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.606s) [629.210231] Subtest query-forked-busy: SUCCESS (4.487s) [630.032473] [110/133] (398s left) syncobj_timeline (invalid-transfer-non-existent-point) [630.093224] Starting subtest: invalid-transfer-non-existent-point [630.096230] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s) [630.215544] [111/133] (398s left) kms_big_fb (x-tiled-16bpp-rotate-0) [630.327665] Starting subtest: x-tiled-16bpp-rotate-0 [631.582148] Subtest x-tiled-16bpp-rotate-0: SUCCESS (1.256s) [631.750928] [112/133] (396s left) kms_psr (fbc-psr-primary-blt) [631.839813] Starting subtest: fbc-psr-primary-blt [631.842238] Starting dynamic subtest: eDP-1 [631.846293] Dynamic subtest eDP-1: SKIP (0.000s) [631.850685] Subtest fbc-psr-primary-blt: SKIP (0.001s) [631.934787] [113/133] (396s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-submi [631.996154] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-submitted [632.102813] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-submitted: SUCCESS (0.106s) [632.204654] [114/133] (396s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-wc) [632.317269] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-wc [632.322241] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [632.445656] [115/133] (396s left) gem_exec_reloc (basic-cpu-active) [632.520451] Subtest basic-cpu-active: SKIP (0.000s) [632.591016] [116/133] (396s left) perf (rc6-disable) [632.739399] Starting subtest: rc6-disable [632.911583] Subtest rc6-disable: SUCCESS (0.174s) [632.958866] [117/133] (395s left) gem_ctx_shared (q-independent) [633.023138] Starting subtest: Q-independent [633.025918] Starting dynamic subtest: rcs0 [633.092718] Dynamic subtest rcs0: SUCCESS (0.069s) [633.105328] Starting dynamic subtest: vcs0 [633.133105] Dynamic subtest vcs0: SUCCESS (0.040s) [633.144146] Starting dynamic subtest: vcs1 [633.169016] Dynamic subtest vcs1: SUCCESS (0.035s) [633.178906] Starting dynamic subtest: vecs0 [633.203899] Dynamic subtest vecs0: SUCCESS (0.034s) [633.213389] Starting dynamic subtest: ccs0 [633.245249] Dynamic subtest ccs0: SUCCESS (0.040s) [633.248030] Subtest Q-independent: SUCCESS (0.223s) [635.167210] [118/133] (393s left) perf (non-zero-reason) [635.280177] Starting subtest: non-zero-reason [635.282614] Starting dynamic subtest: 0-rcs0 [640.715530] Dynamic subtest 0-rcs0: SUCCESS (5.383s) [640.727719] Starting dynamic subtest: 1-vecs0 [644.576216] Dynamic subtest 1-vecs0: SUCCESS (3.911s) [644.579391] Subtest non-zero-reason: SUCCESS (9.296s) [644.627591] [119/133] (384s left) kms_psr (pr-dpms) [644.732208] Starting subtest: pr-dpms [644.737159] Subtest pr-dpms: SKIP (0.000s) [644.829766] [120/133] (384s left) kms_rotation_crc (primary-rotation-180) [644.924424] Starting subtest: primary-rotation-180 [652.284421] Subtest primary-rotation-180: SUCCESS (7.362s) [653.495517] [121/133] (375s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render) [653.601264] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render [660.989769] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.390s) [661.140303] [122/133] (367s left) gem_create (create-size-update) [661.199179] Starting subtest: create-size-update [661.202137] Subtest create-size-update: SUCCESS (0.000s) [661.455704] [123/133] (367s left) prime_vgem (basic-fence-blt) [661.553947] Starting subtest: basic-fence-blt [661.656921] Subtest basic-fence-blt: SUCCESS (0.103s) [661.818840] [124/133] (367s left) kms_getfb (getfb2-into-addfb2) [661.919147] Starting subtest: getfb2-into-addfb2 [661.921866] Subtest getfb2-into-addfb2: SUCCESS (0.000s) [662.054097] [125/133] (367s left) gem_pxp (verify-pxp-execution-after-suspend-resume) [662.169715] Starting subtest: verify-pxp-execution-after-suspend-resume [669.220078] Subtest verify-pxp-execution-after-suspend-resume: SUCCESS (7.051s) [669.373607] [126/133] (359s left) syncobj_basic (bad-pad-fd-to-handle) [669.442322] Starting subtest: bad-pad-fd-to-handle [669.445140] Subtest bad-pad-fd-to-handle: SUCCESS (0.000s) [669.558786] [127/133] (359s left) dmabuf_sync_file (export-before-signal) [669.608384] Starting subtest: export-before-signal [669.611339] Subtest export-before-signal: SUCCESS (0.001s) [669.690119] [128/133] (359s left) kms_flip (2x-flip-vs-panning-vs-hang) [669.781682] Starting subtest: 2x-flip-vs-panning-vs-hang [669.790454] Subtest 2x-flip-vs-panning-vs-hang: SKIP (0.011s) [669.925801] [129/133] (359s left) gem_softpin (allocator-nopin-reserve) [669.990087] Starting subtest: allocator-nopin-reserve [670.068759] Subtest allocator-nopin-reserve: SUCCESS (0.083s) [670.241775] [130/133] (359s left) kms_pipe_crc_basic (read-crc-frame-sequence) [670.337440] Starting subtest: read-crc-frame-sequence [670.341277] Starting dynamic subtest: pipe-A-eDP-1 [671.044423] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.705s) [671.056108] Starting dynamic subtest: pipe-B-eDP-1 [672.426307] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.380s) [672.436945] Starting dynamic subtest: pipe-C-eDP-1 [673.748396] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.318s) [673.761459] Starting dynamic subtest: pipe-D-eDP-1 [675.062019] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.315s) [675.064817] Subtest read-crc-frame-sequence: SUCCESS (4.726s) [675.916595] [131/133] (353s left) kms_frontbuffer_tracking (pipe-fbc-rte) [676.017137] Starting subtest: pipe-fbc-rte [676.025930] Starting dynamic subtest: pipe-B-eDP-1 [681.488983] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.477s) [681.497748] Subtest pipe-fbc-rte: SUCCESS (5.480s) [683.822586] [132/133] (345s left) kms_addfb_basic (too-wide) [683.921149] Starting subtest: too-wide [683.923827] Subtest too-wide: SUCCESS (0.000s) [684.054231] [133/133] (345s left) gem_exec_schedule (pi-shared-iova) [684.247542] Starting subtest: pi-shared-iova [684.250157] Starting dynamic subtest: rcs0 [684.322210] Dynamic subtest rcs0: SUCCESS (0.077s) [684.337109] Starting dynamic subtest: vcs0 [684.375435] Dynamic subtest vcs0: SUCCESS (0.053s) [684.389125] Starting dynamic subtest: vcs1 [684.425914] Dynamic subtest vcs1: SUCCESS (0.050s) [684.438007] Starting dynamic subtest: vecs0 [684.476633] Dynamic subtest vecs0: SUCCESS (0.049s) [684.489092] Starting dynamic subtest: ccs0 [684.534853] Dynamic subtest ccs0: SUCCESS (0.058s) [684.537642] Subtest pi-shared-iova: SUCCESS (0.290s) [686.132149] Closing watchdogs results: parsing output: 0/ for test: syncobj_basic results: parsing output: 1/ for test: kms_psr2_sf results: parsing output: 2/ for test: gem_ccs results: parsing output: 3/ for test: kms_sequence results: parsing output: 4/ for test: sysfs_preempt_timeout results: parsing output: 5/ for test: kms_frontbuffer_tracking results: parsing output: 6/ for test: gem_ctx_persistence results: parsing output: 7/ for test: drm_read results: parsing output: 8/ for test: gem_render_copy_redux results: parsing output: 9/ for test: kms_big_fb results: parsing output: 10/ for test: kms_frontbuffer_tracking results: parsing output: 11/ for test: gem_exec_suspend results: parsing output: 12/ for test: kms_hdmi_inject results: parsing output: 13/ for test: kms_cursor_crc results: parsing output: 14/ for test: kms_frontbuffer_tracking results: parsing output: 15/ for test: kms_frontbuffer_tracking results: parsing output: 16/ for test: gem_render_copy results: parsing output: 17/ for test: kms_big_fb results: parsing output: 18/ for test: syncobj_timeline results: parsing output: 19/ for test: syncobj_wait results: parsing output: 20/ for test: kms_ccs results: parsing output: 21/ for test: kms_pm_rpm results: parsing output: 22/ for test: kms_frontbuffer_tracking results: parsing output: 23/ for test: kms_chamelium_edid results: parsing output: 24/ for test: gem_render_copy results: parsing output: 25/ for test: kms_flip results: parsing output: 26/ for test: gem_exec_big results: parsing output: 27/ for test: gem_exec_flush results: parsing output: 28/ for test: kms_async_flips results: parsing output: 29/ for test: kms_plane_scaling results: parsing output: 30/ for test: kms_frontbuffer_tracking results: parsing output: 31/ for test: kms_properties results: parsing output: 32/ for test: kms_frontbuffer_tracking results: parsing output: 33/ for test: kms_ccs results: parsing output: 34/ for test: gem_wait results: parsing output: 35/ for test: kms_frontbuffer_tracking results: parsing output: 36/ for test: kms_big_fb results: parsing output: 37/ for test: gem_exec_reloc results: parsing output: 38/ for test: kms_big_fb results: parsing output: 39/ for test: kms_lease results: parsing output: 40/ for test: gem_exec_schedule results: parsing output: 41/ for test: gem_exec_whisper results: parsing output: 42/ for test: i915_query results: parsing output: 43/ for test: kms_big_fb results: parsing output: 44/ for test: perf_pmu results: parsing output: 45/ for test: kms_frontbuffer_tracking results: parsing output: 46/ for test: gem_exec_flush results: parsing output: 47/ for test: gem_basic results: parsing output: 48/ for test: kms_frontbuffer_tracking results: parsing output: 49/ for test: kms_plane results: parsing output: 50/ for test: kms_psr results: parsing output: 51/ for test: gem_mmap results: parsing output: 52/ for test: kms_frontbuffer_tracking results: parsing output: 53/ for test: api_intel_bb results: parsing output: 54/ for test: kms_frontbuffer_tracking results: parsing output: 55/ for test: kms_psr results: parsing output: 56/ for test: kms_flip results: parsing output: 57/ for test: kms_ccs results: parsing output: 58/ for test: kms_dp_linktrain_fallback results: parsing output: 59/ for test: gem_readwrite results: parsing output: 60/ for test: kms_frontbuffer_tracking results: parsing output: 61/ for test: prime_vgem results: parsing output: 62/ for test: perf_pmu results: parsing output: 63/ for test: i915_pm_rpm results: parsing output: 64/ for test: kms_flip results: parsing output: 65/ for test: kms_ccs results: parsing output: 66/ for test: kms_color results: parsing output: 67/ for test: gem_mmap_offset results: parsing output: 68/ for test: syncobj_timeline results: parsing output: 69/ for test: kms_pm_dc results: parsing output: 70/ for test: kms_cursor_legacy results: parsing output: 71/ for test: kms_addfb_basic results: parsing output: 72/ for test: gem_pxp results: parsing output: 73/ for test: kms_flip results: parsing output: 74/ for test: kms_psr results: parsing output: 75/ for test: gem_lmem_swapping results: parsing output: 76/ for test: gen9_exec_parse results: parsing output: 77/ for test: kms_frontbuffer_tracking results: parsing output: 78/ for test: i915_suspend results: parsing output: 79/ for test: syncobj_wait results: parsing output: 80/ for test: kms_ccs results: parsing output: 81/ for test: kms_frontbuffer_tracking results: parsing output: 82/ for test: kms_chamelium_hpd results: parsing output: 83/ for test: gem_exec_balancer results: parsing output: 84/ for test: kms_ccs results: parsing output: 85/ for test: gem_exec_fence results: parsing output: 86/ for test: kms_plane_cursor results: parsing output: 87/ for test: gem_ctx_param results: parsing output: 88/ for test: api_intel_allocator results: parsing output: 89/ for test: kms_dsc results: parsing output: 90/ for test: kms_cursor_crc results: parsing output: 91/ for test: syncobj_timeline results: parsing output: 92/ for test: i915_drm_fdinfo results: parsing output: 93/ for test: kms_flip_scaled_crc results: parsing output: 94/ for test: gem_ctx_isolation results: parsing output: 95/ for test: gem_eio results: parsing output: 96/ for test: gem_softpin results: parsing output: 97/ for test: i915_module_load results: parsing output: 98/ for test: kms_flip results: parsing output: 99/ for test: kms_flip_scaled_crc results: parsing output: 100/ for test: kms_content_protection results: parsing output: 101/ for test: kms_big_fb results: parsing output: 102/ for test: kms_frontbuffer_tracking results: parsing output: 103/ for test: gem_ppgtt results: parsing output: 104/ for test: syncobj_wait results: parsing output: 105/ for test: kms_cursor_crc results: parsing output: 106/ for test: kms_psr2_sf results: parsing output: 107/ for test: kms_frontbuffer_tracking results: parsing output: 108/ for test: kms_vblank results: parsing output: 109/ for test: syncobj_timeline results: parsing output: 110/ for test: kms_big_fb results: parsing output: 111/ for test: kms_psr results: parsing output: 112/ for test: syncobj_timeline results: parsing output: 113/ for test: kms_frontbuffer_tracking results: parsing output: 114/ for test: gem_exec_reloc results: parsing output: 115/ for test: perf results: parsing output: 116/ for test: gem_ctx_shared results: parsing output: 117/ for test: perf results: parsing output: 118/ for test: kms_psr results: parsing output: 119/ for test: kms_rotation_crc results: parsing output: 120/ for test: kms_frontbuffer_tracking results: parsing output: 121/ for test: gem_create results: parsing output: 122/ for test: prime_vgem results: parsing output: 123/ for test: kms_getfb results: parsing output: 124/ for test: gem_pxp results: parsing output: 125/ for test: syncobj_basic results: parsing output: 126/ for test: dmabuf_sync_file results: parsing output: 127/ for test: kms_flip results: parsing output: 128/ for test: gem_softpin results: parsing output: 129/ for test: kms_pipe_crc_basic results: parsing output: 130/ for test: kms_frontbuffer_tracking results: parsing output: 131/ for test: kms_addfb_basic results: parsing output: 132/ for test: gem_exec_schedule Done.