[117.794836] Initializing watchdogs [117.794884] /dev/watchdog0 [117.810593] [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] [117.815038] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [117.818198] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [117.821557] [001/156] (960s left) kms_lease (lease-get) [117.943153] Starting subtest: lease-get [117.945441] Starting dynamic subtest: pipe-A-eDP-1 [117.947674] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s) [117.955739] Starting dynamic subtest: pipe-B-eDP-1 [117.957955] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s) [117.965747] Starting dynamic subtest: pipe-C-eDP-1 [117.967999] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s) [117.976072] Starting dynamic subtest: pipe-D-eDP-1 [117.978204] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s) [117.980343] Subtest lease-get: SUCCESS (0.010s) [118.064214] [002/156] (960s left) gem_exec_schedule (preempt-contexts) [118.137104] Starting subtest: preempt-contexts [118.139054] Starting dynamic subtest: rcs0 [118.196264] Dynamic subtest rcs0: SUCCESS (0.060s) [118.207758] Starting dynamic subtest: bcs0 [118.250976] Dynamic subtest bcs0: SUCCESS (0.056s) [118.261471] Starting dynamic subtest: vcs0 [118.299294] Dynamic subtest vcs0: SUCCESS (0.048s) [118.308090] Starting dynamic subtest: vcs1 [118.348609] Dynamic subtest vcs1: SUCCESS (0.049s) [118.359511] Starting dynamic subtest: vecs0 [118.396739] Dynamic subtest vecs0: SUCCESS (0.048s) [118.409218] Starting dynamic subtest: ccs0 [118.443868] Dynamic subtest ccs0: SUCCESS (0.047s) [118.446197] Subtest preempt-contexts: SUCCESS (0.309s) [119.423055] [003/156] (958s left) gem_exec_async (forked-writes) [119.488096] Starting subtest: forked-writes [119.490441] Starting dynamic subtest: rcs0 [119.513709] Dynamic subtest rcs0: SUCCESS (0.025s) [119.525461] Starting dynamic subtest: bcs0 [119.536050] Dynamic subtest bcs0: SUCCESS (0.022s) [119.545425] Starting dynamic subtest: vcs0 [119.557384] Dynamic subtest vcs0: SUCCESS (0.021s) [119.567673] Starting dynamic subtest: vcs1 [119.579108] Dynamic subtest vcs1: SUCCESS (0.021s) [119.588065] Starting dynamic subtest: vecs0 [119.600879] Dynamic subtest vecs0: SUCCESS (0.021s) [119.610584] Starting dynamic subtest: ccs0 [119.622500] Dynamic subtest ccs0: SUCCESS (0.022s) [119.624710] Subtest forked-writes: SUCCESS (0.135s) [119.858617] [004/156] (958s left) kms_flip (2x-plain-flip-ts-check-interruptible) [119.962620] Starting subtest: 2x-plain-flip-ts-check-interruptible [119.975410] Subtest 2x-plain-flip-ts-check-interruptible: SKIP (0.011s) [120.048237] [005/156] (958s left) kms_cursor_crc (cursor-offscreen-128x128) [120.271270] Starting subtest: cursor-offscreen-128x128 [120.286668] Starting dynamic subtest: pipe-A-eDP-1 [122.289668] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.004s) [122.324560] Starting dynamic subtest: pipe-D-eDP-1 [124.946669] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.629s) [124.948977] Subtest cursor-offscreen-128x128: SUCCESS (4.677s) [125.798939] [006/156] (952s left) kms_cursor_crc (cursor-random-256x85) [126.059963] Starting subtest: cursor-random-256x85 [126.113684] Subtest cursor-random-256x85: SKIP (0.050s) [126.266923] [007/156] (952s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-indfb-pgflip-blt) [126.355266] Starting subtest: fbchdr-1p-primscrn-indfb-pgflip-blt [126.359590] Subtest fbchdr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s) [126.442115] [008/156] (952s left) kms_frontbuffer_tracking (fbc-tiling-y) [126.533831] Starting subtest: fbc-tiling-y [126.538208] Subtest fbc-tiling-y: SKIP (0.000s) [126.618238] [009/156] (952s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-render) [126.710722] Starting subtest: psr-2p-primscrn-cur-indfb-draw-render [126.713977] Subtest psr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s) [126.801616] [010/156] (951s left) kms_big_fb (linear-32bpp-rotate-270) [126.895755] Starting subtest: linear-32bpp-rotate-270 [126.915098] Subtest linear-32bpp-rotate-270: SKIP (0.019s) [127.028316] [011/156] (951s left) gem_mmap_wc (write-read) [127.086066] Subtest write-read: SKIP (0.000s) [127.144302] [012/156] (951s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-async-flip) [127.238434] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-async-flip [128.120469] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (0.883s) [128.320648] [013/156] (950s left) kms_psr2_sf (pr-cursor-plane-update-sf) [128.420616] Starting subtest: pr-cursor-plane-update-sf [128.424752] Subtest pr-cursor-plane-update-sf: SKIP (0.000s) [128.492335] [014/156] (950s left) kms_psr2_sf (fbc-pr-overlay-plane-move-continuous-exceed-sf) [128.584786] Starting subtest: fbc-pr-overlay-plane-move-continuous-exceed-sf [128.589212] Subtest fbc-pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s) [128.665173] [015/156] (950s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-pwrite) [128.761338] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-pwrite [136.182345] Subtest fbc-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (7.428s) [137.312824] [016/156] (941s left) gem_exec_fence (submit67) [137.478428] Starting subtest: submit67 [137.483203] Subtest submit67: SKIP (0.000s) [139.434391] [FACT gem_exec_fence (submit67)] new: kernel.kmod_is_loaded.vgem: true [139.437331] [017/156] (939s left) kms_frontbuffer_tracking (psrhdr-rgb101010-draw-mmap-cpu) [139.544316] Starting subtest: psrhdr-rgb101010-draw-mmap-cpu [139.548449] Subtest psrhdr-rgb101010-draw-mmap-cpu: SKIP (0.000s) [139.645597] [018/156] (939s left) kms_color_pipeline (plane-lut1d-ctm3x4) [139.732594] Starting subtest: plane-lut1d-ctm3x4 [139.890841] Starting dynamic subtest: pipe-A-plane-0 [140.057522] Dynamic subtest pipe-A-plane-0: SUCCESS (0.167s) [140.068030] Starting dynamic subtest: pipe-A-plane-1 [140.246468] Dynamic subtest pipe-A-plane-1: SUCCESS (0.189s) [140.255498] Starting dynamic subtest: pipe-A-plane-2 [140.413107] Dynamic subtest pipe-A-plane-2: SUCCESS (0.166s) [141.639095] Starting dynamic subtest: pipe-B-plane-0 [141.820269] Dynamic subtest pipe-B-plane-0: SUCCESS (0.189s) [141.829986] Starting dynamic subtest: pipe-B-plane-1 [141.975580] Dynamic subtest pipe-B-plane-1: SUCCESS (0.155s) [141.984617] Starting dynamic subtest: pipe-B-plane-2 [142.153447] Dynamic subtest pipe-B-plane-2: SUCCESS (0.178s) [143.329226] Starting dynamic subtest: pipe-C-plane-0 [143.487536] Dynamic subtest pipe-C-plane-0: SUCCESS (0.167s) [143.498287] Starting dynamic subtest: pipe-C-plane-1 [143.655355] Dynamic subtest pipe-C-plane-1: SUCCESS (0.166s) [143.664302] Starting dynamic subtest: pipe-C-plane-2 [143.821846] Dynamic subtest pipe-C-plane-2: SUCCESS (0.166s) [145.065916] Starting dynamic subtest: pipe-D-plane-0 [145.202318] Dynamic subtest pipe-D-plane-0: SUCCESS (0.144s) [145.211481] Starting dynamic subtest: pipe-D-plane-1 [145.358321] Dynamic subtest pipe-D-plane-1: SUCCESS (0.155s) [145.369692] Starting dynamic subtest: pipe-D-plane-2 [145.525448] Dynamic subtest pipe-D-plane-2: SUCCESS (0.166s) [145.812533] Subtest plane-lut1d-ctm3x4: SUCCESS (6.079s) [146.655149] [019/156] (932s left) syncobj_timeline (wait-zero-handles) [146.708815] Starting subtest: wait-zero-handles [146.711048] Subtest wait-zero-handles: SUCCESS (0.000s) [146.803533] [020/156] (932s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area) [146.895754] Starting subtest: psr2-overlay-plane-update-sf-dmg-area [146.898171] Starting dynamic subtest: pipe-A-eDP-1 [152.836334] Dynamic subtest pipe-A-eDP-1: SUCCESS (5.946s) [152.845241] Starting dynamic subtest: pipe-B-eDP-1 [159.481567] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.643s) [159.483898] Subtest psr2-overlay-plane-update-sf-dmg-area: SUCCESS (12.592s) [160.360912] [021/156] (918s left) prime_mmap (test_aperture_limit) [160.421075] Starting subtest: test_aperture_limit [160.423357] Starting dynamic subtest: test_aperture_limit-smem [160.430543] Dynamic subtest test_aperture_limit-smem: SKIP (0.009s) [160.434739] Subtest test_aperture_limit: SKIP (0.009s) [160.541573] [022/156] (918s left) gem_pxp (reject-modify-context-protection-off-2) [160.660876] Starting subtest: reject-modify-context-protection-off-2 [160.663358] Subtest reject-modify-context-protection-off-2: SUCCESS (0.002s) [160.767420] [023/156] (918s left) kms_atomic (plane-invalid-params) [160.861032] Starting subtest: plane-invalid-params [160.863375] Starting dynamic subtest: pipe-A-eDP-1 [161.275100] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.415s) [161.277451] Subtest plane-invalid-params: SUCCESS (0.416s) [162.098163] [024/156] (917s left) kms_psr (pr-sprite-mmap-cpu) [162.194717] Starting subtest: pr-sprite-mmap-cpu [162.199202] Subtest pr-sprite-mmap-cpu: SKIP (0.000s) [162.284218] [025/156] (917s left) gem_exec_schedule (fifo) [162.356182] Starting subtest: fifo [162.358117] Starting dynamic subtest: rcs0 [162.444469] Dynamic subtest rcs0: SUCCESS (0.098s) [162.453490] Starting dynamic subtest: vcs0 [162.526064] Dynamic subtest vcs0: SUCCESS (0.080s) [162.539219] Starting dynamic subtest: vcs1 [162.605093] Dynamic subtest vcs1: SUCCESS (0.078s) [162.617863] Starting dynamic subtest: vecs0 [162.678469] Dynamic subtest vecs0: SUCCESS (0.073s) [162.690470] Starting dynamic subtest: ccs0 [162.757325] Dynamic subtest ccs0: SUCCESS (0.079s) [162.759819] Subtest fifo: SUCCESS (0.411s) [164.407125] [026/156] (914s left) gem_partial_pwrite_pread (write-snoop) [164.463479] Subtest write-snoop: SKIP (0.000s) [164.533665] [027/156] (914s left) gem_exec_balancer (nop) [164.599645] Starting subtest: nop [211.227069] Subtest nop: SUCCESS (46.626s) [211.541085] [028/156] (867s left) kms_psr (fbc-psr-no-drrs) [211.647073] Starting subtest: fbc-psr-no-drrs [211.649358] Starting dynamic subtest: eDP-1 [211.653727] Dynamic subtest eDP-1: SKIP (0.000s) [211.658146] Subtest fbc-psr-no-drrs: SKIP (0.001s) [211.732326] [029/156] (867s left) syncobj_wait (multi-wait-for-submit-submitted-signaled) [211.778794] Starting subtest: multi-wait-for-submit-submitted-signaled [211.781086] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.001s) [211.899029] [030/156] (867s left) kms_sequence (queue-idle) [211.986916] Starting subtest: queue-idle [211.989166] Starting dynamic subtest: pipe-A-eDP-1 [213.802612] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.815s) [213.812700] Starting dynamic subtest: pipe-B-eDP-1 [216.270483] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.464s) [216.281151] Starting dynamic subtest: pipe-C-eDP-1 [218.787823] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.516s) [218.798676] Starting dynamic subtest: pipe-D-eDP-1 [221.226714] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.438s) [221.229041] Subtest queue-idle: SUCCESS (9.240s) [222.044183] [031/156] (857s left) syncobj_wait (multi-wait-signaled) [222.095637] Starting subtest: multi-wait-signaled [222.097984] Subtest multi-wait-signaled: SUCCESS (0.001s) [222.208469] [032/156] (857s left) kms_flip (2x-wf_vblank-ts-check) [222.298734] Starting subtest: 2x-wf_vblank-ts-check [222.308189] Subtest 2x-wf_vblank-ts-check: SKIP (0.011s) [222.386473] [033/156] (857s left) kms_cursor_legacy (single-move) [222.499448] Starting subtest: single-move [222.501649] Starting dynamic subtest: pipe-A [227.882641] Dynamic subtest pipe-A: SUCCESS (5.379s) [227.893024] Starting dynamic subtest: pipe-B [233.264610] Dynamic subtest pipe-B: SUCCESS (5.380s) [233.278772] Starting dynamic subtest: pipe-C [238.646312] Dynamic subtest pipe-C: SUCCESS (5.380s) [238.656969] Starting dynamic subtest: pipe-D [244.028730] Dynamic subtest pipe-D: SUCCESS (5.380s) [244.039329] Starting dynamic subtest: all-pipes [249.417287] Dynamic subtest all-pipes: SUCCESS (5.387s) [249.419723] Subtest single-move: SUCCESS (26.916s) [249.559346] [034/156] (830s left) kms_plane_alpha_blend (coverage-7efc) [249.650107] Starting subtest: coverage-7efc [249.942372] Starting dynamic subtest: pipe-A-eDP-1 [250.542592] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.597s) [250.568802] Starting dynamic subtest: pipe-D-eDP-1 [251.859054] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.297s) [251.861461] Subtest coverage-7efc: SUCCESS (2.210s) [252.707286] [035/156] (826s left) perf_pmu (busy-idle-check-all) [252.753597] Starting subtest: busy-idle-check-all [252.755479] Starting dynamic subtest: rcs0 [253.404737] Dynamic subtest rcs0: SUCCESS (0.652s) [253.417398] Starting dynamic subtest: bcs0 [254.060552] Dynamic subtest bcs0: SUCCESS (0.653s) [254.073601] Starting dynamic subtest: vcs0 [255.330735] Dynamic subtest vcs0: SUCCESS (1.266s) [255.343735] Starting dynamic subtest: vcs1 [257.313473] Dynamic subtest vcs1: SUCCESS (1.982s) [257.325793] Starting dynamic subtest: vecs0 [259.298294] Dynamic subtest vecs0: SUCCESS (1.982s) [259.312812] Starting dynamic subtest: ccs0 [259.956295] Dynamic subtest ccs0: SUCCESS (0.656s) [259.958878] Subtest busy-idle-check-all: SUCCESS (7.206s) [260.050579] [036/156] (819s left) kms_properties (crtc-properties-legacy) [260.145814] Starting subtest: crtc-properties-legacy [260.147699] Starting dynamic subtest: pipe-A-eDP-1 [260.595829] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.449s) [260.605658] Starting dynamic subtest: pipe-B-eDP-1 [261.760876] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.165s) [261.772927] Starting dynamic subtest: pipe-C-eDP-1 [262.992355] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.230s) [263.002662] Starting dynamic subtest: pipe-D-eDP-1 [264.139080] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.144s) [264.141374] Subtest crtc-properties-legacy: SUCCESS (3.992s) [264.963725] [037/156] (814s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-fullscreen) [265.068718] Starting subtest: fbc-2p-primscrn-spr-indfb-fullscreen [265.073231] Subtest fbc-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s) [265.157698] [038/156] (814s left) gem_mmap_offset (clear-via-pagefault) [265.206061] Starting subtest: clear-via-pagefault [265.207950] Starting dynamic subtest: smem0 [296.165810] Dynamic subtest smem0: SUCCESS (30.955s) [296.167819] Subtest clear-via-pagefault: SUCCESS (30.957s) [296.278974] [039/156] (783s left) gen3_render_mixed_blits [296.392915] [040/156] (783s left) fbdev (read) [296.433832] Starting subtest: read [296.969995] Subtest read: SUCCESS (0.534s) [297.047937] [041/156] (782s left) gem_spin_batch (spin-all) [297.113575] Starting subtest: spin-all [297.133616] Subtest spin-all: SUCCESS (0.020s) [298.376207] [042/156] (781s left) gem_softpin (32b-excludes-last-page) [298.443369] Starting subtest: 32b-excludes-last-page [298.449438] Subtest 32b-excludes-last-page: SUCCESS (0.006s) [298.580763] [043/156] (781s left) gem_tiled_fence_blits (basic) [298.636536] Subtest basic: SKIP (0.000s) [298.715382] [044/156] (781s left) gem_exec_reloc (basic-wc-active) [298.765589] Subtest basic-wc-active: SKIP (0.000s) [298.840612] [045/156] (781s left) gem_ctx_param (set-priority-range) [298.880462] Starting subtest: set-priority-range [298.894715] Subtest set-priority-range: SUCCESS (0.014s) [298.996876] [046/156] (781s left) kms_pm_rpm (fences) [300.536453] Starting subtest: fences [300.541808] Subtest fences: SKIP (0.000s) [301.286432] [047/156] (778s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-gtt) [301.376281] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-gtt [301.380685] Subtest fbcpsrhdr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [301.480178] [048/156] (778s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-spr-indfb-draw-mmap-cpu) [301.571852] Starting subtest: fbchdr-1p-primscrn-spr-indfb-draw-mmap-cpu [301.576179] Subtest fbchdr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [301.672705] [049/156] (778s left) gem_userptr_blits (dmabuf-unsync) [301.748737] Subtest dmabuf-unsync: SKIP (0.000s) [301.859077] [050/156] (778s left) syncobj_timeline (invalid-transfer-bad-pad) [301.906436] Starting subtest: invalid-transfer-bad-pad [301.908791] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s) [302.023477] [051/156] (778s left) kms_plane_multiple (2x-tiling-x) [302.114290] Starting subtest: 2x-tiling-x [302.118415] Subtest 2x-tiling-x: SKIP (0.000s) [302.187989] [052/156] (778s left) dumb_buffer (map-invalid-size) [302.242556] Starting subtest: map-invalid-size [302.244492] Subtest map-invalid-size: SUCCESS (0.000s) [302.339347] [053/156] (778s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-cur-indfb-onoff) [302.443760] Starting subtest: fbcpsrhdr-2p-primscrn-cur-indfb-onoff [302.447185] Subtest fbcpsrhdr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s) [302.539795] [054/156] (777s left) kms_big_fb (y-tiled-8bpp-rotate-270) [302.646090] Starting subtest: y-tiled-8bpp-rotate-270 [302.649473] Subtest y-tiled-8bpp-rotate-270: SKIP (0.000s) [302.741829] [055/156] (777s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc) [302.848535] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc [310.091218] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (7.248s) [310.206566] [056/156] (770s left) kms_frontbuffer_tracking (psr-rgb565-draw-blt) [310.312772] Starting subtest: psr-rgb565-draw-blt [317.441450] Subtest psr-rgb565-draw-blt: SUCCESS (7.132s) [317.547070] [057/156] (763s left) kms_cursor_edge_walk (64x64-left-edge) [317.635713] Starting subtest: 64x64-left-edge [317.638081] Starting dynamic subtest: pipe-A-eDP-1 [321.071800] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.435s) [321.081552] Starting dynamic subtest: pipe-D-eDP-1 [324.212601] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.138s) [324.214939] Subtest 64x64-left-edge: SUCCESS (6.577s) [325.023537] [058/156] (755s left) gem_exec_whisper (basic-fds) [325.089862] Starting subtest: basic-fds [332.289034] Subtest basic-fds: SUCCESS (7.198s) [332.471087] [059/156] (748s left) gem_mmap_gtt (big-bo) [332.535791] Subtest big-bo: SKIP (0.000s) [332.593690] [060/156] (748s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-plflip-blt) [332.706665] Starting subtest: fbc-1p-primscrn-shrfb-plflip-blt [337.297073] Subtest fbc-1p-primscrn-shrfb-plflip-blt: SUCCESS (4.596s) [338.455604] [061/156] (742s left) gem_lmem_swapping (verify-ccs) [338.494935] Subtest verify-ccs: SKIP (0.000s) [338.541723] [062/156] (742s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-indfb-draw-render) [338.647475] Starting subtest: psrhdr-1p-primscrn-pri-indfb-draw-render [338.651672] Subtest psrhdr-1p-primscrn-pri-indfb-draw-render: SKIP (0.000s) [338.740784] [063/156] (742s left) kms_frontbuffer_tracking (psrhdr-1p-rte) [338.837250] Starting subtest: psrhdr-1p-rte [338.841144] Subtest psrhdr-1p-rte: SKIP (0.000s) [338.931681] [064/156] (741s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-pri-shrfb-draw-mmap-wc) [339.027487] Starting subtest: fbchdr-2p-primscrn-pri-shrfb-draw-mmap-wc [339.031633] Subtest fbchdr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [339.131430] [065/156] (741s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-pwrite) [339.224153] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-pwrite [339.228213] Subtest fbc-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s) [339.334568] [066/156] (741s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-pri-indfb-draw-mmap-wc) [339.428780] Starting subtest: psrhdr-2p-primscrn-pri-indfb-draw-mmap-wc [339.432097] Subtest psrhdr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [339.532233] [067/156] (741s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt) [339.630104] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt [339.633483] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [339.722537] [068/156] (741s left) kms_vblank (ts-continuation-dpms-rpm) [339.815423] Starting subtest: ts-continuation-dpms-rpm [339.817241] Starting dynamic subtest: pipe-A-eDP-1 [342.311742] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.496s) [342.325813] Starting dynamic subtest: pipe-D-eDP-1 [344.562084] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.246s) [344.564384] Subtest ts-continuation-dpms-rpm: SUCCESS (4.746s) [345.441831] [069/156] (735s left) prime_mmap_coherency (read) [345.507586] Starting subtest: read [350.886822] Subtest read: SUCCESS (5.377s) [351.007370] [070/156] (730s left) perf_pmu (invalid-open) [351.047646] Starting subtest: invalid-open [351.049696] Subtest invalid-open: SUCCESS (0.000s) [351.163688] [071/156] (730s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary) [351.271755] Starting subtest: fbcpsr-indfb-scaledprimary [357.034850] Subtest fbcpsr-indfb-scaledprimary: SUCCESS (5.768s) [357.172220] [072/156] (724s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-shrfb-plflip-blt) [357.266954] Starting subtest: fbcpsrhdr-2p-primscrn-shrfb-plflip-blt [357.271065] Subtest fbcpsrhdr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s) [357.367711] [073/156] (723s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-async-flip) [357.466832] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-async-flip [357.471392] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s) [357.564572] [074/156] (723s left) gem_unref_active_buffers [357.763401] [075/156] (723s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-pri-shrfb-draw-mmap-cpu) [357.857501] Starting subtest: fbcpsrhdr-1p-primscrn-pri-shrfb-draw-mmap-cpu [357.861757] Subtest fbcpsrhdr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [357.969608] [076/156] (723s left) gem_create (hog-create) [358.016060] Starting subtest: hog-create [358.018052] Starting dynamic subtest: smem0 [391.269164] Dynamic subtest smem0: SUCCESS (33.251s) [391.272045] Subtest hog-create: SUCCESS (33.253s) [391.454915] [077/156] (690s left) kms_atomic_transition (plane-all-transition-fencing) [391.551387] Starting subtest: plane-all-transition-fencing [391.553631] Starting dynamic subtest: pipe-A-eDP-1 [394.048054] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.500s) [394.355293] Starting dynamic subtest: pipe-B-eDP-1 [397.604382] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.259s) [397.906531] Subtest plane-all-transition-fencing: SUCCESS (6.356s) [398.733921] [078/156] (682s left) sw_sync (sync_multi_consumer_producer) [398.775096] Starting subtest: sync_multi_consumer_producer [399.052045] Subtest sync_multi_consumer_producer: SUCCESS (0.275s) [399.113906] [079/156] (682s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy) [399.205418] Subtest addfb25-x-tiled-mismatch-legacy: SKIP (0.000s) [399.324561] [080/156] (682s left) prime_busy (before-wait) [399.383672] Starting subtest: before-wait [399.388164] Starting dynamic subtest: rcs0 [399.429357] Dynamic subtest rcs0: SUCCESS (0.043s) [399.440854] Starting dynamic subtest: bcs0 [399.485236] Dynamic subtest bcs0: SUCCESS (0.055s) [399.496577] Starting dynamic subtest: vcs0 [399.525623] Dynamic subtest vcs0: SUCCESS (0.040s) [399.538042] Starting dynamic subtest: vcs1 [399.565265] Dynamic subtest vcs1: SUCCESS (0.037s) [399.575489] Starting dynamic subtest: vecs0 [399.605736] Dynamic subtest vecs0: SUCCESS (0.040s) [399.614887] Starting dynamic subtest: ccs0 [399.646070] Dynamic subtest ccs0: SUCCESS (0.039s) [399.754276] Subtest before-wait: SUCCESS (0.370s) [399.827460] [081/156] (681s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy) [399.940593] Starting subtest: basic-busy-flip-before-cursor-legacy [399.944889] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s) [400.082842] [082/156] (681s left) gem_mmap_wc (bad-size) [400.136122] Subtest bad-size: SKIP (0.000s) [400.201503] [083/156] (681s left) gem_mmap_wc (copy) [400.259152] Subtest copy: SKIP (0.000s) [400.324707] [084/156] (681s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc) [400.418454] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc [400.422886] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s) [400.518707] [085/156] (681s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs) [400.613847] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs [400.616204] Starting dynamic subtest: pipe-A-eDP-1 [400.636161] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s) [400.647159] Starting dynamic subtest: pipe-B-eDP-1 [400.668687] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [400.679776] Starting dynamic subtest: pipe-C-eDP-1 [400.699863] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [400.709342] Starting dynamic subtest: pipe-D-eDP-1 [400.728455] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [400.730359] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs: SUCCESS (0.005s) [402.884515] [086/156] (678s left) kms_plane (pixel-format-y-tiled-ccs-modifier) [402.979260] Starting subtest: pixel-format-y-tiled-ccs-modifier [402.983302] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.000s) [403.052455] [087/156] (678s left) api_intel_allocator (simple-allocator) [403.095931] Starting subtest: simple-allocator [403.098306] Starting dynamic subtest: basic [403.100623] Dynamic subtest basic: SUCCESS (0.003s) [403.111979] Starting dynamic subtest: parallel-one [403.276093] Dynamic subtest parallel-one: SUCCESS (0.176s) [403.286784] Starting dynamic subtest: print [403.288979] Dynamic subtest print: SUCCESS (0.000s) [403.300734] Starting dynamic subtest: reuse [403.302631] Dynamic subtest reuse: SUCCESS (0.000s) [403.311692] Starting dynamic subtest: reserve [403.313594] Dynamic subtest reserve: SUCCESS (0.000s) [403.322663] Starting dynamic subtest: fork-reopen-allocator [403.324594] Dynamic subtest fork-reopen-allocator: SUCCESS (0.011s) [403.326497] Subtest simple-allocator: SUCCESS (0.198s) [403.409718] [088/156] (678s left) i915_selftest (live) [406.712093] Starting subtest: live [406.714805] Starting dynamic subtest: sanitycheck [411.178969] Dynamic subtest sanitycheck: SUCCESS (4.461s) [411.189325] Starting dynamic subtest: uncore [415.545345] Dynamic subtest uncore: SUCCESS (4.370s) [415.555627] Starting dynamic subtest: workarounds [418.694098] Dynamic subtest workarounds: SUCCESS (3.146s) [418.702639] Starting dynamic subtest: gt_engines [421.814900] Dynamic subtest gt_engines: SUCCESS (3.120s) [421.825405] Starting dynamic subtest: gt_timelines [438.002304] Dynamic subtest gt_timelines: SUCCESS (16.185s) [438.019154] Starting dynamic subtest: gt_contexts [442.330072] Dynamic subtest gt_contexts: SUCCESS (4.326s) [442.337983] Starting dynamic subtest: gt_lrc [448.436482] Dynamic subtest gt_lrc: SUCCESS (6.104s) [448.446837] Starting dynamic subtest: gt_mocs [451.423882] Dynamic subtest gt_mocs: SUCCESS (2.985s) [451.434567] Starting dynamic subtest: gt_pm [458.199403] Dynamic subtest gt_pm: SUCCESS (6.773s) [458.209151] Starting dynamic subtest: gt_heartbeat [462.577484] Dynamic subtest gt_heartbeat: SUCCESS (4.377s) [462.589600] Starting dynamic subtest: gt_tlb [471.902508] Dynamic subtest gt_tlb: SUCCESS (9.323s) [471.912204] Starting dynamic subtest: requests [483.360737] Dynamic subtest requests: SUCCESS (11.456s) [483.371696] Starting dynamic subtest: migrate [489.097990] Dynamic subtest migrate: SUCCESS (5.734s) [489.106986] Starting dynamic subtest: active [491.872373] Dynamic subtest active: SUCCESS (2.772s) [491.882528] Starting dynamic subtest: objects [496.609432] Dynamic subtest objects: SUCCESS (4.735s) [496.619861] Starting dynamic subtest: mman [501.446632] Dynamic subtest mman: SUCCESS (4.836s) [501.454690] Starting dynamic subtest: dmabuf [505.866632] Dynamic subtest dmabuf: SUCCESS (4.417s) [505.877076] Starting dynamic subtest: vma [510.263070] Dynamic subtest vma: SUCCESS (4.395s) [510.272058] Starting dynamic subtest: coherency [515.304344] Dynamic subtest coherency: SUCCESS (5.039s) [515.318612] Starting dynamic subtest: gtt [525.240357] Dynamic subtest gtt: SUCCESS (9.933s) [525.250625] Starting dynamic subtest: gem [533.039231] Dynamic subtest gem: SUCCESS (7.798s) [533.049732] Starting dynamic subtest: evict [538.583278] Dynamic subtest evict: SUCCESS (5.542s) [538.599507] Starting dynamic subtest: hugepages [547.473733] Dynamic subtest hugepages: SUCCESS (8.887s) [547.483553] Starting dynamic subtest: gem_contexts [575.848725] Dynamic subtest gem_contexts: SUCCESS (28.369s) [575.859175] Starting dynamic subtest: client [580.212351] Dynamic subtest client: SUCCESS (4.362s) [580.222875] Starting dynamic subtest: gem_migrate [584.503958] Dynamic subtest gem_migrate: SUCCESS (4.289s) [584.520044] Starting dynamic subtest: reset [587.277514] Dynamic subtest reset: SUCCESS (2.772s) [587.287896] Starting dynamic subtest: memory_region [591.659047] Dynamic subtest memory_region: SUCCESS (4.379s) [591.669645] Starting dynamic subtest: hangcheck [604.594465] Dynamic subtest hangcheck: SUCCESS (12.933s) [604.604825] Starting dynamic subtest: execlists [608.915286] Dynamic subtest execlists: SUCCESS (4.319s) [608.925718] Starting dynamic subtest: ring_submission [613.312680] Dynamic subtest ring_submission: SUCCESS (4.396s) [613.321173] Starting dynamic subtest: perf [617.707595] Dynamic subtest perf: SUCCESS (4.392s) [617.717967] Starting dynamic subtest: slpc [631.768943] Dynamic subtest slpc: SUCCESS (14.059s) [631.779648] Starting dynamic subtest: guc [635.751439] Dynamic subtest guc: SUCCESS (3.981s) [635.761697] Starting dynamic subtest: guc_multi_lrc [640.104035] Dynamic subtest guc_multi_lrc: SUCCESS (4.350s) [640.114395] Starting dynamic subtest: guc_hang [644.978757] Dynamic subtest guc_hang: SUCCESS (4.873s) [644.989430] Starting dynamic subtest: late_gt_pm [647.743518] Dynamic subtest late_gt_pm: SUCCESS (2.763s) [647.746036] Subtest live: SUCCESS (241.020s) [647.772251] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [647.772917] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true [647.775666] [089/156] (434s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic) [649.365794] Starting subtest: 2x-long-flip-vs-cursor-atomic [649.370264] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.001s) [649.551526] [FACT kms_cursor_legacy (2x-long-flip-vs-cursor-atomic)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [649.552714] [FACT kms_cursor_legacy (2x-long-flip-vs-cursor-atomic)] new: kernel.kmod_is_loaded.i915: true [649.557526] [090/156] (432s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render) [649.653376] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render [649.657779] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s) [649.748662] [091/156] (432s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip) [649.848373] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip [649.852436] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s) [649.949385] [092/156] (432s left) kms_ccs (crc-sprite-planes-basic-4-tiled-lnl-ccs) [650.036951] Starting subtest: crc-sprite-planes-basic-4-tiled-lnl-ccs [650.041247] Subtest crc-sprite-planes-basic-4-tiled-lnl-ccs: SKIP (0.000s) [651.481110] [093/156] (430s left) kms_frontbuffer_tracking (hdr-1p-primscrn-spr-indfb-onoff) [651.593350] Starting subtest: hdr-1p-primscrn-spr-indfb-onoff [651.597645] Subtest hdr-1p-primscrn-spr-indfb-onoff: SKIP (0.000s) [651.690905] [094/156] (430s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb565-draw-blt) [651.778311] Starting subtest: fbcpsrhdr-rgb565-draw-blt [651.782661] Subtest fbcpsrhdr-rgb565-draw-blt: SKIP (0.000s) [651.877928] [095/156] (430s left) gen7_exec_parse (basic-offset) [651.943711] Subtest basic-offset: SKIP (0.000s) [652.025137] [096/156] (430s left) gem_exec_reloc (basic-gtt-noreloc) [652.082375] Subtest basic-gtt-noreloc: SKIP (0.000s) [652.144384] [097/156] (430s left) gem_exec_endless (dispatch) [652.218912] Starting subtest: dispatch [652.221528] Starting dynamic subtest: rcs0 [652.230888] Dynamic subtest rcs0: SUCCESS (0.011s) [652.242907] Starting dynamic subtest: bcs0 [652.247383] Dynamic subtest bcs0: SUCCESS (0.005s) [652.256756] Starting dynamic subtest: vcs0 [652.261238] Dynamic subtest vcs0: SUCCESS (0.004s) [652.270803] Starting dynamic subtest: vcs1 [652.275205] Dynamic subtest vcs1: SUCCESS (0.004s) [652.284244] Starting dynamic subtest: vecs0 [652.288655] Dynamic subtest vecs0: SUCCESS (0.004s) [652.297533] Starting dynamic subtest: ccs0 [652.301955] Dynamic subtest ccs0: SUCCESS (0.004s) [652.304112] Subtest dispatch: SUCCESS (0.037s) [653.323326] [098/156] (428s left) kms_plane_scaling (planes-upscale-20x20-downscale-factor-0-75) [653.409112] Starting subtest: planes-upscale-20x20-downscale-factor-0-75 [653.411431] Starting dynamic subtest: pipe-A [653.433733] Dynamic subtest pipe-A: SKIP (0.020s) [653.443250] Starting dynamic subtest: pipe-B [653.477082] Dynamic subtest pipe-B: SKIP (0.042s) [653.486319] Starting dynamic subtest: pipe-C [653.512281] Dynamic subtest pipe-C: SKIP (0.037s) [653.521491] Starting dynamic subtest: pipe-D [653.553045] Dynamic subtest pipe-D: SKIP (0.038s) [653.557278] Subtest planes-upscale-20x20-downscale-factor-0-75: SKIP (0.140s) [653.643990] [099/156] (428s left) kms_chamelium_edid (dp-edid-change-during-suspend) [654.023391] Subtest dp-edid-change-during-suspend: SKIP (0.000s) [654.892443] [100/156] (427s left) kms_big_fb (x-tiled-64bpp-rotate-90) [654.994113] Starting subtest: x-tiled-64bpp-rotate-90 [655.016636] Subtest x-tiled-64bpp-rotate-90: SKIP (0.022s) [655.133333] [101/156] (427s left) syncobj_timeline (single-wait-for-submit-available-submitted) [655.189763] Starting subtest: single-wait-for-submit-available-submitted [655.192058] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.000s) [655.296767] [102/156] (427s left) gem_mmap_gtt (big-copy-odd) [655.349162] Subtest big-copy-odd: SKIP (0.000s) [655.405818] [103/156] (427s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs) [655.497120] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs [655.499396] Starting dynamic subtest: pipe-A-eDP-1 [655.522229] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [655.533978] Starting dynamic subtest: pipe-B-eDP-1 [655.555680] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [655.565030] Starting dynamic subtest: pipe-C-eDP-1 [655.586654] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [655.595444] Starting dynamic subtest: pipe-D-eDP-1 [655.617252] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [655.621220] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs: SKIP (0.004s) [657.769274] [104/156] (424s left) kms_draw_crc (draw-method-mmap-gtt) [657.862998] Starting subtest: draw-method-mmap-gtt [657.867387] Subtest draw-method-mmap-gtt: SKIP (0.000s) [657.944705] [105/156] (424s left) perf (missing-sample-flags) [658.064823] Starting subtest: missing-sample-flags [658.066688] Subtest missing-sample-flags: SUCCESS (0.000s) [658.111171] [106/156] (424s left) kms_rotation_crc (primary-yf-tiled-reflect-x-0) [658.195430] Starting subtest: primary-yf-tiled-reflect-x-0 [658.268206] Subtest primary-yf-tiled-reflect-x-0: SKIP (0.071s) [658.384613] [107/156] (424s left) kms_cursor_legacy (basic-flip-after-cursor-atomic) [658.502930] Starting subtest: basic-flip-after-cursor-atomic [659.452419] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.950s) [660.299317] [108/156] (422s left) i915_hangman (engine-engine-error) [660.366933] Starting subtest: engine-engine-error [660.369075] Starting dynamic subtest: rcs0 [662.275057] Dynamic subtest rcs0: SUCCESS (1.908s) [662.287572] Starting dynamic subtest: bcs0 [664.320743] Dynamic subtest bcs0: SUCCESS (2.043s) [664.333295] Starting dynamic subtest: vcs0 [666.305717] Dynamic subtest vcs0: SUCCESS (1.981s) [666.319755] Starting dynamic subtest: vcs1 [668.290579] Dynamic subtest vcs1: SUCCESS (1.981s) [668.303967] Starting dynamic subtest: vecs0 [670.272966] Dynamic subtest vecs0: SUCCESS (1.980s) [670.286551] Starting dynamic subtest: ccs0 [672.321035] Dynamic subtest ccs0: SUCCESS (2.046s) [672.324063] Subtest engine-engine-error: SUCCESS (11.955s) [672.407669] [109/156] (410s left) syncobj_wait (multi-wait-all-submitted-signaled) [672.461576] Starting subtest: multi-wait-all-submitted-signaled [672.566349] Subtest multi-wait-all-submitted-signaled: SUCCESS (0.102s) [672.663626] [110/156] (410s left) kms_frontbuffer_tracking (fbchdr-rgb565-draw-render) [672.763709] Starting subtest: fbchdr-rgb565-draw-render [672.767800] Subtest fbchdr-rgb565-draw-render: SKIP (0.000s) [672.863738] [111/156] (410s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu) [672.974948] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu [679.584755] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.615s) [679.689758] [112/156] (403s left) kms_cursor_legacy (cursorb-vs-flipa-varying-size) [679.809502] Starting subtest: cursorB-vs-flipA-varying-size [679.814024] Subtest cursorB-vs-flipA-varying-size: SKIP (0.001s) [679.954799] [113/156] (402s left) kms_psr (fbc-psr2-cursor-blt) [680.051438] Starting subtest: fbc-psr2-cursor-blt [680.053458] Starting dynamic subtest: eDP-1 [680.057611] Dynamic subtest eDP-1: SKIP (0.000s) [680.061659] Subtest fbc-psr2-cursor-blt: SKIP (0.001s) [680.126131] [114/156] (402s left) kms_cdclk (mode-transition) [680.228071] Starting subtest: mode-transition [680.230218] Starting dynamic subtest: pipe-A-eDP-1 [680.522583] Dynamic subtest pipe-A-eDP-1: SKIP (0.292s) [680.536755] Starting dynamic subtest: pipe-B-eDP-1 [680.541237] Dynamic subtest pipe-B-eDP-1: SKIP (0.002s) [680.551048] Starting dynamic subtest: pipe-C-eDP-1 [680.555654] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s) [680.565994] Starting dynamic subtest: pipe-D-eDP-1 [680.570089] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s) [680.574034] Subtest mode-transition: SKIP (0.300s) [681.360045] [115/156] (401s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-spr-indfb-onoff) [681.461645] Starting subtest: hdr-2p-scndscrn-spr-indfb-onoff [681.465813] Subtest hdr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s) [681.559458] [116/156] (401s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-spr-indfb-onoff) [681.651875] Starting subtest: fbchdr-2p-scndscrn-spr-indfb-onoff [681.656177] Subtest fbchdr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s) [681.750951] [117/156] (401s left) kms_frontbuffer_tracking (fbcpsr-2p-rte) [681.852752] Starting subtest: fbcpsr-2p-rte [681.857255] Subtest fbcpsr-2p-rte: SKIP (0.000s) [681.955277] [118/156] (401s left) gem_exec_schedule (thriceslice) [682.022229] Starting subtest: thriceslice [682.024079] Starting dynamic subtest: rcs0 [682.043339] Dynamic subtest rcs0: SUCCESS (0.030s) [682.053672] Starting dynamic subtest: bcs0 [682.072163] Dynamic subtest bcs0: SUCCESS (0.028s) [682.081552] Starting dynamic subtest: vcs0 [682.122800] Dynamic subtest vcs0: SUCCESS (0.049s) [682.134912] Starting dynamic subtest: vcs1 [682.153739] Dynamic subtest vcs1: SUCCESS (0.029s) [682.163524] Starting dynamic subtest: vecs0 [682.183160] Dynamic subtest vecs0: SUCCESS (0.029s) [682.192449] Starting dynamic subtest: ccs0 [682.235849] Dynamic subtest ccs0: SUCCESS (0.050s) [682.238617] Subtest thriceslice: SUCCESS (0.224s) [682.540797] [119/156] (400s left) kms_chamelium_hpd (hdmi-hpd-fast) [682.935010] Subtest hdmi-hpd-fast: SKIP (0.000s) [683.786054] [120/156] (399s left) kms_rotation_crc (primary-rotation-180) [683.874218] Starting subtest: primary-rotation-180 [690.905367] Subtest primary-rotation-180: SUCCESS (7.031s) [692.082911] [121/156] (391s left) kms_getfb (getfb2-handle-protection) [692.175091] Starting subtest: getfb2-handle-protection [692.193406] Subtest getfb2-handle-protection: SUCCESS (0.019s) [692.355382] [122/156] (390s left) kms_content_protection (atomic-hdcp14) [692.488882] Starting subtest: atomic-hdcp14 [692.493544] Subtest atomic-hdcp14: SKIP (0.000s) [692.605598] [123/156] (390s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-pgflip-blt) [692.709318] Starting subtest: psr-2p-primscrn-indfb-pgflip-blt [692.713559] Subtest psr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s) [692.816831] [124/156] (390s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-cur-indfb-draw-render) [692.915436] Starting subtest: hdr-2p-scndscrn-cur-indfb-draw-render [692.919768] Subtest hdr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s) [693.007829] [125/156] (390s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-render) [693.121422] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-render [700.394847] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-render: SUCCESS (7.281s) [700.551395] [126/156] (382s left) gem_softpin (evict-active-interruptible) [700.608463] Starting subtest: evict-active-interruptible [700.614775] Subtest evict-active-interruptible: SUCCESS (0.006s) [700.722418] [127/156] (382s left) kms_frontbuffer_tracking (hdr-1p-primscrn-pri-indfb-draw-mmap-cpu) [700.819274] Starting subtest: hdr-1p-primscrn-pri-indfb-draw-mmap-cpu [700.823781] Subtest hdr-1p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s) [700.910969] [128/156] (382s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-signaled) [700.955903] Starting subtest: multi-wait-all-for-submit-unsubmitted-signaled [701.062027] Subtest multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.105s) [701.146616] [129/156] (382s left) syncobj_timeline (multi-wait-submitted-signaled) [701.202366] Starting subtest: multi-wait-submitted-signaled [701.204754] Subtest multi-wait-submitted-signaled: SUCCESS (0.001s) [701.307797] [130/156] (382s left) core_auth (getclient-simple) [701.342193] Starting subtest: getclient-simple [701.356080] Subtest getclient-simple: SUCCESS (0.018s) [701.469026] [131/156] (382s left) gem_lmem_evict (dontneed-evict-race) [701.506610] Subtest dontneed-evict-race: SKIP (0.000s) [701.549900] [132/156] (382s left) kms_flip (flip-vs-dpms-on-nop-interruptible) [701.644970] Starting subtest: flip-vs-dpms-on-nop-interruptible [701.647377] Starting dynamic subtest: A-eDP1 [703.492796] Dynamic subtest A-eDP1: SUCCESS (1.846s) [703.507090] Starting dynamic subtest: B-eDP1 [705.318063] Dynamic subtest B-eDP1: SUCCESS (1.823s) [705.332837] Starting dynamic subtest: C-eDP1 [707.136945] Dynamic subtest C-eDP1: SUCCESS (1.816s) [707.147218] Starting dynamic subtest: D-eDP1 [708.973469] Dynamic subtest D-eDP1: SUCCESS (1.835s) [708.978582] Subtest flip-vs-dpms-on-nop-interruptible: SUCCESS (7.333s) [710.154853] [133/156] (373s left) kms_prop_blob (invalid-get-prop) [710.203690] Starting subtest: invalid-get-prop [710.206086] Subtest invalid-get-prop: SUCCESS (0.000s) [710.308060] [134/156] (373s left) gem_ctx_persistence (heartbeat-many) [710.364421] Starting subtest: heartbeat-many [710.368877] Subtest heartbeat-many: SKIP (0.000s) [710.464646] [135/156] (373s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs-cc) [710.557731] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs-cc [710.559896] Starting dynamic subtest: pipe-A-eDP-1 [710.568545] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [710.579894] Starting dynamic subtest: pipe-B-eDP-1 [710.588630] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [710.598913] Starting dynamic subtest: pipe-C-eDP-1 [710.607342] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [710.616712] Starting dynamic subtest: pipe-D-eDP-1 [710.624724] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [710.628645] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs-cc: SKIP (0.005s) [712.819977] [136/156] (371s left) gem_exec_flush (basic-uc-pro-default) [712.876068] Starting subtest: basic-uc-pro-default [718.335510] Subtest basic-uc-pro-default: SUCCESS (5.459s) [718.527679] [137/156] (365s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted) [718.581720] Starting subtest: invalid-multi-wait-all-unsubmitted [718.583960] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s) [718.681577] [138/156] (365s left) kms_psr (psr-sprite-plane-move) [718.770976] Starting subtest: psr-sprite-plane-move [718.773124] Starting dynamic subtest: eDP-1 [720.540899] Dynamic subtest eDP-1: SUCCESS (1.769s) [720.543372] Subtest psr-sprite-plane-move: SUCCESS (1.770s) [721.387619] [139/156] (362s left) syncobj_basic (test-valid-cycle) [721.444715] Starting subtest: test-valid-cycle [721.446950] Subtest test-valid-cycle: SUCCESS (0.000s) [721.572924] [140/156] (362s left) i915_drm_fdinfo (memory-info-resident) [721.609368] Starting subtest: memory-info-resident [721.611804] Starting dynamic subtest: smem0 [724.261354] Dynamic subtest smem0: SUCCESS (2.655s) [724.263913] Subtest memory-info-resident: SUCCESS (2.656s) [724.356075] [141/156] (359s left) kms_frontbuffer_tracking (psrhdr-1p-offscreen-pri-indfb-draw-blt) [724.461569] Starting subtest: psrhdr-1p-offscreen-pri-indfb-draw-blt [724.465169] Subtest psrhdr-1p-offscreen-pri-indfb-draw-blt: SKIP (0.000s) [724.545834] [142/156] (359s left) syncobj_wait (wait-all-delayed-signal) [724.613637] Starting subtest: wait-all-delayed-signal [724.715836] Subtest wait-all-delayed-signal: SUCCESS (0.103s) [724.794870] [143/156] (359s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-signa [724.857822] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-signaled [724.965920] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-signaled: SUCCESS (0.106s) [725.059624] [144/156] (359s left) kms_invalid_mode (bad-vtotal) [725.161068] Starting subtest: bad-vtotal [725.163368] Starting dynamic subtest: pipe-A-eDP-1 [725.444138] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.286s) [725.454429] Starting dynamic subtest: pipe-B-eDP-1 [725.456315] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [725.465421] Starting dynamic subtest: pipe-C-eDP-1 [725.467750] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [725.477278] Starting dynamic subtest: pipe-D-eDP-1 [725.479150] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [725.481033] Subtest bad-vtotal: SUCCESS (0.292s) [726.320321] [145/156] (358s left) kms_psr (psr-no-drrs) [726.406596] Starting subtest: psr-no-drrs [726.408751] Starting dynamic subtest: eDP-1 [727.997786] Dynamic subtest eDP-1: SUCCESS (1.590s) [728.000069] Subtest psr-no-drrs: SUCCESS (1.591s) [728.881353] [146/156] (355s left) gem_ctx_persistence (engines-queued) [728.931652] Starting subtest: engines-queued [728.933491] Starting dynamic subtest: rcs0 [728.989726] Dynamic subtest rcs0: SUCCESS (0.060s) [729.000762] Starting dynamic subtest: bcs0 [729.030611] Dynamic subtest bcs0: SUCCESS (0.039s) [729.041811] Starting dynamic subtest: vcs0 [730.305462] Dynamic subtest vcs0: SUCCESS (1.271s) [730.318947] Starting dynamic subtest: vcs1 [732.289316] Dynamic subtest vcs1: SUCCESS (1.980s) [732.303067] Starting dynamic subtest: vecs0 [734.272789] Dynamic subtest vecs0: SUCCESS (1.981s) [734.287382] Starting dynamic subtest: ccs0 [734.454577] Dynamic subtest ccs0: SUCCESS (0.181s) [734.457048] Subtest engines-queued: SUCCESS (5.525s) [734.567135] [147/156] (349s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-cur-indfb-draw-blt) [734.666330] Starting subtest: fbchdr-2p-scndscrn-cur-indfb-draw-blt [734.670293] Subtest fbchdr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s) [734.760207] [148/156] (349s left) i915_pm_rps (min-max-config-idle) [734.812303] Starting subtest: min-max-config-idle [734.816836] Subtest min-max-config-idle: SKIP (0.001s) [734.921296] [149/156] (349s left) kms_flip (2x-flip-vs-rmfb-interruptible) [735.004442] Starting subtest: 2x-flip-vs-rmfb-interruptible [735.015682] Subtest 2x-flip-vs-rmfb-interruptible: SKIP (0.010s) [735.108134] [150/156] (349s left) kms_big_fb (4-tiled-addfb-size-offset-overflow) [735.204098] Starting subtest: 4-tiled-addfb-size-offset-overflow [735.206350] Subtest 4-tiled-addfb-size-offset-overflow: SUCCESS (0.000s) [735.305677] [151/156] (349s left) kms_plane (plane-position-hole-dpms) [735.392976] Starting subtest: plane-position-hole-dpms [735.930142] Starting dynamic subtest: pipe-A-plane-1 [738.400447] Dynamic subtest pipe-A-plane-1: SUCCESS (2.473s) [738.412898] Starting dynamic subtest: pipe-A-plane-2 [740.871073] Dynamic subtest pipe-A-plane-2: SUCCESS (2.467s) [740.882082] Starting dynamic subtest: pipe-A-plane-3 [743.313193] Dynamic subtest pipe-A-plane-3: SUCCESS (2.441s) [743.324728] Starting dynamic subtest: pipe-A-plane-4 [745.694343] Dynamic subtest pipe-A-plane-4: SUCCESS (2.384s) [745.705849] Starting dynamic subtest: pipe-A-plane-5 [745.725665] Dynamic subtest pipe-A-plane-5: SUCCESS (0.029s) [746.886165] Starting dynamic subtest: pipe-B-plane-1 [749.341069] Dynamic subtest pipe-B-plane-1: SUCCESS (2.468s) [749.352110] Starting dynamic subtest: pipe-B-plane-2 [751.779695] Dynamic subtest pipe-B-plane-2: SUCCESS (2.437s) [751.789867] Starting dynamic subtest: pipe-B-plane-3 [754.139644] Dynamic subtest pipe-B-plane-3: SUCCESS (2.361s) [754.151329] Starting dynamic subtest: pipe-B-plane-4 [756.511787] Dynamic subtest pipe-B-plane-4: SUCCESS (2.370s) [756.522224] Starting dynamic subtest: pipe-B-plane-5 [756.539112] Dynamic subtest pipe-B-plane-5: SUCCESS (0.026s) [756.541439] Subtest plane-position-hole-dpms: SUCCESS (21.146s) [757.320241] [152/156] (327s left) kms_frontbuffer_tracking (hdr-2p-primscrn-spr-indfb-move) [757.418605] Starting subtest: hdr-2p-primscrn-spr-indfb-move [757.423062] Subtest hdr-2p-primscrn-spr-indfb-move: SKIP (0.000s) [757.523110] [153/156] (327s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc) [757.624812] Starting subtest: psrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc [757.628955] Subtest psrhdr-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [757.727162] [154/156] (327s left) gen9_exec_parse (bb-chained) [757.792225] Subtest bb-chained: SKIP (0.000s) [757.853365] [155/156] (326s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-downscaling) [757.934845] Starting subtest: flip-64bpp-linear-to-32bpp-linear-downscaling [757.937116] Starting dynamic subtest: pipe-A-default-mode [759.084151] Dynamic subtest pipe-A-default-mode: SKIP (1.146s) [759.089028] Subtest flip-64bpp-linear-to-32bpp-linear-downscaling: SKIP (1.148s) [759.233473] [156/156] (325s left) gem_flink_basic (basic) [759.287823] Starting subtest: basic [759.290055] Subtest basic: SUCCESS (0.000s) [759.396622] Closing watchdogs results: parsing output: 0/ for test: kms_lease results: parsing output: 1/ for test: gem_exec_schedule results: parsing output: 2/ for test: gem_exec_async results: parsing output: 3/ for test: kms_flip results: parsing output: 4/ for test: kms_cursor_crc results: parsing output: 5/ for test: kms_cursor_crc results: parsing output: 6/ for test: kms_frontbuffer_tracking results: parsing output: 7/ for test: kms_frontbuffer_tracking results: parsing output: 8/ for test: kms_frontbuffer_tracking results: parsing output: 9/ for test: kms_big_fb results: parsing output: 10/ for test: gem_mmap_wc results: parsing output: 11/ for test: kms_big_fb results: parsing output: 12/ for test: kms_psr2_sf results: parsing output: 13/ for test: kms_psr2_sf results: parsing output: 14/ for test: kms_frontbuffer_tracking results: parsing output: 15/ for test: gem_exec_fence results: parsing output: 16/ for test: kms_frontbuffer_tracking results: parsing output: 17/ for test: kms_color_pipeline results: parsing output: 18/ for test: syncobj_timeline results: parsing output: 19/ for test: kms_psr2_sf results: parsing output: 20/ for test: prime_mmap results: parsing output: 21/ for test: gem_pxp results: parsing output: 22/ for test: kms_atomic results: parsing output: 23/ for test: kms_psr results: parsing output: 24/ for test: gem_exec_schedule results: parsing output: 25/ for test: gem_partial_pwrite_pread results: parsing output: 26/ for test: gem_exec_balancer results: parsing output: 27/ for test: kms_psr results: parsing output: 28/ for test: syncobj_wait results: parsing output: 29/ for test: kms_sequence results: parsing output: 30/ for test: syncobj_wait results: parsing output: 31/ for test: kms_flip results: parsing output: 32/ for test: kms_cursor_legacy results: parsing output: 33/ for test: kms_plane_alpha_blend results: parsing output: 34/ for test: perf_pmu results: parsing output: 35/ for test: kms_properties results: parsing output: 36/ for test: kms_frontbuffer_tracking results: parsing output: 37/ for test: gem_mmap_offset results: parsing output: 38/ for test: gen3_render_mixed_blits results: parsing output: 39/ for test: fbdev results: parsing output: 40/ for test: gem_spin_batch results: parsing output: 41/ for test: gem_softpin results: parsing output: 42/ for test: gem_tiled_fence_blits results: parsing output: 43/ for test: gem_exec_reloc results: parsing output: 44/ for test: gem_ctx_param results: parsing output: 45/ for test: kms_pm_rpm results: parsing output: 46/ for test: kms_frontbuffer_tracking results: parsing output: 47/ for test: kms_frontbuffer_tracking results: parsing output: 48/ for test: gem_userptr_blits results: parsing output: 49/ for test: syncobj_timeline results: parsing output: 50/ for test: kms_plane_multiple results: parsing output: 51/ for test: dumb_buffer results: parsing output: 52/ for test: kms_frontbuffer_tracking results: parsing output: 53/ for test: kms_big_fb results: parsing output: 54/ for test: kms_frontbuffer_tracking results: parsing output: 55/ for test: kms_frontbuffer_tracking results: parsing output: 56/ for test: kms_cursor_edge_walk results: parsing output: 57/ for test: gem_exec_whisper results: parsing output: 58/ for test: gem_mmap_gtt results: parsing output: 59/ for test: kms_frontbuffer_tracking results: parsing output: 60/ for test: gem_lmem_swapping results: parsing output: 61/ for test: kms_frontbuffer_tracking results: parsing output: 62/ for test: kms_frontbuffer_tracking results: parsing output: 63/ for test: kms_frontbuffer_tracking results: parsing output: 64/ for test: kms_frontbuffer_tracking results: parsing output: 65/ for test: kms_frontbuffer_tracking results: parsing output: 66/ for test: kms_frontbuffer_tracking results: parsing output: 67/ for test: kms_vblank results: parsing output: 68/ for test: prime_mmap_coherency results: parsing output: 69/ for test: perf_pmu 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_big_fb results: parsing output: 73/ for test: gem_unref_active_buffers results: parsing output: 74/ for test: kms_frontbuffer_tracking results: parsing output: 75/ for test: gem_create results: parsing output: 76/ for test: kms_atomic_transition results: parsing output: 77/ for test: sw_sync results: parsing output: 78/ for test: kms_addfb_basic results: parsing output: 79/ for test: prime_busy results: parsing output: 80/ for test: kms_cursor_legacy results: parsing output: 81/ for test: gem_mmap_wc results: parsing output: 82/ for test: gem_mmap_wc results: parsing output: 83/ for test: kms_frontbuffer_tracking results: parsing output: 84/ for test: kms_ccs results: parsing output: 85/ for test: kms_plane results: parsing output: 86/ for test: api_intel_allocator results: parsing output: 87/ for test: i915_selftest results: parsing output: 88/ for test: kms_cursor_legacy results: parsing output: 89/ for test: kms_frontbuffer_tracking results: parsing output: 90/ for test: kms_big_fb results: parsing output: 91/ for test: kms_ccs results: parsing output: 92/ for test: kms_frontbuffer_tracking results: parsing output: 93/ for test: kms_frontbuffer_tracking results: parsing output: 94/ for test: gen7_exec_parse results: parsing output: 95/ for test: gem_exec_reloc results: parsing output: 96/ for test: gem_exec_endless results: parsing output: 97/ for test: kms_plane_scaling results: parsing output: 98/ for test: kms_chamelium_edid results: parsing output: 99/ for test: kms_big_fb results: parsing output: 100/ for test: syncobj_timeline results: parsing output: 101/ for test: gem_mmap_gtt results: parsing output: 102/ for test: kms_ccs results: parsing output: 103/ for test: kms_draw_crc results: parsing output: 104/ for test: perf results: parsing output: 105/ for test: kms_rotation_crc results: parsing output: 106/ for test: kms_cursor_legacy results: parsing output: 107/ for test: i915_hangman results: parsing output: 108/ for test: syncobj_wait results: parsing output: 109/ for test: kms_frontbuffer_tracking results: parsing output: 110/ for test: kms_frontbuffer_tracking results: parsing output: 111/ for test: kms_cursor_legacy results: parsing output: 112/ for test: kms_psr results: parsing output: 113/ for test: kms_cdclk results: parsing output: 114/ for test: kms_frontbuffer_tracking results: parsing output: 115/ for test: kms_frontbuffer_tracking results: parsing output: 116/ for test: kms_frontbuffer_tracking results: parsing output: 117/ for test: gem_exec_schedule results: parsing output: 118/ for test: kms_chamelium_hpd results: parsing output: 119/ for test: kms_rotation_crc results: parsing output: 120/ for test: kms_getfb results: parsing output: 121/ for test: kms_content_protection results: parsing output: 122/ for test: kms_frontbuffer_tracking results: parsing output: 123/ for test: kms_frontbuffer_tracking results: parsing output: 124/ for test: kms_frontbuffer_tracking results: parsing output: 125/ for test: gem_softpin results: parsing output: 126/ for test: kms_frontbuffer_tracking results: parsing output: 127/ for test: syncobj_wait results: parsing output: 128/ for test: syncobj_timeline results: parsing output: 129/ for test: core_auth results: parsing output: 130/ for test: gem_lmem_evict results: parsing output: 131/ for test: kms_flip results: parsing output: 132/ for test: kms_prop_blob results: parsing output: 133/ for test: gem_ctx_persistence results: parsing output: 134/ for test: kms_ccs results: parsing output: 135/ for test: gem_exec_flush results: parsing output: 136/ for test: syncobj_timeline results: parsing output: 137/ for test: kms_psr results: parsing output: 138/ for test: syncobj_basic results: parsing output: 139/ for test: i915_drm_fdinfo results: parsing output: 140/ for test: kms_frontbuffer_tracking results: parsing output: 141/ for test: syncobj_wait results: parsing output: 142/ for test: syncobj_timeline results: parsing output: 143/ for test: kms_invalid_mode results: parsing output: 144/ for test: kms_psr results: parsing output: 145/ for test: gem_ctx_persistence results: parsing output: 146/ for test: kms_frontbuffer_tracking results: parsing output: 147/ for test: i915_pm_rps results: parsing output: 148/ for test: kms_flip results: parsing output: 149/ for test: kms_big_fb results: parsing output: 150/ for test: kms_plane results: parsing output: 151/ for test: kms_frontbuffer_tracking results: parsing output: 152/ for test: kms_frontbuffer_tracking results: parsing output: 153/ for test: gen9_exec_parse results: parsing output: 154/ for test: kms_flip_scaled_crc results: parsing output: 155/ for test: gem_flink_basic Done.