[59.485421] Initializing watchdogs [59.485503] /dev/watchdog0 [59.499493] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics] [59.503795] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [59.506104] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [59.509332] [001/132] (960s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt) [59.628826] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt [64.128371] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (4.502s) [65.304432] [002/132] (954s left) syncobj_timeline (signal-array) [65.364080] Starting subtest: signal-array [65.366509] Subtest signal-array: SUCCESS (0.000s) [65.477839] [003/132] (954s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-async-flip) [65.584270] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-async-flip [65.588290] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s) [65.678769] [004/132] (954s left) kms_big_fb (x-tiled-32bpp-rotate-90) [65.801553] Starting subtest: x-tiled-32bpp-rotate-90 [65.821141] Subtest x-tiled-32bpp-rotate-90: SKIP (0.019s) [65.952688] [005/132] (954s left) gem_softpin (allocator-basic) [66.017821] Starting subtest: allocator-basic [66.090230] Subtest allocator-basic: SUCCESS (0.071s) [66.244754] [006/132] (953s left) gem_render_copy (y-tiled-ccs-to-x-tiled) [66.316356] Starting subtest: y-tiled-ccs-to-x-tiled [66.320083] Subtest y-tiled-ccs-to-x-tiled: SKIP (0.000s) [66.508595] [007/132] (953s left) kms_rotation_crc (exhaust-fences) [66.606069] Starting subtest: exhaust-fences [66.610475] Subtest exhaust-fences: SKIP (0.000s) [66.675510] [008/132] (953s left) kms_flip (bo-too-big) [66.805470] Starting subtest: bo-too-big [66.807850] Starting dynamic subtest: A-eDP1 [68.130224] Dynamic subtest A-eDP1: SUCCESS (1.324s) [68.139623] Starting dynamic subtest: B-eDP1 [69.375405] Dynamic subtest B-eDP1: SUCCESS (1.245s) [69.384815] Starting dynamic subtest: C-eDP1 [70.710076] Dynamic subtest C-eDP1: SUCCESS (1.333s) [70.719683] Starting dynamic subtest: D-eDP1 [72.049332] Dynamic subtest D-eDP1: SUCCESS (1.339s) [72.054396] Subtest bo-too-big: SUCCESS (5.250s) [73.251600] [009/132] (947s left) perf (invalid-oa-exponent) [73.370427] Starting subtest: invalid-oa-exponent [73.384451] Subtest invalid-oa-exponent: SUCCESS (0.013s) [73.417709] [010/132] (946s left) kms_psr (psr-cursor-mmap-cpu) [73.517896] Starting subtest: psr-cursor-mmap-cpu [73.520236] Starting dynamic subtest: eDP-1 [75.254845] Dynamic subtest eDP-1: SUCCESS (1.737s) [75.257312] Subtest psr-cursor-mmap-cpu: SUCCESS (1.738s) [76.124527] [011/132] (944s left) kms_ccs (crc-primary-suspend-yf-tiled-ccs) [76.230315] Starting subtest: crc-primary-suspend-yf-tiled-ccs [76.232706] Starting dynamic subtest: pipe-A-eDP-1 [76.241844] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [76.249524] Starting dynamic subtest: pipe-B-eDP-1 [76.258681] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [76.265930] Starting dynamic subtest: pipe-C-eDP-1 [76.274606] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [76.281642] Starting dynamic subtest: pipe-D-eDP-1 [76.290485] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [76.294755] Subtest crc-primary-suspend-yf-tiled-ccs: SKIP (0.003s) [78.396933] [012/132] (942s left) kms_frontbuffer_tracking (fbc-suspend) [78.493838] Starting subtest: fbc-suspend [117.074967] Subtest fbc-suspend: SUCCESS (7.549s) [118.265297] [013/132] (902s left) prime_self_import (basic-llseek-size) [118.308658] Starting subtest: basic-llseek-size [118.326655] Subtest basic-llseek-size: SUCCESS (0.020s) [118.420878] [014/132] (902s left) kms_chamelium_audio (hdmi-audio) [118.794783] Subtest hdmi-audio: SKIP (0.000s) [119.570602] [015/132] (900s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-msflip-blt) [119.668537] Starting subtest: fbcpsr-2p-scndscrn-shrfb-msflip-blt [119.673085] Subtest fbcpsr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s) [119.771074] [016/132] (900s left) prime_mmap_kms (buffer-sharing) [119.870722] Starting subtest: buffer-sharing [120.309703] Subtest buffer-sharing: SUCCESS (0.438s) [121.121141] [017/132] (899s left) kms_frontbuffer_tracking (psr-indfb-scaledprimary) [121.221440] Starting subtest: psr-indfb-scaledprimary [127.000877] Subtest psr-indfb-scaledprimary: SUCCESS (5.780s) [127.123497] [018/132] (893s left) kms_flip (dpms-vs-vblank-race) [127.215383] Starting subtest: dpms-vs-vblank-race [127.217844] Starting dynamic subtest: A-eDP1 [131.049212] Dynamic subtest A-eDP1: SUCCESS (3.830s) [131.058732] Starting dynamic subtest: B-eDP1 [135.673824] Dynamic subtest B-eDP1: SUCCESS (4.622s) [135.683746] Starting dynamic subtest: C-eDP1 [140.282813] Dynamic subtest C-eDP1: SUCCESS (4.606s) [140.292123] Starting dynamic subtest: D-eDP1 [144.902668] Dynamic subtest D-eDP1: SUCCESS (4.618s) [144.907632] Subtest dpms-vs-vblank-race: SUCCESS (17.689s) [145.776135] [019/132] (874s left) gem_exec_schedule (pi-shared-iova) [145.973464] Starting subtest: pi-shared-iova [145.975610] Starting dynamic subtest: rcs0 [146.071925] Dynamic subtest rcs0: SUCCESS (0.099s) [146.080903] Starting dynamic subtest: vcs0 [146.128668] Dynamic subtest vcs0: SUCCESS (0.056s) [146.140561] Starting dynamic subtest: vcs1 [146.188444] Dynamic subtest vcs1: SUCCESS (0.058s) [146.198309] Starting dynamic subtest: vecs0 [146.237407] Dynamic subtest vecs0: SUCCESS (0.050s) [146.250045] Starting dynamic subtest: ccs0 [146.296423] Dynamic subtest ccs0: SUCCESS (0.058s) [146.298990] Subtest pi-shared-iova: SUCCESS (0.324s) [148.004176] [020/132] (872s left) gem_exec_reloc (basic-write-read) [148.061697] Subtest basic-write-read: SKIP (0.000s) [148.137240] [021/132] (872s left) api_intel_bb (offset-control) [148.185915] Starting subtest: offset-control [148.190815] Subtest offset-control: SUCCESS (0.007s) [148.299847] [022/132] (872s left) kms_cursor_crc (cursor-offscreen-512x170) [148.587101] Starting subtest: cursor-offscreen-512x170 [148.591743] Subtest cursor-offscreen-512x170: SKIP (0.001s) [148.730250] [023/132] (872s left) gem_barrier_race (remote-request) [148.788030] Starting subtest: remote-request [148.790222] Starting dynamic subtest: rcs0 [153.965560] Dynamic subtest rcs0: SUCCESS (5.179s) [153.967764] Subtest remote-request: SUCCESS (5.179s) [154.113077] [024/132] (866s left) gem_watchdog (default-virtual) [154.181414] Starting subtest: default-virtual [160.466457] Subtest default-virtual: SUCCESS (6.290s) [160.573927] [025/132] (860s left) vgem_basic (busy-fence) [160.643012] Starting subtest: busy-fence [160.645087] Subtest busy-fence: SUCCESS (0.000s) [160.699206] [FACT vgem_basic (busy-fence)] new: kernel.kmod_is_loaded.vgem: true [160.702561] [026/132] (860s left) i915_drm_fdinfo (busy-check-all) [160.739439] Starting subtest: busy-check-all [160.741772] Starting dynamic subtest: rcs0 [160.746182] Dynamic subtest rcs0: SKIP (0.005s) [160.756483] Starting dynamic subtest: bcs0 [160.760649] Dynamic subtest bcs0: SKIP (0.000s) [160.769561] Starting dynamic subtest: vcs0 [160.773509] Dynamic subtest vcs0: SKIP (0.000s) [160.781432] Starting dynamic subtest: vcs1 [160.785745] Dynamic subtest vcs1: SKIP (0.000s) [160.793546] Starting dynamic subtest: vecs0 [160.797577] Dynamic subtest vecs0: SKIP (0.000s) [160.805145] Starting dynamic subtest: ccs0 [160.809155] Dynamic subtest ccs0: SKIP (0.000s) [160.813191] Subtest busy-check-all: SKIP (0.008s) [160.849726] [027/132] (860s left) sw_sync (alloc_timeline) [160.884138] Starting subtest: alloc_timeline [160.886480] Subtest alloc_timeline: SUCCESS (0.000s) [160.941809] [028/132] (860s left) gem_partial_pwrite_pread (reads-snoop) [161.015961] Subtest reads-snoop: SKIP (0.000s) [161.100553] [029/132] (859s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-render) [161.202528] Starting subtest: psr-1p-primscrn-spr-indfb-draw-render [167.957126] Subtest psr-1p-primscrn-spr-indfb-draw-render: SUCCESS (6.757s) [168.104485] [030/132] (853s left) kms_force_connector_basic (force-edid) [168.184898] Starting subtest: force-edid [168.549654] Subtest force-edid: SUCCESS (0.367s) [168.685906] [031/132] (852s left) kms_dp_linktrain_fallback (dp-fallback) [168.771837] Starting subtest: dp-fallback [168.778573] Subtest dp-fallback: SKIP (0.000s) [168.842544] [032/132] (852s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-pwrite) [168.938185] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-pwrite [168.941652] Subtest fbc-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [169.019619] [033/132] (852s left) i915_drm_fdinfo (virtual-busy-idle-all) [169.058864] Starting subtest: virtual-busy-idle-all [169.062409] Subtest virtual-busy-idle-all: SKIP (0.000s) [169.128907] [034/132] (852s left) kms_async_flips (basic-modeset-with-all-modifiers-formats) [169.219677] Starting subtest: basic-modeset-with-all-modifiers-formats [169.594025] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB8888 [170.375421] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB8888: SUCCESS (0.782s) [170.384025] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB2101010 [170.397579] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB2101010: SUCCESS (0.021s) [170.408480] Starting dynamic subtest: pipe-A-eDP-1-4-rc-ccs-XRGB16161616F [170.419752] Dynamic subtest pipe-A-eDP-1-4-rc-ccs-XRGB16161616F: SUCCESS (0.022s) [170.430478] Starting dynamic subtest: pipe-A-eDP-1-4-RGB565 [170.564299] Dynamic subtest pipe-A-eDP-1-4-RGB565: SUCCESS (0.144s) [170.577064] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB8888 [170.586470] Dynamic subtest pipe-A-eDP-1-4-XRGB8888: SUCCESS (0.021s) [170.596922] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB2101010 [170.608756] Dynamic subtest pipe-A-eDP-1-4-XRGB2101010: SUCCESS (0.021s) [170.617121] Starting dynamic subtest: pipe-A-eDP-1-4-XRGB16161616F [170.631041] Dynamic subtest pipe-A-eDP-1-4-XRGB16161616F: SUCCESS (0.021s) [170.638951] Starting dynamic subtest: pipe-A-eDP-1-4-YUYV [170.653708] Dynamic subtest pipe-A-eDP-1-4-YUYV: SUCCESS (0.020s) [170.669195] Starting dynamic subtest: pipe-A-eDP-1-4-Y210 [170.675471] Dynamic subtest pipe-A-eDP-1-4-Y210: SUCCESS (0.022s) [170.683620] Starting dynamic subtest: pipe-A-eDP-1-4-XYUV8888 [170.697648] Dynamic subtest pipe-A-eDP-1-4-XYUV8888: SUCCESS (0.021s) [170.705950] Starting dynamic subtest: pipe-A-eDP-1-4-XV30 [170.719795] Dynamic subtest pipe-A-eDP-1-4-XV30: SUCCESS (0.021s) [170.728132] Starting dynamic subtest: pipe-A-eDP-1-4-XV36 [170.742093] Dynamic subtest pipe-A-eDP-1-4-XV36: SUCCESS (0.021s) [170.750124] Starting dynamic subtest: pipe-A-eDP-1-x-RGB565 [170.897846] Dynamic subtest pipe-A-eDP-1-x-RGB565: SUCCESS (0.155s) [170.907388] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB8888 [170.920030] Dynamic subtest pipe-A-eDP-1-x-XRGB8888: SUCCESS (0.022s) [170.928430] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB2101010 [170.942141] Dynamic subtest pipe-A-eDP-1-x-XRGB2101010: SUCCESS (0.022s) [170.950477] Starting dynamic subtest: pipe-A-eDP-1-x-XRGB16161616F [170.964487] Dynamic subtest pipe-A-eDP-1-x-XRGB16161616F: SUCCESS (0.022s) [170.972646] Starting dynamic subtest: pipe-A-eDP-1-x-YUYV [170.987732] Dynamic subtest pipe-A-eDP-1-x-YUYV: SUCCESS (0.022s) [170.999479] Starting dynamic subtest: pipe-A-eDP-1-x-Y210 [171.008713] Dynamic subtest pipe-A-eDP-1-x-Y210: SUCCESS (0.020s) [171.016484] Starting dynamic subtest: pipe-A-eDP-1-x-XYUV8888 [171.031030] Dynamic subtest pipe-A-eDP-1-x-XYUV8888: SUCCESS (0.022s) [171.038779] Starting dynamic subtest: pipe-A-eDP-1-x-XV30 [171.053171] Dynamic subtest pipe-A-eDP-1-x-XV30: SUCCESS (0.022s) [171.061041] Starting dynamic subtest: pipe-A-eDP-1-x-XV36 [171.075567] Dynamic subtest pipe-A-eDP-1-x-XV36: SUCCESS (0.022s) [171.083404] Starting dynamic subtest: pipe-A-eDP-1-linear-RGB565 [171.220017] Dynamic subtest pipe-A-eDP-1-linear-RGB565: SUCCESS (0.144s) [171.229632] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB8888 [171.242180] Dynamic subtest pipe-A-eDP-1-linear-XRGB8888: SUCCESS (0.022s) [171.250726] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB2101010 [171.264324] Dynamic subtest pipe-A-eDP-1-linear-XRGB2101010: SUCCESS (0.022s) [171.271882] Starting dynamic subtest: pipe-A-eDP-1-linear-XRGB16161616F [171.286486] Dynamic subtest pipe-A-eDP-1-linear-XRGB16161616F: SUCCESS (0.022s) [171.293943] Starting dynamic subtest: pipe-A-eDP-1-linear-YUYV [171.308892] Dynamic subtest pipe-A-eDP-1-linear-YUYV: SUCCESS (0.022s) [171.316848] Starting dynamic subtest: pipe-A-eDP-1-linear-Y210 [171.331059] Dynamic subtest pipe-A-eDP-1-linear-Y210: SUCCESS (0.022s) [171.338677] Starting dynamic subtest: pipe-A-eDP-1-linear-XYUV8888 [171.353354] Dynamic subtest pipe-A-eDP-1-linear-XYUV8888: SUCCESS (0.022s) [171.360829] Starting dynamic subtest: pipe-A-eDP-1-linear-XV30 [171.375427] Dynamic subtest pipe-A-eDP-1-linear-XV30: SUCCESS (0.022s) [171.382961] Starting dynamic subtest: pipe-A-eDP-1-linear-XV36 [171.397854] Dynamic subtest pipe-A-eDP-1-linear-XV36: SUCCESS (0.022s) [171.787341] Subtest basic-modeset-with-all-modifiers-formats: SUCCESS (2.569s) [172.624569] [035/132] (848s left) kms_psr (fbc-psr-cursor-mmap-gtt) [172.732941] Starting subtest: fbc-psr-cursor-mmap-gtt [172.735192] Starting dynamic subtest: eDP-1 [172.739169] Dynamic subtest eDP-1: SKIP (0.000s) [172.743170] Subtest fbc-psr-cursor-mmap-gtt: SKIP (0.001s) [172.803987] [036/132] (848s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-cpu) [172.900020] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-cpu [179.859146] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (6.960s) [179.973279] [037/132] (841s left) gem_bad_reloc (negative-reloc-bltcopy) [180.046221] Subtest negative-reloc-bltcopy: SKIP (0.000s) [180.116749] [038/132] (841s left) gem_pxp (create-regular-buffer) [180.246899] Starting subtest: create-regular-buffer [180.249399] Subtest create-regular-buffer: SUCCESS (0.000s) [180.368568] [039/132] (841s left) i915_pm_rps (min-max-config-idle) [180.441932] Starting subtest: min-max-config-idle [180.446556] Subtest min-max-config-idle: SKIP (0.001s) [180.518558] [040/132] (841s left) perf (sysctl-defaults) [180.578401] Starting subtest: sysctl-defaults [180.580428] Subtest sysctl-defaults: SUCCESS (0.000s) [180.639722] [041/132] (840s left) gem_exec_create (legacy) [180.708744] Starting subtest: legacy [180.711098] Starting dynamic subtest: smem [183.949420] Dynamic subtest smem: SUCCESS (3.238s) [183.952071] Subtest legacy: SUCCESS (3.239s) [184.129450] [042/132] (837s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc) [184.231050] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc [184.235274] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [184.323662] [043/132] (837s left) kms_flip (flip-vs-dpms-on-nop) [184.422189] Starting subtest: flip-vs-dpms-on-nop [184.424565] Starting dynamic subtest: A-eDP1 [186.288160] Dynamic subtest A-eDP1: SUCCESS (1.867s) [186.301639] Starting dynamic subtest: B-eDP1 [188.185724] Dynamic subtest B-eDP1: SUCCESS (1.894s) [188.196440] Starting dynamic subtest: C-eDP1 [189.990680] Dynamic subtest C-eDP1: SUCCESS (1.804s) [190.001133] Starting dynamic subtest: D-eDP1 [191.877953] Dynamic subtest D-eDP1: SUCCESS (1.886s) [191.882908] Subtest flip-vs-dpms-on-nop: SUCCESS (7.462s) [193.023262] [044/132] (828s left) kms_atomic_transition (plane-all-transition) [193.110398] Starting subtest: plane-all-transition [193.112718] Starting dynamic subtest: pipe-A-eDP-1 [195.603156] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.494s) [195.909541] Starting dynamic subtest: pipe-B-eDP-1 [199.136282] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.234s) [199.450103] Subtest plane-all-transition: SUCCESS (6.340s) [200.339087] [045/132] (821s left) sw_sync (alloc_merge_fence) [200.386376] Starting subtest: alloc_merge_fence [200.388601] Subtest alloc_merge_fence: SUCCESS (0.000s) [200.449262] [046/132] (821s left) gen9_exec_parse (batch-invalid-length) [200.511653] Subtest batch-invalid-length: SKIP (0.000s) [200.593498] [047/132] (821s left) kms_color_pipeline (plane-lut1d-lut1d) [200.680874] Starting subtest: plane-lut1d-lut1d [200.860250] Starting dynamic subtest: pipe-A-plane-0 [201.060341] Dynamic subtest pipe-A-plane-0: SUCCESS (0.200s) [201.068954] Starting dynamic subtest: pipe-A-plane-1 [201.204887] Dynamic subtest pipe-A-plane-1: SUCCESS (0.144s) [201.213227] Starting dynamic subtest: pipe-A-plane-2 [201.349010] Dynamic subtest pipe-A-plane-2: SUCCESS (0.144s) [202.528666] Starting dynamic subtest: pipe-B-plane-0 [202.663330] Dynamic subtest pipe-B-plane-0: SUCCESS (0.144s) [202.672264] Starting dynamic subtest: pipe-B-plane-1 [202.808293] Dynamic subtest pipe-B-plane-1: SUCCESS (0.144s) [202.816866] Starting dynamic subtest: pipe-B-plane-2 [202.952416] Dynamic subtest pipe-B-plane-2: SUCCESS (0.144s) [204.177173] Starting dynamic subtest: pipe-C-plane-0 [204.336812] Dynamic subtest pipe-C-plane-0: SUCCESS (0.166s) [204.345637] Starting dynamic subtest: pipe-C-plane-1 [204.470201] Dynamic subtest pipe-C-plane-1: SUCCESS (0.132s) [204.478536] Starting dynamic subtest: pipe-C-plane-2 [204.625672] Dynamic subtest pipe-C-plane-2: SUCCESS (0.155s) [205.781196] Starting dynamic subtest: pipe-D-plane-0 [205.908159] Dynamic subtest pipe-D-plane-0: SUCCESS (0.133s) [205.916691] Starting dynamic subtest: pipe-D-plane-1 [206.052235] Dynamic subtest pipe-D-plane-1: SUCCESS (0.144s) [206.061040] Starting dynamic subtest: pipe-D-plane-2 [206.196839] Dynamic subtest pipe-D-plane-2: SUCCESS (0.144s) [206.485807] Subtest plane-lut1d-lut1d: SUCCESS (5.802s) [207.328794] [048/132] (814s left) kms_pm_rpm (basic-pci-d3-state) [209.168791] Starting subtest: basic-pci-d3-state [210.629532] Subtest basic-pci-d3-state: SUCCESS (1.464s) [210.731126] [049/132] (811s left) kms_lease (multimaster-lease) [210.821333] Starting subtest: multimaster-lease [210.823552] Subtest multimaster-lease: SUCCESS (0.003s) [210.951803] [050/132] (810s left) kms_plane (pixel-format-linear-modifier-source-clamping) [211.055028] Starting subtest: pixel-format-linear-modifier-source-clamping [211.084368] Starting dynamic subtest: pipe-A-plane-0 [214.681961] Dynamic subtest pipe-A-plane-0: SUCCESS (3.599s) [214.692198] Starting dynamic subtest: pipe-A-plane-3 [216.481817] Dynamic subtest pipe-A-plane-3: SUCCESS (1.798s) [217.576028] Starting dynamic subtest: pipe-B-plane-0 [221.245818] Dynamic subtest pipe-B-plane-0: SUCCESS (3.678s) [221.256486] Starting dynamic subtest: pipe-B-plane-3 [222.901144] Dynamic subtest pipe-B-plane-3: SUCCESS (1.653s) [223.212568] Subtest pixel-format-linear-modifier-source-clamping: SUCCESS (12.158s) [224.034357] [051/132] (797s left) kms_chamelium_color (gamma) [224.130817] Subtest gamma: SKIP (0.000s) [224.174574] [052/132] (797s left) gem_exec_params (rel-constants-invalid-rel-gen5) [224.237284] Starting subtest: rel-constants-invalid-rel-gen5 [224.239200] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s) [224.333497] [053/132] (797s left) kms_universal_plane (universal-plane-functional) [224.424040] Starting subtest: universal-plane-functional [224.426330] Starting dynamic subtest: pipe-A-eDP-1 [228.319571] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.892s) [228.329062] Starting dynamic subtest: pipe-B-eDP-1 [232.909783] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.591s) [232.918488] Starting dynamic subtest: pipe-C-eDP-1 [237.188455] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.279s) [237.198418] Starting dynamic subtest: pipe-D-eDP-1 [241.463780] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.274s) [241.466192] Subtest universal-plane-functional: SUCCESS (17.042s) [242.317984] [054/132] (779s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt) [242.429820] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt [242.434065] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [242.536427] [055/132] (779s left) kms_cursor_crc (cursor-tearing-framebuffer-change) [242.651054] Starting subtest: cursor-tearing-framebuffer-change [242.652933] Starting dynamic subtest: pipe-A-eDP-1 [243.203956] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.554s) [243.213760] Starting dynamic subtest: pipe-D-eDP-1 [244.404548] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.200s) [244.406956] Subtest cursor-tearing-framebuffer-change: SUCCESS (1.756s) [245.221512] [056/132] (776s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-wc) [245.315253] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-wc [248.897649] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (3.586s) [250.031898] [057/132] (772s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu) [250.144422] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu [250.148582] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [250.268489] [058/132] (772s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180) [250.370739] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180 [250.375550] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s) [250.477638] [059/132] (771s left) gem_exec_reloc (basic-gtt-cpu-noreloc) [250.541366] Subtest basic-gtt-cpu-noreloc: SKIP (0.000s) [250.624854] [060/132] (771s left) dumb_buffer (create-valid-dumb) [250.683035] Starting subtest: create-valid-dumb [250.685272] Subtest create-valid-dumb: SUCCESS (0.000s) [250.776601] [061/132] (771s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-pwrite) [250.867370] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-pwrite [250.871278] Subtest psr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s) [250.997441] [062/132] (771s left) kms_joiner (basic-force-big-joiner) [251.089960] Starting subtest: basic-force-big-joiner [251.093282] Subtest basic-force-big-joiner: SKIP (0.000s) [251.160093] [063/132] (771s left) gem_render_copy (linear) [251.214014] Starting subtest: linear [251.215820] Starting dynamic subtest: smem [251.253674] Dynamic subtest smem: SUCCESS (0.039s) [251.255887] Subtest linear: SUCCESS (0.040s) [251.474718] [064/132] (771s left) gem_exec_balancer (bonded-true-hang) [251.731021] Starting subtest: bonded-true-hang [251.736769] Subtest bonded-true-hang: SKIP (0.000s) [251.841951] [065/132] (770s left) gem_userptr_blits (dmabuf-unsync) [251.909920] Subtest dmabuf-unsync: SKIP (0.000s) [252.043081] [066/132] (770s left) kms_plane_scaling (plane-upscale-20x20-with-rotation) [252.146937] Starting subtest: plane-upscale-20x20-with-rotation [252.149283] Starting dynamic subtest: pipe-A [252.376332] Dynamic subtest pipe-A: SUCCESS (0.230s) [252.388931] Starting dynamic subtest: pipe-B [253.672385] Dynamic subtest pipe-B: SUCCESS (1.295s) [253.684234] Starting dynamic subtest: pipe-C [254.962556] Dynamic subtest pipe-C: SUCCESS (1.288s) [254.975872] Starting dynamic subtest: pipe-D [256.285517] Dynamic subtest pipe-D: SUCCESS (1.322s) [256.287878] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.141s) [257.420174] [067/132] (765s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait) [257.513213] Starting subtest: plane-primary-toggle-with-vblank-wait [257.515523] Starting dynamic subtest: pipe-A-eDP-1 [257.686577] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.174s) [258.009333] Starting dynamic subtest: pipe-B-eDP-1 [258.890768] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.889s) [259.188615] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (1.675s) [260.016413] [068/132] (762s left) kms_flip (2x-blocking-absolute-wf_vblank) [260.108529] Starting subtest: 2x-blocking-absolute-wf_vblank [260.120029] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.011s) [260.202382] [069/132] (762s left) kms_cursor_legacy (cursorb-vs-flipa-toggle) [260.316719] Starting subtest: cursorB-vs-flipA-toggle [260.321215] Subtest cursorB-vs-flipA-toggle: SKIP (0.001s) [260.462656] [070/132] (762s left) kms_getfb (getfb2-handle-protection) [260.563257] Starting subtest: getfb2-handle-protection [260.583806] Subtest getfb2-handle-protection: SUCCESS (0.022s) [260.697662] [071/132] (762s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip) [260.802172] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip [261.880768] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.079s) [262.029813] [072/132] (760s left) gem_lmem_swapping (verify-random) [262.083964] Subtest verify-random: SKIP (0.000s) [262.126241] [073/132] (760s left) i915_query (query-regions-unallocated) [262.178583] Starting subtest: query-regions-unallocated [262.180646] Subtest query-regions-unallocated: SUCCESS (0.000s) [262.274880] [074/132] (760s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs) [262.375662] Starting subtest: crc-sprite-planes-basic-4-tiled-bmg-ccs [262.379212] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s) [263.522328] [075/132] (759s left) gem_exec_flush (basic-uc-rw-default) [263.588637] Starting subtest: basic-uc-rw-default [269.041564] Subtest basic-uc-rw-default: SUCCESS (5.453s) [269.241568] [076/132] (753s left) gem_eio (suspend) [269.472430] Starting subtest: suspend [281.697329] Subtest suspend: SUCCESS (12.227s) [281.824246] [077/132] (741s left) syncobj_eventfd (invalid-illegal-handle) [281.879143] Starting subtest: invalid-illegal-handle [281.881507] Subtest invalid-illegal-handle: SUCCESS (0.000s) [281.998205] [078/132] (741s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-blt) [282.092262] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-blt [286.207050] Subtest fbc-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (4.118s) [287.326756] [079/132] (735s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc) [287.441556] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc [294.343863] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (6.905s) [294.481441] [080/132] (728s left) syncobj_timeline (invalid-query-illegal-handle) [294.537387] Starting subtest: invalid-query-illegal-handle [294.539546] Subtest invalid-query-illegal-handle: SUCCESS (0.000s) [294.635757] [081/132] (728s left) gem_ctx_persistence (legacy-engines-hostile-preempt) [294.697563] Starting subtest: legacy-engines-hostile-preempt [294.699799] Starting dynamic subtest: render [294.768942] Dynamic subtest render: SUCCESS (0.070s) [294.780603] Starting dynamic subtest: bsd1 [295.940001] Dynamic subtest bsd1: SUCCESS (1.167s) [295.952016] Starting dynamic subtest: bsd2 [297.908434] Dynamic subtest bsd2: SUCCESS (1.964s) [297.920240] Starting dynamic subtest: blt [297.996553] Dynamic subtest blt: SUCCESS (0.086s) [298.011605] Starting dynamic subtest: vebox [299.919269] Dynamic subtest vebox: SUCCESS (1.918s) [299.921945] Subtest legacy-engines-hostile-preempt: SUCCESS (5.221s) [300.010561] [082/132] (723s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-yf-tiled) [300.060753] Starting subtest: y-tiled-mc-ccs-to-vebox-yf-tiled [300.065162] Subtest y-tiled-mc-ccs-to-vebox-yf-tiled: SKIP (0.000s) [300.246777] [083/132] (723s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling) [300.339418] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-downscaling [300.341782] Starting dynamic subtest: pipe-A-default-mode [301.443319] Dynamic subtest pipe-A-default-mode: SKIP (1.104s) [301.447550] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (1.105s) [301.578458] [084/132] (721s left) kms_chamelium_hpd (vga-hpd-with-enabled-mode) [301.968132] Subtest vga-hpd-with-enabled-mode: SKIP (0.000s) [302.803301] [085/132] (720s left) prime_udl [302.886113] [086/132] (720s left) perf (gen12-unprivileged-single-ctx-counters) [302.973648] Starting subtest: gen12-unprivileged-single-ctx-counters [302.976099] Starting dynamic subtest: rcs0 [303.168554] Dynamic subtest rcs0: SUCCESS (0.194s) [303.170864] Subtest gen12-unprivileged-single-ctx-counters: SUCCESS (0.195s) [303.210517] [087/132] (720s left) gem_mmap_offset (bad-extensions) [303.299755] Starting subtest: bad-extensions [303.302599] Subtest bad-extensions: SUCCESS (0.000s) [303.403505] [088/132] (720s left) gem_exec_gttfill (multigpu-basic) [303.585613] Starting subtest: multigpu-basic [318.079215] Subtest multigpu-basic: SUCCESS (14.494s) [318.134066] [089/132] (705s left) gem_mmap_gtt (basic-small-copy-xy) [318.235833] Subtest basic-small-copy-XY: SKIP (0.000s) [318.316116] [090/132] (705s left) gem_gpgpu_fill (offset-16x16) [318.386465] Starting subtest: offset-16x16 [318.396542] Subtest offset-16x16: SUCCESS (0.010s) [318.542493] [091/132] (705s left) gem_exec_schedule (timeslicing) [318.628476] Starting subtest: timeslicing [318.630687] Starting dynamic subtest: rcs0 [318.646018] Dynamic subtest rcs0: SUCCESS (0.025s) [318.656899] Starting dynamic subtest: bcs0 [318.671379] Dynamic subtest bcs0: SUCCESS (0.025s) [318.682844] Starting dynamic subtest: vcs0 [318.695869] Dynamic subtest vcs0: SUCCESS (0.023s) [318.704850] Starting dynamic subtest: vcs1 [318.717757] Dynamic subtest vcs1: SUCCESS (0.021s) [318.726637] Starting dynamic subtest: vecs0 [318.739803] Dynamic subtest vecs0: SUCCESS (0.021s) [318.748879] Starting dynamic subtest: ccs0 [318.764651] Dynamic subtest ccs0: SUCCESS (0.025s) [318.766930] Subtest timeslicing: SUCCESS (0.145s) [319.989812] [092/132] (703s left) kms_addfb_basic (bad-pitch-63) [320.049104] Starting subtest: bad-pitch-63 [320.051058] Subtest bad-pitch-63: SUCCESS (0.000s) [320.189419] [093/132] (703s left) gem_ctx_sseu (engines) [320.266270] Subtest engines: SKIP (0.000s) [320.345859] [094/132] (703s left) gem_ctx_persistence (engines-persistence) [320.409621] Starting subtest: engines-persistence [320.412015] Starting dynamic subtest: rcs0 [321.233053] Dynamic subtest rcs0: SUCCESS (0.823s) [321.245157] Starting dynamic subtest: bcs0 [321.990698] Dynamic subtest bcs0: SUCCESS (0.755s) [322.002473] Starting dynamic subtest: vcs0 [322.756814] Dynamic subtest vcs0: SUCCESS (0.764s) [322.769150] Starting dynamic subtest: vcs1 [323.543890] Dynamic subtest vcs1: SUCCESS (0.785s) [323.555913] Starting dynamic subtest: vecs0 [324.294732] Dynamic subtest vecs0: SUCCESS (0.749s) [324.306723] Starting dynamic subtest: ccs0 [325.065995] Dynamic subtest ccs0: SUCCESS (0.769s) [325.068576] Subtest engines-persistence: SUCCESS (4.657s) [325.153692] [095/132] (698s left) syncobj_timeline (etime-multi-wait-for-submit-submitted) [325.216341] Starting subtest: etime-multi-wait-for-submit-submitted [325.322956] Subtest etime-multi-wait-for-submit-submitted: SUCCESS (0.106s) [325.401970] [096/132] (698s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs) [325.499676] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs [325.501887] Starting dynamic subtest: pipe-A-eDP-1 [325.521088] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s) [325.531072] Starting dynamic subtest: pipe-B-eDP-1 [325.549141] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [325.558444] Starting dynamic subtest: pipe-C-eDP-1 [325.577486] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [325.586166] Starting dynamic subtest: pipe-D-eDP-1 [325.605143] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [325.607005] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs: SUCCESS (0.008s) [327.730113] [097/132] (696s left) kms_psr (fbc-pr-cursor-plane-move) [327.825752] Starting subtest: fbc-pr-cursor-plane-move [327.830112] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s) [327.897500] [098/132] (696s left) kms_big_fb (yf-tiled-32bpp-rotate-270) [328.003293] Starting subtest: yf-tiled-32bpp-rotate-270 [328.007604] Subtest yf-tiled-32bpp-rotate-270: SKIP (0.000s) [328.103149] [099/132] (695s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic) [328.210947] Starting subtest: 2x-long-flip-vs-cursor-atomic [328.216203] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.002s) [328.357502] [100/132] (695s left) kms_ccs (bad-rotation-90-4-tiled-bmg-ccs) [328.449366] Starting subtest: bad-rotation-90-4-tiled-bmg-ccs [328.453841] Subtest bad-rotation-90-4-tiled-bmg-ccs: SKIP (0.000s) [329.626490] [101/132] (694s left) kms_vblank (query-forked-hang) [329.727185] Starting subtest: query-forked-hang [329.729281] Starting dynamic subtest: pipe-A-eDP-1 [355.744238] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.016s) [355.763229] Starting dynamic subtest: pipe-D-eDP-1 [370.716009] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.967s) [370.718452] Subtest query-forked-hang: SUCCESS (40.988s) [371.531418] [102/132] (652s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-plflip-blt) [371.644715] Starting subtest: fbcpsr-2p-primscrn-indfb-plflip-blt [371.648887] Subtest fbcpsr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s) [371.738710] [103/132] (652s left) gem_create (create-massive) [371.800182] Starting subtest: create-massive [371.802789] Subtest create-massive: SUCCESS (0.000s) [372.005545] [104/132] (652s left) kms_flip (flip-vs-fences-interruptible) [372.103580] Starting subtest: flip-vs-fences-interruptible [372.108243] Subtest flip-vs-fences-interruptible: SKIP (0.000s) [372.207911] [105/132] (652s left) gem_exec_whisper (basic-fds-priority) [372.281432] Starting subtest: basic-fds-priority [396.839746] Subtest basic-fds-priority: SUCCESS (24.553s) [397.024435] [106/132] (627s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area) [397.129766] Starting subtest: pr-primary-plane-update-sf-dmg-area [397.134145] Subtest pr-primary-plane-update-sf-dmg-area: SKIP (0.000s) [397.212554] [107/132] (627s left) kms_fb_coherency (memset-crc) [397.302322] Starting subtest: memset-crc [397.304260] Starting dynamic subtest: mmap-offset-wc [397.717045] Dynamic subtest mmap-offset-wc: SUCCESS (0.415s) [398.015536] Starting dynamic subtest: mmap-offset-uc [403.183106] Dynamic subtest mmap-offset-uc: SUCCESS (5.174s) [403.480829] Subtest memset-crc: SUCCESS (6.179s) [404.310107] [108/132] (620s left) kms_properties (colorop-properties-atomic) [404.397987] Starting subtest: colorop-properties-atomic [404.400110] Starting dynamic subtest: pipe-A-eDP-1 [404.752815] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.356s) [404.765114] Starting dynamic subtest: pipe-B-eDP-1 [405.835902] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.082s) [405.845726] Starting dynamic subtest: pipe-C-eDP-1 [406.946538] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.108s) [406.956591] Starting dynamic subtest: pipe-D-eDP-1 [408.036057] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.087s) [408.038454] Subtest colorop-properties-atomic: SUCCESS (3.638s) [408.912474] [109/132] (615s left) kms_pipe_stress (stress-xrgb8888-4tiled) [409.014533] Starting subtest: stress-xrgb8888-4tiled [414.925587] Subtest stress-xrgb8888-4tiled: SUCCESS (5.912s) [414.974191] [110/132] (609s left) perf_pmu (semaphore-busy) [415.015202] Starting subtest: semaphore-busy [415.017112] Starting dynamic subtest: rcs0 [416.665743] Dynamic subtest rcs0: SUCCESS (1.645s) [416.677724] Starting dynamic subtest: bcs0 [418.296064] Dynamic subtest bcs0: SUCCESS (1.628s) [418.308586] Starting dynamic subtest: vcs0 [422.473173] Dynamic subtest vcs0: SUCCESS (4.174s) [422.483795] Starting dynamic subtest: vcs1 [428.424573] Dynamic subtest vcs1: SUCCESS (5.948s) [428.435327] Starting dynamic subtest: vecs0 [434.441024] Dynamic subtest vecs0: SUCCESS (6.012s) [434.453702] Starting dynamic subtest: ccs0 [437.516565] Dynamic subtest ccs0: SUCCESS (3.073s) [437.519145] Subtest semaphore-busy: SUCCESS (22.496s) [437.633163] [111/132] (586s left) kms_atomic (crtc-invalid-params) [437.728029] Starting subtest: crtc-invalid-params [437.729936] Starting dynamic subtest: pipe-A-eDP-1 [438.087061] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.359s) [438.089406] Subtest crtc-invalid-params: SUCCESS (0.360s) [438.916489] [112/132] (585s left) kms_psr (pr-sprite-render) [439.025114] Starting subtest: pr-sprite-render [439.029254] Subtest pr-sprite-render: SKIP (0.000s) [439.100067] [113/132] (585s left) api_intel_allocator (open-vm) [439.153595] Starting subtest: open-vm [439.156024] Subtest open-vm: SUCCESS (0.003s) [439.291359] [114/132] (585s left) kms_cursor_crc (cursor-rapid-movement-512x512) [439.561347] Starting subtest: cursor-rapid-movement-512x512 [439.565930] Subtest cursor-rapid-movement-512x512: SKIP (0.002s) [439.741320] [115/132] (585s left) syncobj_timeline (multi-wait-available-signaled) [439.795991] Starting subtest: multi-wait-available-signaled [439.797757] Subtest multi-wait-available-signaled: SUCCESS (0.000s) [439.932120] [116/132] (584s left) prime_vgem (basic-fence-flip) [440.008222] Starting subtest: basic-fence-flip [440.339175] Subtest basic-fence-flip: SUCCESS (0.331s) [440.470865] [117/132] (584s left) gem_exec_params (no-blt) [440.524720] Starting subtest: no-blt [440.527196] Subtest no-blt: SUCCESS (0.002s) [440.656014] [118/132] (584s left) kms_plane_lowres (tiling-none) [440.738296] Starting subtest: tiling-none [440.740664] Starting dynamic subtest: pipe-A-eDP-1 [440.745255] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [441.039638] Starting dynamic subtest: pipe-B-eDP-1 [441.044355] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [441.054561] Starting dynamic subtest: pipe-C-eDP-1 [441.059235] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [441.069113] Starting dynamic subtest: pipe-D-eDP-1 [441.073094] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [441.077120] Subtest tiling-none: SKIP (0.301s) [441.837224] [119/132] (583s left) gem_pxp (reject-modify-context-protection-on) [441.939117] Starting subtest: reject-modify-context-protection-on [441.941436] Subtest reject-modify-context-protection-on: SUCCESS (0.002s) [442.050135] [120/132] (582s left) syncobj_basic (test-valid-cycle) [442.112304] Starting subtest: test-valid-cycle [442.114649] Subtest test-valid-cycle: SUCCESS (0.000s) [442.205720] [121/132] (582s left) kms_plane (plane-panning-bottom-right) [442.309107] Starting subtest: plane-panning-bottom-right [442.311401] Starting dynamic subtest: pipe-A [444.024966] Dynamic subtest pipe-A: SUCCESS (1.710s) [444.035088] Starting dynamic subtest: pipe-B [446.339837] Dynamic subtest pipe-B: SUCCESS (2.315s) [446.342220] Subtest plane-panning-bottom-right: SUCCESS (4.029s) [447.205771] [122/132] (577s left) kms_content_protection (dp-mst-type-0-suspend-resume) [447.362325] Starting subtest: dp-mst-type-0-suspend-resume [447.366912] Subtest dp-mst-type-0-suspend-resume: SKIP (0.000s) [447.501407] [123/132] (577s left) syncobj_wait (signal) [447.558203] Starting subtest: signal [447.560481] Subtest signal: SUCCESS (0.000s) [447.656653] [124/132] (577s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-msflip-blt) [447.747557] Starting subtest: psr-2p-primscrn-indfb-msflip-blt [447.751729] Subtest psr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s) [447.834442] [125/132] (577s left) kms_psr (psr-primary-render) [447.929249] Starting subtest: psr-primary-render [447.931541] Starting dynamic subtest: eDP-1 [449.687324] Dynamic subtest eDP-1: SUCCESS (1.759s) [449.689604] Subtest psr-primary-render: SUCCESS (1.760s) [450.515442] [126/132] (574s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-async-flip) [450.607691] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip [451.253758] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.648s) [451.427147] [127/132] (573s left) kms_psr (fbc-psr2-primary-blt) [451.530365] Starting subtest: fbc-psr2-primary-blt [451.532565] Starting dynamic subtest: eDP-1 [451.536965] Dynamic subtest eDP-1: SKIP (0.000s) [451.541321] Subtest fbc-psr2-primary-blt: SKIP (0.001s) [451.601156] [128/132] (573s left) kms_busy (extended-modeset-hang-newfb) [451.710254] Starting subtest: extended-modeset-hang-newfb [451.712112] Starting dynamic subtest: pipe-A [487.540260] Dynamic subtest pipe-A: SUCCESS (35.826s) [487.552329] Starting dynamic subtest: pipe-D [510.829202] Dynamic subtest pipe-D: SUCCESS (23.285s) [510.831536] Subtest extended-modeset-hang-newfb: SUCCESS (59.116s) [511.708194] [129/132] (513s left) gem_close_race (basic-process) [511.770453] Starting subtest: basic-process [511.813676] Subtest basic-process: SUCCESS (0.043s) [512.010891] [130/132] (513s left) perf_pmu (idle) [512.060795] Starting subtest: idle [512.063228] Starting dynamic subtest: rcs0 [512.608460] Dynamic subtest rcs0: SUCCESS (0.547s) [512.620554] Starting dynamic subtest: bcs0 [513.128089] Dynamic subtest bcs0: SUCCESS (0.517s) [513.140962] Starting dynamic subtest: vcs0 [513.646897] Dynamic subtest vcs0: SUCCESS (0.516s) [513.658652] Starting dynamic subtest: vcs1 [514.171129] Dynamic subtest vcs1: SUCCESS (0.523s) [514.186165] Starting dynamic subtest: vecs0 [514.694526] Dynamic subtest vecs0: SUCCESS (0.519s) [514.707479] Starting dynamic subtest: ccs0 [515.213491] Dynamic subtest ccs0: SUCCESS (0.515s) [515.216260] Subtest idle: SUCCESS (3.154s) [515.307203] [131/132] (510s left) gem_exec_fence (syncobj-invalid-wait) [515.761678] Starting subtest: syncobj-invalid-wait [515.764386] Subtest syncobj-invalid-wait: SUCCESS (0.000s) [517.009043] [132/132] (508s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-pwrite) [517.120311] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-pwrite [523.271899] Subtest fbc-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (6.156s) [524.421450] Closing watchdogs results: parsing output: 0/ for test: kms_frontbuffer_tracking results: parsing output: 1/ for test: syncobj_timeline results: parsing output: 2/ for test: kms_big_fb results: parsing output: 3/ for test: kms_big_fb results: parsing output: 4/ for test: gem_softpin results: parsing output: 5/ for test: gem_render_copy results: parsing output: 6/ for test: kms_rotation_crc results: parsing output: 7/ for test: kms_flip results: parsing output: 8/ for test: perf results: parsing output: 9/ for test: kms_psr results: parsing output: 10/ for test: kms_ccs results: parsing output: 11/ for test: kms_frontbuffer_tracking results: parsing output: 12/ for test: prime_self_import results: parsing output: 13/ for test: kms_chamelium_audio results: parsing output: 14/ for test: kms_frontbuffer_tracking results: parsing output: 15/ for test: prime_mmap_kms results: parsing output: 16/ for test: kms_frontbuffer_tracking results: parsing output: 17/ for test: kms_flip results: parsing output: 18/ for test: gem_exec_schedule results: parsing output: 19/ for test: gem_exec_reloc results: parsing output: 20/ for test: api_intel_bb results: parsing output: 21/ for test: kms_cursor_crc results: parsing output: 22/ for test: gem_barrier_race results: parsing output: 23/ for test: gem_watchdog results: parsing output: 24/ for test: vgem_basic results: parsing output: 25/ for test: i915_drm_fdinfo results: parsing output: 26/ for test: sw_sync results: parsing output: 27/ for test: gem_partial_pwrite_pread results: parsing output: 28/ for test: kms_frontbuffer_tracking results: parsing output: 29/ for test: kms_force_connector_basic results: parsing output: 30/ for test: kms_dp_linktrain_fallback results: parsing output: 31/ for test: kms_frontbuffer_tracking results: parsing output: 32/ for test: i915_drm_fdinfo results: parsing output: 33/ for test: kms_async_flips results: parsing output: 34/ for test: kms_psr results: parsing output: 35/ for test: kms_frontbuffer_tracking results: parsing output: 36/ for test: gem_bad_reloc results: parsing output: 37/ for test: gem_pxp results: parsing output: 38/ for test: i915_pm_rps results: parsing output: 39/ for test: perf results: parsing output: 40/ for test: gem_exec_create results: parsing output: 41/ for test: kms_frontbuffer_tracking results: parsing output: 42/ for test: kms_flip results: parsing output: 43/ for test: kms_atomic_transition results: parsing output: 44/ for test: sw_sync results: parsing output: 45/ for test: gen9_exec_parse results: parsing output: 46/ for test: kms_color_pipeline results: parsing output: 47/ for test: kms_pm_rpm results: parsing output: 48/ for test: kms_lease results: parsing output: 49/ for test: kms_plane results: parsing output: 50/ for test: kms_chamelium_color results: parsing output: 51/ for test: gem_exec_params results: parsing output: 52/ for test: kms_universal_plane results: parsing output: 53/ for test: kms_frontbuffer_tracking results: parsing output: 54/ for test: kms_cursor_crc results: parsing output: 55/ for test: kms_frontbuffer_tracking results: parsing output: 56/ for test: kms_frontbuffer_tracking results: parsing output: 57/ for test: kms_big_fb results: parsing output: 58/ for test: gem_exec_reloc results: parsing output: 59/ for test: dumb_buffer results: parsing output: 60/ for test: kms_frontbuffer_tracking results: parsing output: 61/ for test: kms_joiner results: parsing output: 62/ for test: gem_render_copy results: parsing output: 63/ for test: gem_exec_balancer results: parsing output: 64/ for test: gem_userptr_blits results: parsing output: 65/ for test: kms_plane_scaling results: parsing output: 66/ for test: kms_atomic_transition results: parsing output: 67/ for test: kms_flip results: parsing output: 68/ for test: kms_cursor_legacy results: parsing output: 69/ for test: kms_getfb results: parsing output: 70/ for test: kms_big_fb results: parsing output: 71/ for test: gem_lmem_swapping results: parsing output: 72/ for test: i915_query results: parsing output: 73/ for test: kms_ccs results: parsing output: 74/ for test: gem_exec_flush results: parsing output: 75/ for test: gem_eio results: parsing output: 76/ for test: syncobj_eventfd results: parsing output: 77/ for test: kms_frontbuffer_tracking results: parsing output: 78/ for test: kms_frontbuffer_tracking results: parsing output: 79/ for test: syncobj_timeline results: parsing output: 80/ for test: gem_ctx_persistence results: parsing output: 81/ for test: gem_render_copy results: parsing output: 82/ for test: kms_flip_scaled_crc results: parsing output: 83/ for test: kms_chamelium_hpd results: parsing output: 84/ for test: prime_udl results: parsing output: 85/ for test: perf results: parsing output: 86/ for test: gem_mmap_offset results: parsing output: 87/ for test: gem_exec_gttfill results: parsing output: 88/ for test: gem_mmap_gtt results: parsing output: 89/ for test: gem_gpgpu_fill results: parsing output: 90/ for test: gem_exec_schedule results: parsing output: 91/ for test: kms_addfb_basic results: parsing output: 92/ for test: gem_ctx_sseu results: parsing output: 93/ for test: gem_ctx_persistence results: parsing output: 94/ for test: syncobj_timeline results: parsing output: 95/ for test: kms_ccs results: parsing output: 96/ for test: kms_psr results: parsing output: 97/ for test: kms_big_fb results: parsing output: 98/ for test: kms_cursor_legacy results: parsing output: 99/ for test: kms_ccs results: parsing output: 100/ for test: kms_vblank results: parsing output: 101/ for test: kms_frontbuffer_tracking results: parsing output: 102/ for test: gem_create results: parsing output: 103/ for test: kms_flip results: parsing output: 104/ for test: gem_exec_whisper results: parsing output: 105/ for test: kms_psr2_sf results: parsing output: 106/ for test: kms_fb_coherency results: parsing output: 107/ for test: kms_properties results: parsing output: 108/ for test: kms_pipe_stress results: parsing output: 109/ for test: perf_pmu results: parsing output: 110/ for test: kms_atomic results: parsing output: 111/ for test: kms_psr results: parsing output: 112/ for test: api_intel_allocator results: parsing output: 113/ for test: kms_cursor_crc results: parsing output: 114/ for test: syncobj_timeline results: parsing output: 115/ for test: prime_vgem results: parsing output: 116/ for test: gem_exec_params results: parsing output: 117/ for test: kms_plane_lowres results: parsing output: 118/ for test: gem_pxp results: parsing output: 119/ for test: syncobj_basic results: parsing output: 120/ for test: kms_plane results: parsing output: 121/ for test: kms_content_protection results: parsing output: 122/ for test: syncobj_wait results: parsing output: 123/ for test: kms_frontbuffer_tracking results: parsing output: 124/ for test: kms_psr results: parsing output: 125/ for test: kms_big_fb results: parsing output: 126/ for test: kms_psr results: parsing output: 127/ for test: kms_busy results: parsing output: 128/ for test: gem_close_race results: parsing output: 129/ for test: perf_pmu results: parsing output: 130/ for test: gem_exec_fence results: parsing output: 131/ for test: kms_frontbuffer_tracking Done.