[62.192389] Initializing watchdogs [62.192435] /dev/watchdog0 [62.206023] [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] [62.210436] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [62.212725] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [62.215988] [001/133] (960s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs) [62.342746] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs [62.347285] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s) [63.457174] [002/133] (959s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt) [63.551747] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt [63.555903] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [63.682207] [003/133] (959s left) kms_cursor_crc (cursor-tearing-position-change) [63.798611] Starting subtest: cursor-tearing-position-change [63.800680] Starting dynamic subtest: pipe-A-eDP-1 [64.397533] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.599s) [64.406062] Starting dynamic subtest: pipe-D-eDP-1 [65.588872] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.192s) [65.591352] Subtest cursor-tearing-position-change: SUCCESS (1.793s) [66.421228] [004/133] (956s left) kms_async_flips (crc) [66.515750] Starting subtest: crc [66.885689] Starting dynamic subtest: pipe-A-eDP-1 [69.849958] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.944s) [70.203271] Starting dynamic subtest: pipe-B-eDP-1 [73.171338] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.958s) [73.528420] Starting dynamic subtest: pipe-C-eDP-1 [76.495419] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.945s) [76.826280] Starting dynamic subtest: pipe-D-eDP-1 [79.735699] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.886s) [79.737587] Subtest crc: SUCCESS (13.197s) [80.862587] [005/133] (942s left) kms_content_protection (content-type-change) [80.998328] Starting subtest: content-type-change [81.002880] Subtest content-type-change: SKIP (0.000s) [81.106953] [006/133] (941s left) kms_chamelium_hpd (common-hpd-after-suspend) [81.498587] Subtest common-hpd-after-suspend: SKIP (0.000s) [82.271315] [007/133] (940s left) fbdev (eof) [82.321955] Starting subtest: eof [82.324418] Subtest eof: SUCCESS (0.000s) [82.390924] [008/133] (940s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted) [82.449137] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted [82.554672] Subtest etime-multi-wait-all-available-unsubmitted-submitted: SUCCESS (0.105s) [82.629212] [009/133] (940s left) kms_cursor_legacy (cursora-vs-flipa-atomic) [82.751239] Starting subtest: cursorA-vs-flipA-atomic [93.883892] Subtest cursorA-vs-flipA-atomic: SUCCESS (11.135s) [94.733322] [010/133] (928s left) kms_color_pipeline (plane-ctm3x4-lut1d) [94.828367] Starting subtest: plane-ctm3x4-lut1d [94.995815] Starting dynamic subtest: pipe-A-plane-0 [95.140693] Dynamic subtest pipe-A-plane-0: SUCCESS (0.144s) [95.147849] Starting dynamic subtest: pipe-A-plane-1 [95.275359] Dynamic subtest pipe-A-plane-1: SUCCESS (0.133s) [95.282828] Starting dynamic subtest: pipe-A-plane-2 [95.451737] Dynamic subtest pipe-A-plane-2: SUCCESS (0.178s) [96.656226] Starting dynamic subtest: pipe-B-plane-0 [96.794434] Dynamic subtest pipe-B-plane-0: SUCCESS (0.144s) [96.802211] Starting dynamic subtest: pipe-B-plane-1 [96.972614] Dynamic subtest pipe-B-plane-1: SUCCESS (0.177s) [96.983366] Starting dynamic subtest: pipe-B-plane-2 [97.149735] Dynamic subtest pipe-B-plane-2: SUCCESS (0.177s) [98.383919] Starting dynamic subtest: pipe-C-plane-0 [98.512062] Dynamic subtest pipe-C-plane-0: SUCCESS (0.133s) [98.519392] Starting dynamic subtest: pipe-C-plane-1 [98.647196] Dynamic subtest pipe-C-plane-1: SUCCESS (0.133s) [98.656837] Starting dynamic subtest: pipe-C-plane-2 [98.790102] Dynamic subtest pipe-C-plane-2: SUCCESS (0.144s) [100.008684] Starting dynamic subtest: pipe-D-plane-0 [100.136663] Dynamic subtest pipe-D-plane-0: SUCCESS (0.133s) [100.145262] Starting dynamic subtest: pipe-D-plane-1 [100.292381] Dynamic subtest pipe-D-plane-1: SUCCESS (0.155s) [100.299508] Starting dynamic subtest: pipe-D-plane-2 [100.436647] Dynamic subtest pipe-D-plane-2: SUCCESS (0.143s) [100.722698] Subtest plane-ctm3x4-lut1d: SUCCESS (5.896s) [101.551066] [011/133] (921s left) gem_lmem_swapping (heavy-verify-multi) [101.595524] Subtest heavy-verify-multi: SKIP (0.000s) [101.631651] [012/133] (921s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu) [101.728524] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu [101.732964] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [101.820196] [013/133] (921s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt) [101.916043] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt [101.920603] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [102.000861] [014/133] (921s left) gen3_render_linear_blits [102.129127] [015/133] (921s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc) [102.219250] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc [102.221619] Starting dynamic subtest: pipe-A-eDP-1 [102.282660] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [102.291980] Starting dynamic subtest: pipe-B-eDP-1 [102.351245] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [102.359951] Starting dynamic subtest: pipe-C-eDP-1 [102.417072] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [102.425547] Starting dynamic subtest: pipe-D-eDP-1 [102.482030] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [102.486374] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.008s) [104.495801] [016/133] (918s left) kms_cursor_crc (cursor-rapid-movement-128x42) [104.741787] Starting subtest: cursor-rapid-movement-128x42 [104.787088] Subtest cursor-rapid-movement-128x42: SKIP (0.040s) [104.988367] [017/133] (918s left) gem_exec_schedule (fifo) [105.066333] Starting subtest: fifo [105.068320] Starting dynamic subtest: rcs0 [105.152650] Dynamic subtest rcs0: SUCCESS (0.095s) [105.160031] Starting dynamic subtest: vcs0 [105.236863] Dynamic subtest vcs0: SUCCESS (0.083s) [105.247670] Starting dynamic subtest: vcs1 [105.317806] Dynamic subtest vcs1: SUCCESS (0.080s) [105.330126] Starting dynamic subtest: vecs0 [105.401435] Dynamic subtest vecs0: SUCCESS (0.083s) [105.414538] Starting dynamic subtest: ccs0 [105.491300] Dynamic subtest ccs0: SUCCESS (0.090s) [105.493747] Subtest fifo: SUCCESS (0.434s) [106.971049] [018/133] (916s left) gem_softpin (noreloc) [107.036341] Starting subtest: noreloc [112.480677] Subtest noreloc: SUCCESS (5.390s) [112.547862] [019/133] (910s left) i915_drm_fdinfo (virtual-busy-hang) [112.589929] Starting subtest: virtual-busy-hang [112.594898] Subtest virtual-busy-hang: SKIP (0.000s) [112.657359] [020/133] (910s left) kms_lease (master-vs-lease) [112.750985] Starting subtest: master-vs-lease [112.753318] Subtest master-vs-lease: SUCCESS (0.001s) [112.840400] [021/133] (910s left) prime_vgem (basic-gtt) [112.987532] Starting subtest: basic-gtt [112.992191] Subtest basic-gtt: SKIP (0.000s) [113.087760] [FACT prime_vgem (basic-gtt)] new: kernel.kmod_is_loaded.vgem: true [113.091104] [022/133] (910s left) gem_exec_schedule (u-semaphore-resolve) [113.170539] Starting subtest: u-semaphore-resolve [113.199582] Subtest u-semaphore-resolve: SUCCESS (0.037s) [113.523209] [023/133] (910s left) kms_joiner (invalid-modeset-force-big-joiner) [113.614232] Starting subtest: invalid-modeset-force-big-joiner [113.618505] Subtest invalid-modeset-force-big-joiner: SKIP (0.000s) [113.679980] [024/133] (909s left) gem_shrink (reclaim) [113.743622] Starting subtest: reclaim [116.196691] Subtest reclaim: SUCCESS (2.451s) [116.346142] [025/133] (907s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic) [116.461646] Starting subtest: 2x-cursor-vs-flip-atomic [116.466305] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.001s) [116.602945] [026/133] (907s left) kms_chamelium_frames (hdmi-crc-single) [116.978843] Subtest hdmi-crc-single: SKIP (0.000s) [117.810407] [027/133] (905s left) gem_exec_params (rel-constants-invalid-rel-gen5) [117.865651] Starting subtest: rel-constants-invalid-rel-gen5 [117.868801] Subtest rel-constants-invalid-rel-gen5: SUCCESS (0.000s) [117.949234] [028/133] (905s left) vgem_basic (dmabuf-mmap) [117.991284] Starting subtest: dmabuf-mmap [117.997497] Subtest dmabuf-mmap: SUCCESS (0.008s) [118.047103] [029/133] (905s left) gem_userptr_blits (readonly-unsync) [118.106721] Subtest readonly-unsync: SKIP (0.000s) [118.231095] [030/133] (905s left) gem_softpin (evict-active) [118.292915] Starting subtest: evict-active [118.299248] Subtest evict-active: SUCCESS (0.006s) [118.439662] [031/133] (905s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-downscaling) [118.535975] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-downscaling [118.540254] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-downscaling: SKIP (0.000s) [118.605364] [032/133] (905s left) kms_pm_backlight (fade) [118.696317] Starting subtest: fade [118.744402] Starting dynamic subtest: eDP-1 [121.217450] Dynamic subtest eDP-1: SUCCESS (2.469s) [121.219749] Subtest fade: SUCCESS (2.520s) [122.054283] [033/133] (901s left) kms_big_fb (y-tiled-16bpp-rotate-270) [122.152605] Starting subtest: y-tiled-16bpp-rotate-270 [122.157214] Subtest y-tiled-16bpp-rotate-270: SKIP (0.000s) [122.248420] [034/133] (901s left) gem_ctx_persistence (smoketest) [122.305562] Starting subtest: smoketest [161.845709] Subtest smoketest: SUCCESS (39.536s) [161.922293] [035/133] (862s left) gem_exec_balancer (sequential) [161.986789] Starting subtest: sequential [165.052659] Subtest sequential: SUCCESS (3.065s) [165.366597] [036/133] (858s left) gem_wait (write-wait) [165.441932] Starting subtest: write-wait [165.444383] Starting dynamic subtest: all-engines [166.566487] Dynamic subtest all-engines: SUCCESS (1.123s) [166.581984] Starting dynamic subtest: rcs0 [167.627372] Dynamic subtest rcs0: SUCCESS (1.060s) [167.641643] Starting dynamic subtest: bcs0 [168.687077] Dynamic subtest bcs0: SUCCESS (1.059s) [168.700924] Starting dynamic subtest: vcs0 [169.741230] Dynamic subtest vcs0: SUCCESS (1.053s) [169.755892] Starting dynamic subtest: vcs1 [170.795324] Dynamic subtest vcs1: SUCCESS (1.053s) [170.809799] Starting dynamic subtest: vecs0 [171.851651] Dynamic subtest vecs0: SUCCESS (1.053s) [171.867854] Starting dynamic subtest: ccs0 [172.905595] Dynamic subtest ccs0: SUCCESS (1.055s) [172.908270] Subtest write-wait: SUCCESS (7.464s) [173.106208] [037/133] (851s left) kms_psr (fbc-psr2-suspend) [173.207750] Starting subtest: fbc-psr2-suspend [173.209992] Starting dynamic subtest: eDP-1 [173.214048] Dynamic subtest eDP-1: SKIP (0.000s) [173.218172] Subtest fbc-psr2-suspend: SKIP (0.001s) [173.280227] [038/133] (850s left) gen9_exec_parse (batch-without-end) [173.343791] Subtest batch-without-end: SKIP (0.000s) [173.416043] [039/133] (850s left) kms_cursor_legacy (cursor-vs-flip-varying-size) [173.537347] Starting subtest: cursor-vs-flip-varying-size [204.821197] Subtest cursor-vs-flip-varying-size: SUCCESS (31.284s) [205.665648] [040/133] (818s left) dmabuf_sync_file (import-multiple-read-only) [205.721069] Starting subtest: import-multiple-read-only [205.723491] Subtest import-multiple-read-only: SUCCESS (0.003s) [205.778220] [041/133] (818s left) prime_mmap (test_map_unmap) [205.828048] Starting subtest: test_map_unmap [205.830268] Starting dynamic subtest: test_map_unmap-smem [205.858284] Dynamic subtest test_map_unmap-smem: SUCCESS (0.032s) [205.860732] Subtest test_map_unmap: SUCCESS (0.032s) [205.954957] [042/133] (818s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-downscaling) [206.046100] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-downscaling [206.048391] Starting dynamic subtest: pipe-A-default-mode [207.221645] Dynamic subtest pipe-A-default-mode: SKIP (1.174s) [207.226061] Subtest flip-64bpp-4tile-to-32bpp-4tile-downscaling: SKIP (1.176s) [207.378827] [043/133] (816s left) kms_plane (pixel-format-linear-modifier-source-clamping) [207.473105] Starting subtest: pixel-format-linear-modifier-source-clamping [207.499305] Starting dynamic subtest: pipe-A-plane-0 [210.954317] Dynamic subtest pipe-A-plane-0: SUCCESS (3.455s) [210.964420] Starting dynamic subtest: pipe-A-plane-3 [212.631970] Dynamic subtest pipe-A-plane-3: SUCCESS (1.677s) [213.774838] Starting dynamic subtest: pipe-B-plane-0 [217.345656] Dynamic subtest pipe-B-plane-0: SUCCESS (3.578s) [217.353669] Starting dynamic subtest: pipe-B-plane-3 [219.034536] Dynamic subtest pipe-B-plane-3: SUCCESS (1.687s) [219.343423] Subtest pixel-format-linear-modifier-source-clamping: SUCCESS (11.871s) [220.155142] [044/133] (804s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-move) [220.249891] Starting subtest: psr-2p-scndscrn-cur-indfb-move [220.253815] Subtest psr-2p-scndscrn-cur-indfb-move: SKIP (0.000s) [220.373473] [045/133] (804s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-submitted) [220.424779] Starting subtest: multi-wait-all-for-submit-unsubmitted-submitted [220.530675] Subtest multi-wait-all-for-submit-unsubmitted-submitted: SUCCESS (0.103s) [220.603179] [046/133] (803s left) gem_ctx_shared (q-in-order) [220.667360] Starting subtest: Q-in-order [220.669787] Starting dynamic subtest: rcs0 [220.774100] Dynamic subtest rcs0: SUCCESS (0.106s) [220.783020] Starting dynamic subtest: vcs0 [220.864138] Dynamic subtest vcs0: SUCCESS (0.089s) [220.877106] Starting dynamic subtest: vcs1 [220.943797] Dynamic subtest vcs1: SUCCESS (0.079s) [220.959291] Starting dynamic subtest: vecs0 [221.019664] Dynamic subtest vecs0: SUCCESS (0.075s) [221.034698] Starting dynamic subtest: ccs0 [221.094894] Dynamic subtest ccs0: SUCCESS (0.075s) [221.097387] Subtest Q-in-order: SUCCESS (0.428s) [222.001164] [047/133] (802s left) kms_getfb (getfb-repeated-different-handles) [222.097727] Starting subtest: getfb-repeated-different-handles [222.099988] Subtest getfb-repeated-different-handles: SUCCESS (0.000s) [222.203768] [048/133] (802s left) gem_mmap_wc (close) [222.267535] Subtest close: SKIP (0.000s) [222.342494] [049/133] (802s left) drm_read (invalid-buffer) [222.486278] Starting subtest: invalid-buffer [222.488759] Subtest invalid-buffer: SUCCESS (0.000s) [222.613148] [050/133] (802s left) kms_flip (plain-flip-interruptible) [222.706338] Starting subtest: plain-flip-interruptible [222.708799] Starting dynamic subtest: A-eDP1 [224.359925] Dynamic subtest A-eDP1: SUCCESS (1.654s) [224.369940] Starting dynamic subtest: B-eDP1 [225.999150] Dynamic subtest B-eDP1: SUCCESS (1.637s) [226.009128] Starting dynamic subtest: C-eDP1 [227.618679] Dynamic subtest C-eDP1: SUCCESS (1.619s) [227.628393] Starting dynamic subtest: D-eDP1 [229.256552] Dynamic subtest D-eDP1: SUCCESS (1.637s) [229.261881] Subtest plain-flip-interruptible: SUCCESS (6.556s) [230.437793] [051/133] (794s left) gem_render_copy (yf-tiled-to-vebox-x-tiled) [230.509272] Starting subtest: yf-tiled-to-vebox-x-tiled [230.513808] Subtest yf-tiled-to-vebox-x-tiled: SKIP (0.000s) [230.699128] [052/133] (794s left) kms_big_fb (4-tiled-64bpp-rotate-0) [230.812028] Starting subtest: 4-tiled-64bpp-rotate-0 [232.418806] Subtest 4-tiled-64bpp-rotate-0: SUCCESS (1.607s) [232.588259] [053/133] (792s left) gem_create (create-ext-placement-all) [232.750384] Starting subtest: create-ext-placement-all [232.752539] Subtest create-ext-placement-all: SUCCESS (0.000s) [232.854912] [054/133] (791s left) gem_mmap_offset (partial-unmap) [232.910046] Starting subtest: partial-unmap [232.912023] Starting dynamic subtest: smem0 [233.395876] Dynamic subtest smem0: SUCCESS (0.486s) [233.398677] Subtest partial-unmap: SUCCESS (0.487s) [233.498705] [055/133] (791s left) gem_ctx_isolation (dirty-create) [233.561065] Starting subtest: dirty-create [233.563104] Starting dynamic subtest: rcs0 [233.731509] Dynamic subtest rcs0: SUCCESS (0.173s) [233.741515] Starting dynamic subtest: bcs0 [233.935527] Dynamic subtest bcs0: SUCCESS (0.203s) [233.945858] Starting dynamic subtest: vcs0 [234.151621] Dynamic subtest vcs0: SUCCESS (0.214s) [234.163569] Starting dynamic subtest: vcs1 [236.129538] Dynamic subtest vcs1: SUCCESS (1.977s) [236.137272] Starting dynamic subtest: vecs0 [238.103021] Dynamic subtest vecs0: SUCCESS (1.973s) [238.112843] Starting dynamic subtest: ccs0 [240.115544] Dynamic subtest ccs0: SUCCESS (2.012s) [240.117884] Subtest dirty-create: SUCCESS (6.557s) [240.342558] [056/133] (784s left) api_intel_bb (blit-reloc-purge-cache) [240.401596] Starting subtest: blit-reloc-purge-cache [240.406191] Subtest blit-reloc-purge-cache: SKIP (0.001s) [240.517505] [057/133] (784s left) vgem_basic (bad-fence) [240.567264] Starting subtest: bad-fence [240.569204] Subtest bad-fence: SUCCESS (0.000s) [240.625928] [058/133] (784s left) kms_flip (2x-blocking-absolute-wf_vblank) [240.734397] Starting subtest: 2x-blocking-absolute-wf_vblank [240.742736] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.010s) [240.821301] [059/133] (784s left) kms_plane_scaling (planes-upscale-20x20-downscale-factor-0-75) [240.911135] Starting subtest: planes-upscale-20x20-downscale-factor-0-75 [240.913413] Starting dynamic subtest: pipe-A [240.932155] Dynamic subtest pipe-A: SKIP (0.017s) [240.940617] Starting dynamic subtest: pipe-B [240.963568] Dynamic subtest pipe-B: SKIP (0.030s) [240.971917] Starting dynamic subtest: pipe-C [240.994814] Dynamic subtest pipe-C: SKIP (0.030s) [241.002682] Starting dynamic subtest: pipe-D [241.024061] Dynamic subtest pipe-D: SKIP (0.030s) [241.028574] Subtest planes-upscale-20x20-downscale-factor-0-75: SKIP (0.110s) [241.105672] [060/133] (783s left) kms_rotation_crc (primary-x-tiled-reflect-x-180) [241.193283] Starting subtest: primary-x-tiled-reflect-x-180 [248.087910] Subtest primary-x-tiled-reflect-x-180: SUCCESS (6.897s) [249.300394] [061/133] (775s left) syncobj_timeline (invalid-transfer-illegal-handle) [249.357767] Starting subtest: invalid-transfer-illegal-handle [249.359978] Subtest invalid-transfer-illegal-handle: SUCCESS (0.000s) [249.455706] [062/133] (775s left) kms_psr (fbc-pr-sprite-mmap-gtt) [249.541075] Starting subtest: fbc-pr-sprite-mmap-gtt [249.545412] Subtest fbc-pr-sprite-mmap-gtt: SKIP (0.000s) [249.611224] [063/133] (775s left) kms_psr (fbc-pr-primary-mmap-cpu) [249.697236] Starting subtest: fbc-pr-primary-mmap-cpu [249.701487] Subtest fbc-pr-primary-mmap-cpu: SKIP (0.000s) [249.769941] [064/133] (775s left) gem_exec_nop (basic-parallel) [249.844227] Starting subtest: basic-parallel [265.879405] Subtest basic-parallel: SUCCESS (16.043s) [266.111361] [065/133] (759s left) syncobj_timeline (reset-multiple-signaled) [266.172312] Starting subtest: reset-multiple-signaled [266.174625] Subtest reset-multiple-signaled: SUCCESS (0.001s) [266.286908] [066/133] (759s left) gem_mmap_wc (read-write-distinct) [266.336486] Subtest read-write-distinct: SKIP (0.000s) [266.413313] [067/133] (758s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation) [266.521966] Starting subtest: plane-downscale-factor-0-75-with-rotation [266.524179] Starting dynamic subtest: pipe-A [266.762119] Dynamic subtest pipe-A: SUCCESS (0.242s) [266.769985] Starting dynamic subtest: pipe-B [268.083370] Dynamic subtest pipe-B: SUCCESS (1.320s) [268.091599] Starting dynamic subtest: pipe-C [269.419197] Dynamic subtest pipe-C: SUCCESS (1.334s) [269.426933] Starting dynamic subtest: pipe-D [270.741967] Dynamic subtest pipe-D: SUCCESS (1.322s) [270.744345] Subtest plane-downscale-factor-0-75-with-rotation: SUCCESS (4.222s) [271.923681] [068/133] (753s left) gem_mmap_gtt (cpuset-big-copy-xy) [271.979299] Subtest cpuset-big-copy-XY: SKIP (0.000s) [272.037553] [069/133] (753s left) kms_universal_plane (universal-plane-sanity) [272.121839] Starting subtest: universal-plane-sanity [272.123785] Starting dynamic subtest: pipe-A-eDP-1 [272.718955] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.598s) [272.727868] Starting dynamic subtest: pipe-B-eDP-1 [273.938274] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.218s) [273.947498] Starting dynamic subtest: pipe-C-eDP-1 [275.145239] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.202s) [275.154231] Starting dynamic subtest: pipe-D-eDP-1 [276.386191] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.243s) [276.388551] Subtest universal-plane-sanity: SUCCESS (4.266s) [277.249657] [070/133] (748s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip) [277.360894] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip [277.365128] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s) [277.459131] [071/133] (748s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu) [277.562898] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu [281.542282] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (3.985s) [282.747812] [072/133] (742s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-onoff) [282.841993] Starting subtest: fbc-1p-primscrn-cur-indfb-onoff [286.728086] Subtest fbc-1p-primscrn-cur-indfb-onoff: SUCCESS (3.890s) [287.928943] [073/133] (737s left) kms_scaling_modes (scaling-mode-full-aspect) [288.029957] Starting subtest: scaling-mode-full-aspect [288.032255] Starting dynamic subtest: pipe-A-eDP-1 [288.123866] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.093s) [288.135867] Starting dynamic subtest: pipe-B-eDP-1 [289.247425] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.124s) [289.256180] Starting dynamic subtest: pipe-C-eDP-1 [290.364316] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.116s) [290.372562] Starting dynamic subtest: pipe-D-eDP-1 [291.515890] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.150s) [291.518163] Subtest scaling-mode-full-aspect: SUCCESS (3.490s) [292.664604] [074/133] (732s left) kms_psr (psr2-sprite-render) [292.766158] Starting subtest: psr2-sprite-render [292.768264] Starting dynamic subtest: eDP-1 [294.461795] Dynamic subtest eDP-1: SUCCESS (1.694s) [294.464173] Subtest psr2-sprite-render: SUCCESS (1.695s) [295.331894] [075/133] (730s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs) [295.424526] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs [295.426872] Starting dynamic subtest: pipe-A-eDP-1 [295.450511] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [295.461534] Starting dynamic subtest: pipe-B-eDP-1 [295.482947] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [295.490844] Starting dynamic subtest: pipe-C-eDP-1 [295.512124] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [295.519701] Starting dynamic subtest: pipe-D-eDP-1 [295.541431] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [295.545463] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.004s) [297.688992] [076/133] (728s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-plflip-blt) [297.784551] Starting subtest: psr-2p-scndscrn-shrfb-plflip-blt [297.788595] Subtest psr-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s) [297.910866] [077/133] (727s left) kms_addfb_basic (bad-pitch-0) [297.970049] Starting subtest: bad-pitch-0 [297.972053] Subtest bad-pitch-0: SUCCESS (0.000s) [298.094871] [078/133] (727s left) gem_workarounds (basic-read) [298.155580] Starting subtest: basic-read [298.167542] Subtest basic-read: SUCCESS (0.010s) [298.286384] [079/133] (727s left) gem_exec_whisper (basic-fds-priority-all) [298.347071] Starting subtest: basic-fds-priority-all [320.957487] Subtest basic-fds-priority-all: SUCCESS (22.609s) [321.150784] [080/133] (704s left) kms_draw_crc (draw-method-mmap-wc) [321.247997] Starting subtest: draw-method-mmap-wc [321.250314] Starting dynamic subtest: xrgb8888-untiled [321.469931] Dynamic subtest xrgb8888-untiled: SUCCESS (0.221s) [321.479660] Starting dynamic subtest: rgb565-untiled [321.678588] Dynamic subtest rgb565-untiled: SUCCESS (0.210s) [321.689583] Starting dynamic subtest: xrgb2101010-untiled [321.879161] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.199s) [321.889072] Starting dynamic subtest: xbgr16161616f-untiled [322.102953] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.221s) [322.111069] Starting dynamic subtest: xrgb8888-xtiled [322.245237] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.143s) [322.254451] Starting dynamic subtest: rgb565-xtiled [322.390184] Dynamic subtest rgb565-xtiled: SUCCESS (0.143s) [322.400266] Starting dynamic subtest: xrgb2101010-xtiled [322.523192] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.130s) [322.536429] Starting dynamic subtest: xbgr16161616f-xtiled [322.660122] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.132s) [322.670100] Starting dynamic subtest: xrgb8888-4tiled [322.812841] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.155s) [322.821238] Starting dynamic subtest: rgb565-4tiled [322.956507] Dynamic subtest rgb565-4tiled: SUCCESS (0.143s) [322.965570] Starting dynamic subtest: xrgb2101010-4tiled [323.089978] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.133s) [323.098957] Starting dynamic subtest: xbgr16161616f-4tiled [323.256504] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.166s) [323.258399] Subtest draw-method-mmap-wc: SUCCESS (2.011s) [323.350030] [081/133] (702s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite) [323.454867] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite [330.331273] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.878s) [330.457645] [082/133] (695s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-gtt) [330.553258] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-gtt [330.557492] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [330.666097] [083/133] (695s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-async-flip) [330.767436] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-async-flip [331.580833] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (0.815s) [331.765785] [084/133] (694s left) core_getstats (basic) [331.821255] Starting subtest: basic [331.823418] Subtest basic: SUCCESS (0.000s) [331.949060] [085/133] (694s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu) [332.059699] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu [338.648799] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.592s) [338.752109] [086/133] (687s left) kms_atomic (atomic-plane-damage) [338.845264] Starting subtest: atomic-plane-damage [338.898345] Starting dynamic subtest: pipe-A-eDP-1 [339.444244] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.546s) [339.446893] Subtest atomic-plane-damage: SUCCESS (0.601s) [340.282462] [087/133] (685s left) kms_chamelium_color (ctm-max) [340.378753] Subtest ctm-max: SKIP (0.000s) [340.427205] [088/133] (685s left) gem_spin_batch (spin-all-new) [340.489199] Starting subtest: spin-all-new [340.500395] Subtest spin-all-new: SUCCESS (0.014s) [341.954409] [089/133] (684s left) kms_pipe_stress (stress-xrgb8888-ytiled) [342.045750] Starting subtest: stress-xrgb8888-ytiled [342.050158] Subtest stress-xrgb8888-ytiled: SKIP (0.000s) [342.128228] [090/133] (684s left) kms_plane_multiple (2x-tiling-x) [342.217098] Starting subtest: 2x-tiling-x [342.221109] Subtest 2x-tiling-x: SKIP (0.000s) [342.288207] [091/133] (684s left) perf (oa-formats) [342.415447] Starting subtest: oa-formats [342.417452] Starting dynamic subtest: 0-rcs0 [342.431539] Dynamic subtest 0-rcs0: SUCCESS (0.017s) [342.441878] Starting dynamic subtest: 1-vcs0 [342.454622] Dynamic subtest 1-vcs0: SUCCESS (0.022s) [342.456939] Subtest oa-formats: SUCCESS (0.041s) [342.503098] [092/133] (683s left) syncobj_timeline (wait-any-complex) [342.572452] Starting subtest: wait-any-complex [342.634070] Subtest wait-any-complex: SUCCESS (0.062s) [342.711539] [093/133] (683s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling) [342.820343] Subtest addfb25-framebuffer-vs-set-tiling: SKIP (0.000s) [342.918389] [094/133] (683s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs) [343.022061] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs [343.024083] Starting dynamic subtest: pipe-A-eDP-1 [343.043536] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s) [343.056568] Starting dynamic subtest: pipe-B-eDP-1 [343.076543] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [343.093407] Starting dynamic subtest: pipe-C-eDP-1 [343.112085] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [343.129058] Starting dynamic subtest: pipe-D-eDP-1 [343.149088] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [343.152825] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs: SKIP (0.017s) [345.340960] [095/133] (681s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-gtt) [345.445703] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-gtt [345.449903] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [345.554515] [096/133] (680s left) kms_psr2_sf (pr-overlay-plane-update-sf-dmg-area) [345.657098] Starting subtest: pr-overlay-plane-update-sf-dmg-area [345.661201] Subtest pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s) [345.726144] [097/133] (680s left) gem_exec_fence (syncobj-timeline-invalid-wait) [346.350929] Starting subtest: syncobj-timeline-invalid-wait [346.353935] Subtest syncobj-timeline-invalid-wait: SUCCESS (0.004s) [348.017894] [098/133] (678s left) gem_mmap_offset (ptrace) [348.076254] Starting subtest: ptrace [348.081069] Starting dynamic subtest: smem0-wb [348.097361] Dynamic subtest smem0-wb: SUCCESS (0.019s) [348.108168] Starting dynamic subtest: smem0-wc [348.116649] Dynamic subtest smem0-wc: SUCCESS (0.018s) [348.124902] Starting dynamic subtest: smem0-uc [348.136699] Dynamic subtest smem0-uc: SUCCESS (0.019s) [348.139161] Subtest ptrace: SUCCESS (0.061s) [348.268269] [099/133] (678s left) kms_vblank (wait-busy-hang) [348.373880] Starting subtest: wait-busy-hang [348.375718] Starting dynamic subtest: pipe-A-eDP-1 [374.685366] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.310s) [374.699427] Starting dynamic subtest: pipe-D-eDP-1 [399.629427] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.939s) [399.631425] Subtest wait-busy-hang: SUCCESS (51.253s) [400.422283] [100/133] (626s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-blt) [400.529713] Starting subtest: psr-1p-primscrn-spr-indfb-draw-blt [407.321411] Subtest psr-1p-primscrn-spr-indfb-draw-blt: SUCCESS (6.794s) [407.470555] [101/133] (619s left) kms_big_fb (x-tiled-32bpp-rotate-270) [407.569849] Starting subtest: x-tiled-32bpp-rotate-270 [407.589038] Subtest x-tiled-32bpp-rotate-270: SKIP (0.019s) [407.700347] [102/133] (619s left) gem_render_copy (linear-to-vebox-yf-tiled) [407.753318] Starting subtest: linear-to-vebox-yf-tiled [407.757500] Subtest linear-to-vebox-yf-tiled: SKIP (0.000s) [407.935306] [103/133] (618s left) i915_hangman (gt-engine-hang) [408.004556] Starting subtest: gt-engine-hang [408.006547] Starting dynamic subtest: rcs0 [409.844672] Dynamic subtest rcs0: SUCCESS (1.840s) [409.857056] Starting dynamic subtest: bcs0 [411.892497] Dynamic subtest bcs0: SUCCESS (2.045s) [411.904430] Starting dynamic subtest: vcs0 [413.876328] Dynamic subtest vcs0: SUCCESS (1.982s) [413.888569] Starting dynamic subtest: vcs1 [415.860085] Dynamic subtest vcs1: SUCCESS (1.981s) [415.872075] Starting dynamic subtest: vecs0 [417.843785] Dynamic subtest vecs0: SUCCESS (1.980s) [417.855835] Starting dynamic subtest: ccs0 [419.892104] Dynamic subtest ccs0: SUCCESS (2.045s) [419.894865] Subtest gt-engine-hang: SUCCESS (11.889s) [420.018208] [104/133] (606s left) kms_addfb_basic (bad-pitch-32) [420.067757] Starting subtest: bad-pitch-32 [420.070076] Subtest bad-pitch-32: SUCCESS (0.000s) [420.206605] [105/133] (606s left) perf_pmu (semaphore-busy) [420.248564] Starting subtest: semaphore-busy [420.250819] Starting dynamic subtest: rcs0 [421.903861] Dynamic subtest rcs0: SUCCESS (1.654s) [421.915099] Starting dynamic subtest: bcs0 [423.537024] Dynamic subtest bcs0: SUCCESS (1.630s) [423.548312] Starting dynamic subtest: vcs0 [427.461927] Dynamic subtest vcs0: SUCCESS (3.869s) [427.473352] Starting dynamic subtest: vcs1 [433.424781] Dynamic subtest vcs1: SUCCESS (6.014s) [433.435064] Starting dynamic subtest: vecs0 [439.491976] Dynamic subtest vecs0: SUCCESS (6.013s) [439.502764] Starting dynamic subtest: ccs0 [442.512781] Dynamic subtest ccs0: SUCCESS (3.069s) [442.515630] Subtest semaphore-busy: SUCCESS (22.265s) [442.633135] [106/133] (584s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite) [442.737233] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite [442.741671] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s) [442.833615] [107/133] (584s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip) [442.930698] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip [442.935034] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s) [443.024043] [108/133] (583s left) syncobj_timeline (host-signal-ordered) [443.076707] Starting subtest: host-signal-ordered [443.078649] Subtest host-signal-ordered: SUCCESS (0.000s) [443.172285] [109/133] (583s left) kms_psr2_sf (fbc-pr-primary-plane-update-sf-dmg-area) [443.274718] Starting subtest: fbc-pr-primary-plane-update-sf-dmg-area [443.278648] Subtest fbc-pr-primary-plane-update-sf-dmg-area: SKIP (0.000s) [443.343637] [110/133] (583s left) syncobj_wait (wait-for-submit-complex) [443.395079] Starting subtest: wait-for-submit-complex [443.455591] Subtest wait-for-submit-complex: SUCCESS (0.062s) [443.544226] [111/133] (583s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180) [443.633326] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180 [444.602051] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (0.968s) [444.727539] [112/133] (582s left) gem_readwrite (write-bad-handle) [444.780918] Subtest write-bad-handle: SKIP (0.000s) [444.837298] [113/133] (582s left) i915_pm_rpm (system-suspend-devices) [447.062034] Starting subtest: system-suspend-devices [454.860341] Subtest system-suspend-devices: SUCCESS (7.801s) [455.225921] [114/133] (572s left) kms_psr (fbc-psr-sprite-render) [455.352267] Starting subtest: fbc-psr-sprite-render [455.354183] Starting dynamic subtest: eDP-1 [455.358251] Dynamic subtest eDP-1: SKIP (0.000s) [455.362294] Subtest fbc-psr-sprite-render: SKIP (0.001s) [455.438627] [115/133] (571s left) kms_pm_rpm (modeset-non-lpsp-stress) [456.987066] Starting subtest: modeset-non-lpsp-stress [458.153092] Subtest modeset-non-lpsp-stress: SKIP (1.167s) [458.556113] [116/133] (568s left) kms_flip (2x-wf_vblank-ts-check-interruptible) [458.648941] Starting subtest: 2x-wf_vblank-ts-check-interruptible [458.660068] Subtest 2x-wf_vblank-ts-check-interruptible: SKIP (0.010s) [458.734160] [117/133] (568s left) gem_ctx_bad_destroy (invalid-ctx) [458.803470] Starting subtest: invalid-ctx [458.805761] Subtest invalid-ctx: SUCCESS (0.000s) [458.878328] [118/133] (568s left) gem_render_copy_redux (flink-interruptible) [458.938751] Starting subtest: flink-interruptible [459.707433] Subtest flink-interruptible: SUCCESS (0.771s) [459.840252] [119/133] (567s left) gem_exec_reloc (basic-gtt-cpu-active) [459.887897] Subtest basic-gtt-cpu-active: SKIP (0.000s) [459.956137] [120/133] (567s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt) [460.053153] Starting subtest: fbcpsr-rgb101010-draw-blt [466.829248] Subtest fbcpsr-rgb101010-draw-blt: SUCCESS (6.778s) [467.005858] [121/133] (560s left) i915_selftest (perf) [470.261432] Starting subtest: perf [470.263912] Starting dynamic subtest: engine_cs [474.571039] Dynamic subtest engine_cs: SUCCESS (4.312s) [474.580956] Starting dynamic subtest: request [479.845971] Dynamic subtest request: SUCCESS (5.272s) [479.860500] Starting dynamic subtest: migrate [484.165357] Dynamic subtest migrate: SUCCESS (4.318s) [484.175137] Starting dynamic subtest: region [489.810428] Dynamic subtest region: SUCCESS (5.643s) [489.812884] Subtest perf: SUCCESS (19.553s) [489.839978] [FACT i915_selftest (perf)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [489.840714] [FACT i915_selftest (perf)] deleted: kernel.kmod_is_loaded.i915: true [489.844441] [122/133] (537s left) kms_cursor_legacy (short-flip-before-cursor-toggle) [491.407267] Starting subtest: short-flip-before-cursor-toggle [492.370398] Subtest short-flip-before-cursor-toggle: SUCCESS (0.963s) [493.264750] [FACT kms_cursor_legacy (short-flip-before-cursor-toggle)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [493.265944] [FACT kms_cursor_legacy (short-flip-before-cursor-toggle)] new: kernel.kmod_is_loaded.i915: true [493.269660] [123/133] (534s left) gem_fence_thrash (bo-write-verify-x) [493.323542] Starting subtest: bo-write-verify-x [493.351671] Subtest bo-write-verify-x: SKIP (0.027s) [493.421435] [124/133] (534s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-blt) [493.519023] Starting subtest: psr-2p-primscrn-pri-indfb-draw-blt [493.523124] Subtest psr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s) [493.632959] [125/133] (534s left) kms_cursor_crc (cursor-offscreen-64x21) [493.827108] Starting subtest: cursor-offscreen-64x21 [493.872141] Subtest cursor-offscreen-64x21: SKIP (0.044s) [494.133371] [126/133] (533s left) perf_pmu (busy-accuracy-2) [494.179085] Starting subtest: busy-accuracy-2 [494.181072] Starting dynamic subtest: rcs0 [497.221098] Dynamic subtest rcs0: SUCCESS (3.040s) [497.232432] Starting dynamic subtest: bcs0 [500.333942] Dynamic subtest bcs0: SUCCESS (3.058s) [500.344484] Starting dynamic subtest: vcs0 [503.379317] Dynamic subtest vcs0: SUCCESS (3.045s) [503.390443] Starting dynamic subtest: vcs1 [506.428522] Dynamic subtest vcs1: SUCCESS (3.047s) [506.439203] Starting dynamic subtest: vecs0 [509.475090] Dynamic subtest vecs0: SUCCESS (3.044s) [509.486064] Starting dynamic subtest: ccs0 [512.526880] Dynamic subtest ccs0: SUCCESS (3.050s) [512.529219] Subtest busy-accuracy-2: SUCCESS (18.298s) [512.598378] [127/133] (515s left) kms_frontbuffer_tracking (fbc-indfb-scaledprimary) [512.719674] Starting subtest: fbc-indfb-scaledprimary [515.709058] Subtest fbc-indfb-scaledprimary: SUCCESS (2.993s) [516.849793] [128/133] (510s left) gem_exec_balancer (hang) [517.105287] Starting subtest: hang [518.870396] Subtest hang: SUCCESS (1.768s) [518.980210] [129/133] (508s left) perf_pmu (busy-idle-no-semaphores) [519.015912] Starting subtest: busy-idle-no-semaphores [519.018161] Starting dynamic subtest: rcs0 [519.684389] Dynamic subtest rcs0: SUCCESS (0.668s) [519.696035] Starting dynamic subtest: bcs0 [520.339669] Dynamic subtest bcs0: SUCCESS (0.653s) [520.351593] Starting dynamic subtest: vcs0 [520.992809] Dynamic subtest vcs0: SUCCESS (0.650s) [521.004812] Starting dynamic subtest: vcs1 [522.556613] Dynamic subtest vcs1: SUCCESS (1.561s) [522.568873] Starting dynamic subtest: vecs0 [524.542520] Dynamic subtest vecs0: SUCCESS (1.983s) [524.554661] Starting dynamic subtest: ccs0 [526.526677] Dynamic subtest ccs0: SUCCESS (1.981s) [526.529837] Subtest busy-idle-no-semaphores: SUCCESS (7.512s) [526.644903] [130/133] (501s left) gem_exec_params (invalid-ring2) [526.692137] Starting subtest: invalid-ring2 [526.694455] Subtest invalid-ring2: SUCCESS (0.000s) [526.785918] [131/133] (501s left) gem_exec_schedule (pi-ringfull) [526.976817] Starting subtest: pi-ringfull [526.979114] Starting dynamic subtest: rcs0 [527.007308] Dynamic subtest rcs0: SUCCESS (0.033s) [527.024956] Starting dynamic subtest: bcs0 [527.040082] Dynamic subtest bcs0: SUCCESS (0.032s) [527.056920] Starting dynamic subtest: vcs0 [527.071800] Dynamic subtest vcs0: SUCCESS (0.031s) [527.090607] Starting dynamic subtest: vcs1 [527.106856] Dynamic subtest vcs1: SUCCESS (0.034s) [527.121824] Starting dynamic subtest: vecs0 [527.137705] Dynamic subtest vecs0: SUCCESS (0.030s) [527.146447] Starting dynamic subtest: ccs0 [527.168652] Dynamic subtest ccs0: SUCCESS (0.030s) [527.170804] Subtest pi-ringfull: SUCCESS (0.195s) [527.424298] [132/133] (500s left) kms_dp_link_training (non-uhbr-sst) [527.514094] Starting subtest: non-uhbr-sst [527.522560] Subtest non-uhbr-sst: SKIP (0.000s) [527.586211] [133/133] (500s left) gem_exec_flush (basic-wb-set-default) [527.638988] Starting subtest: basic-wb-set-default [533.123300] Subtest basic-wb-set-default: SUCCESS (5.460s) [533.283762] Closing watchdogs results: parsing output: 0/ for test: kms_ccs results: parsing output: 1/ for test: kms_frontbuffer_tracking results: parsing output: 2/ for test: kms_cursor_crc results: parsing output: 3/ for test: kms_async_flips results: parsing output: 4/ for test: kms_content_protection results: parsing output: 5/ for test: kms_chamelium_hpd results: parsing output: 6/ for test: fbdev results: parsing output: 7/ for test: syncobj_timeline results: parsing output: 8/ for test: kms_cursor_legacy results: parsing output: 9/ for test: kms_color_pipeline results: parsing output: 10/ for test: gem_lmem_swapping results: parsing output: 11/ for test: kms_frontbuffer_tracking results: parsing output: 12/ for test: kms_frontbuffer_tracking results: parsing output: 13/ for test: gen3_render_linear_blits results: parsing output: 14/ for test: kms_ccs results: parsing output: 15/ for test: kms_cursor_crc results: parsing output: 16/ for test: gem_exec_schedule results: parsing output: 17/ for test: gem_softpin results: parsing output: 18/ for test: i915_drm_fdinfo results: parsing output: 19/ for test: kms_lease results: parsing output: 20/ for test: prime_vgem results: parsing output: 21/ for test: gem_exec_schedule results: parsing output: 22/ for test: kms_joiner results: parsing output: 23/ for test: gem_shrink results: parsing output: 24/ for test: kms_cursor_legacy results: parsing output: 25/ for test: kms_chamelium_frames results: parsing output: 26/ for test: gem_exec_params results: parsing output: 27/ for test: vgem_basic results: parsing output: 28/ for test: gem_userptr_blits results: parsing output: 29/ for test: gem_softpin results: parsing output: 30/ for test: kms_flip_scaled_crc results: parsing output: 31/ for test: kms_pm_backlight results: parsing output: 32/ for test: kms_big_fb results: parsing output: 33/ for test: gem_ctx_persistence results: parsing output: 34/ for test: gem_exec_balancer results: parsing output: 35/ for test: gem_wait results: parsing output: 36/ for test: kms_psr results: parsing output: 37/ for test: gen9_exec_parse results: parsing output: 38/ for test: kms_cursor_legacy results: parsing output: 39/ for test: dmabuf_sync_file results: parsing output: 40/ for test: prime_mmap results: parsing output: 41/ for test: kms_flip_scaled_crc results: parsing output: 42/ for test: kms_plane results: parsing output: 43/ for test: kms_frontbuffer_tracking results: parsing output: 44/ for test: syncobj_wait results: parsing output: 45/ for test: gem_ctx_shared results: parsing output: 46/ for test: kms_getfb results: parsing output: 47/ for test: gem_mmap_wc results: parsing output: 48/ for test: drm_read results: parsing output: 49/ for test: kms_flip results: parsing output: 50/ for test: gem_render_copy results: parsing output: 51/ for test: kms_big_fb results: parsing output: 52/ for test: gem_create results: parsing output: 53/ for test: gem_mmap_offset results: parsing output: 54/ for test: gem_ctx_isolation results: parsing output: 55/ for test: api_intel_bb results: parsing output: 56/ for test: vgem_basic results: parsing output: 57/ for test: kms_flip results: parsing output: 58/ for test: kms_plane_scaling results: parsing output: 59/ for test: kms_rotation_crc results: parsing output: 60/ for test: syncobj_timeline results: parsing output: 61/ for test: kms_psr results: parsing output: 62/ for test: kms_psr results: parsing output: 63/ for test: gem_exec_nop results: parsing output: 64/ for test: syncobj_timeline results: parsing output: 65/ for test: gem_mmap_wc results: parsing output: 66/ for test: kms_plane_scaling results: parsing output: 67/ for test: gem_mmap_gtt results: parsing output: 68/ for test: kms_universal_plane results: parsing output: 69/ for test: kms_big_fb results: parsing output: 70/ for test: kms_frontbuffer_tracking results: parsing output: 71/ for test: kms_frontbuffer_tracking results: parsing output: 72/ for test: kms_scaling_modes results: parsing output: 73/ for test: kms_psr results: parsing output: 74/ for test: kms_ccs results: parsing output: 75/ for test: kms_frontbuffer_tracking results: parsing output: 76/ for test: kms_addfb_basic results: parsing output: 77/ for test: gem_workarounds results: parsing output: 78/ for test: gem_exec_whisper results: parsing output: 79/ for test: kms_draw_crc results: parsing output: 80/ for test: kms_frontbuffer_tracking results: parsing output: 81/ for test: kms_frontbuffer_tracking results: parsing output: 82/ for test: kms_big_fb results: parsing output: 83/ for test: core_getstats results: parsing output: 84/ for test: kms_frontbuffer_tracking results: parsing output: 85/ for test: kms_atomic results: parsing output: 86/ for test: kms_chamelium_color results: parsing output: 87/ for test: gem_spin_batch results: parsing output: 88/ for test: kms_pipe_stress results: parsing output: 89/ for test: kms_plane_multiple results: parsing output: 90/ for test: perf results: parsing output: 91/ for test: syncobj_timeline results: parsing output: 92/ for test: kms_addfb_basic results: parsing output: 93/ for test: kms_ccs results: parsing output: 94/ for test: kms_frontbuffer_tracking results: parsing output: 95/ for test: kms_psr2_sf results: parsing output: 96/ for test: gem_exec_fence results: parsing output: 97/ for test: gem_mmap_offset results: parsing output: 98/ for test: kms_vblank results: parsing output: 99/ for test: kms_frontbuffer_tracking results: parsing output: 100/ for test: kms_big_fb results: parsing output: 101/ for test: gem_render_copy results: parsing output: 102/ for test: i915_hangman results: parsing output: 103/ for test: kms_addfb_basic results: parsing output: 104/ for test: perf_pmu results: parsing output: 105/ for test: kms_frontbuffer_tracking results: parsing output: 106/ for test: kms_big_fb results: parsing output: 107/ for test: syncobj_timeline results: parsing output: 108/ for test: kms_psr2_sf results: parsing output: 109/ for test: syncobj_wait results: parsing output: 110/ for test: kms_big_fb results: parsing output: 111/ for test: gem_readwrite results: parsing output: 112/ for test: i915_pm_rpm results: parsing output: 113/ for test: kms_psr results: parsing output: 114/ for test: kms_pm_rpm results: parsing output: 115/ for test: kms_flip results: parsing output: 116/ for test: gem_ctx_bad_destroy results: parsing output: 117/ for test: gem_render_copy_redux results: parsing output: 118/ for test: gem_exec_reloc results: parsing output: 119/ for test: kms_frontbuffer_tracking results: parsing output: 120/ for test: i915_selftest results: parsing output: 121/ for test: kms_cursor_legacy results: parsing output: 122/ for test: gem_fence_thrash results: parsing output: 123/ for test: kms_frontbuffer_tracking results: parsing output: 124/ for test: kms_cursor_crc results: parsing output: 125/ for test: perf_pmu results: parsing output: 126/ for test: kms_frontbuffer_tracking results: parsing output: 127/ for test: gem_exec_balancer results: parsing output: 128/ for test: perf_pmu results: parsing output: 129/ for test: gem_exec_params results: parsing output: 130/ for test: gem_exec_schedule results: parsing output: 131/ for test: kms_dp_link_training results: parsing output: 132/ for test: gem_exec_flush Done.