[55.689138] Initializing watchdogs
[55.689183]   /dev/watchdog0
[55.703340] [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]
[55.707792] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[55.709991] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[55.713385] [001/133] (960s left) gem_pxp (create-regular-buffer)
[55.866220] Starting subtest: create-regular-buffer
[55.868675] Subtest create-regular-buffer: SUCCESS (0.000s)
[55.988473] [002/133] (960s left) kms_pm_rpm (basic-pci-d3-state)
[57.559194] Starting subtest: basic-pci-d3-state
[59.057612] Subtest basic-pci-d3-state: SUCCESS (1.499s)
[59.155722] [003/133] (957s left) gem_wait (wait)
[59.241819] Starting subtest: wait
[59.244117] Starting dynamic subtest: all-engines
[61.308834] Dynamic subtest all-engines: SUCCESS (2.067s)
[61.319189] Starting dynamic subtest: rcs0
[62.353329] Dynamic subtest rcs0: SUCCESS (1.045s)
[62.361754] Starting dynamic subtest: bcs0
[63.399223] Dynamic subtest bcs0: SUCCESS (1.045s)
[63.408451] Starting dynamic subtest: vcs0
[64.443835] Dynamic subtest vcs0: SUCCESS (1.044s)
[64.455587] Starting dynamic subtest: vcs1
[65.489269] Dynamic subtest vcs1: SUCCESS (1.045s)
[65.503354] Starting dynamic subtest: vecs0
[66.533642] Dynamic subtest vecs0: SUCCESS (1.043s)
[66.543402] Starting dynamic subtest: ccs0
[67.579199] Dynamic subtest ccs0: SUCCESS (1.045s)
[67.581776] Subtest wait: SUCCESS (8.340s)
[67.789344] [004/133] (948s left) gem_exec_gttfill (engines)
[67.847864] Starting subtest: engines
[67.849869] Starting dynamic subtest: rcs0
[91.328244] Dynamic subtest rcs0: SUCCESS (23.482s)
[91.336789] Starting dynamic subtest: bcs0
[114.756723] Dynamic subtest bcs0: SUCCESS (23.426s)
[114.764893] Starting dynamic subtest: vcs0
[138.089923] Dynamic subtest vcs0: SUCCESS (23.332s)
[138.098083] Starting dynamic subtest: vcs1
[161.464817] Dynamic subtest vcs1: SUCCESS (23.373s)
[161.474329] Starting dynamic subtest: vecs0
[184.772345] Dynamic subtest vecs0: SUCCESS (23.305s)
[184.782668] Starting dynamic subtest: ccs0
[208.124394] Dynamic subtest ccs0: SUCCESS (23.351s)
[208.127113] Subtest engines: SUCCESS (140.275s)
[208.311520] [005/133] (808s left) kms_frontbuffer_tracking (fbcpsr-2p-rte)
[208.474022] Starting subtest: fbcpsr-2p-rte
[208.478055] Subtest fbcpsr-2p-rte: SKIP (0.000s)
[208.572190] [006/133] (807s left) kms_psr (fbc-pr-no-drrs)
[208.668634] Starting subtest: fbc-pr-no-drrs
[208.673084] Subtest fbc-pr-no-drrs: SKIP (0.000s)
[208.740971] [007/133] (807s left) perf (gen12-group-concurrent-oa-buffer-read)
[208.894047] Starting subtest: gen12-group-concurrent-oa-buffer-read
[218.977354] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.031s)
[219.017786] [008/133] (797s left) gem_softpin (full)
[219.065059] Starting subtest: full
[219.075387] Subtest full: SUCCESS (0.010s)
[219.218046] [009/133] (797s left) kms_plane (pixel-format-4-tiled-dg2-mc-ccs-modifier)
[219.311708] Starting subtest: pixel-format-4-tiled-dg2-mc-ccs-modifier
[219.316158] Subtest pixel-format-4-tiled-dg2-mc-ccs-modifier: SKIP (0.000s)
[219.397618] [010/133] (797s left) gem_mmap_gtt (basic-read)
[219.447650] Subtest basic-read: SKIP (0.000s)
[219.504467] [011/133] (797s left) kms_big_fb (linear-32bpp-rotate-180)
[219.612247] Starting subtest: linear-32bpp-rotate-180
[221.233708] Subtest linear-32bpp-rotate-180: SUCCESS (1.622s)
[221.380647] [012/133] (795s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[221.478585] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt
[221.482113] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[221.573536] [013/133] (795s left) gem_ctx_bad_destroy (invalid-ctx)
[221.620967] Starting subtest: invalid-ctx
[221.622895] Subtest invalid-ctx: SUCCESS (0.000s)
[221.677447] [014/133] (795s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-cc-modifier)
[221.765364] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-cc-modifier
[221.791488] Starting dynamic subtest: pipe-A-plane-0
[222.080245] Dynamic subtest pipe-A-plane-0: SUCCESS (0.289s)
[222.089462] Starting dynamic subtest: pipe-A-plane-3
[222.313668] Dynamic subtest pipe-A-plane-3: SUCCESS (0.233s)
[222.322683] Starting dynamic subtest: pipe-A-plane-5
[222.326136] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[223.388278] Starting dynamic subtest: pipe-B-plane-0
[223.680261] Dynamic subtest pipe-B-plane-0: SUCCESS (0.300s)
[223.688885] Starting dynamic subtest: pipe-B-plane-3
[223.924887] Dynamic subtest pipe-B-plane-3: SUCCESS (0.244s)
[223.933436] Starting dynamic subtest: pipe-B-plane-5
[223.937653] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[224.254307] Subtest pixel-format-4-tiled-mtl-rc-ccs-cc-modifier: SUCCESS (2.490s)
[225.067017] [015/133] (791s left) syncobj_timeline (single-wait-for-submit-available-signaled)
[225.136864] Starting subtest: single-wait-for-submit-available-signaled
[225.139252] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.001s)
[225.228966] [016/133] (791s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling)
[225.326606] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-downscaling
[225.328867] Starting dynamic subtest: pipe-A-default-mode
[226.546311] Dynamic subtest pipe-A-default-mode: SKIP (1.218s)
[226.551496] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (1.219s)
[226.689970] [017/133] (790s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[226.742885] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[226.744856] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[226.834782] [018/133] (790s left) i915_drm_fdinfo (virtual-busy-all)
[226.883071] Starting subtest: virtual-busy-all
[226.887331] Subtest virtual-busy-all: SKIP (0.000s)
[226.952717] [019/133] (789s left) gem_exec_reloc (basic-gtt-read-noreloc)
[227.012055] Subtest basic-gtt-read-noreloc: SKIP (0.000s)
[227.085686] [020/133] (789s left) kms_lease (lease-invalid-connector)
[227.176077] Starting subtest: lease-invalid-connector
[227.177935] Starting dynamic subtest: pipe-A-eDP-1
[227.179649] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[227.188498] Starting dynamic subtest: pipe-B-eDP-1
[227.190525] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[227.198448] Starting dynamic subtest: pipe-C-eDP-1
[227.200318] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[227.208272] Starting dynamic subtest: pipe-D-eDP-1
[227.209831] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[227.211419] Subtest lease-invalid-connector: SUCCESS (0.003s)
[227.252527] [021/133] (789s left) gem_pxp (reject-modify-context-protection-off-3)
[227.356212] Starting subtest: reject-modify-context-protection-off-3
[227.358231] Subtest reject-modify-context-protection-off-3: SUCCESS (0.002s)
[227.474926] [022/133] (789s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-mc-ccs)
[227.570694] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-mc-ccs
[227.573032] Starting dynamic subtest: pipe-A-eDP-1
[227.625256] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[227.635821] Starting dynamic subtest: pipe-B-eDP-1
[227.681859] Dynamic subtest pipe-B-eDP-1: SKIP (0.002s)
[227.691168] Starting dynamic subtest: pipe-C-eDP-1
[227.736811] Dynamic subtest pipe-C-eDP-1: SKIP (0.002s)
[227.745512] Starting dynamic subtest: pipe-D-eDP-1
[227.792045] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[227.795468] Subtest crc-sprite-planes-basic-y-tiled-gen12-mc-ccs: SKIP (0.009s)
[229.768988] [023/133] (787s left) gem_mmap_gtt (fault-concurrent)
[229.829652] Subtest fault-concurrent: SKIP (0.000s)
[229.881986] [024/133] (787s left) kms_addfb_basic (addfb25-4-tiled)
[229.985941] Starting subtest: addfb25-4-tiled
[229.988265] Subtest addfb25-4-tiled: SUCCESS (0.000s)
[230.084516] [025/133] (787s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[230.193127] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[230.195337] Starting dynamic subtest: A-eDP1
[233.769647] Dynamic subtest A-eDP1: SUCCESS (3.574s)
[233.780599] Starting dynamic subtest: B-eDP1
[236.948944] Dynamic subtest B-eDP1: SUCCESS (3.177s)
[236.959030] Starting dynamic subtest: C-eDP1
[240.141801] Dynamic subtest C-eDP1: SUCCESS (3.192s)
[240.153837] Starting dynamic subtest: D-eDP1
[243.228858] Dynamic subtest D-eDP1: SUCCESS (3.086s)
[243.230889] Subtest single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (13.036s)
[244.029356] [026/133] (773s left) kms_cursor_legacy (flip-vs-cursor-busy-crc-legacy)
[244.157657] Starting subtest: flip-vs-cursor-busy-crc-legacy
[244.970426] Subtest flip-vs-cursor-busy-crc-legacy: SUCCESS (0.812s)
[245.763982] [027/133] (771s left) syncobj_eventfd (timeline-wait-signaled)
[245.824242] Starting subtest: timeline-wait-signaled
[245.826601] Subtest timeline-wait-signaled: SUCCESS (0.000s)
[245.904266] [028/133] (771s left) gem_exec_schedule (u-fairslice)
[245.983942] Starting subtest: u-fairslice
[245.986136] Starting dynamic subtest: rcs0
[248.051351] Dynamic subtest rcs0: SUCCESS (2.020s)
[248.061462] Starting dynamic subtest: bcs0
[250.017805] Dynamic subtest bcs0: SUCCESS (2.019s)
[250.026135] Starting dynamic subtest: vcs0
[252.094767] Dynamic subtest vcs0: SUCCESS (2.018s)
[252.104596] Starting dynamic subtest: vcs1
[254.056852] Dynamic subtest vcs1: SUCCESS (2.018s)
[254.064884] Starting dynamic subtest: vecs0
[256.123684] Dynamic subtest vecs0: SUCCESS (2.020s)
[256.133976] Starting dynamic subtest: ccs0
[258.098811] Dynamic subtest ccs0: SUCCESS (2.022s)
[258.101160] Subtest u-fairslice: SUCCESS (12.120s)
[258.415121] [029/133] (758s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-upscaling)
[258.511730] Starting subtest: flip-32bpp-linear-to-64bpp-linear-upscaling
[258.514087] Starting dynamic subtest: pipe-A-default-mode
[261.197134] Dynamic subtest pipe-A-default-mode: SUCCESS (2.685s)
[261.199394] Subtest flip-32bpp-linear-to-64bpp-linear-upscaling: SUCCESS (2.687s)
[262.061214] [030/133] (755s left) gem_exec_whisper (basic-sync-all)
[262.121227] Starting subtest: basic-sync-all
[268.352273] Subtest basic-sync-all: SUCCESS (6.228s)
[268.540777] [031/133] (748s left) syncobj_timeline (etime-multi-wait-available-unsubmitted)
[268.606852] Starting subtest: etime-multi-wait-available-unsubmitted
[268.711543] Subtest etime-multi-wait-available-unsubmitted: SUCCESS (0.104s)
[268.784912] [032/133] (748s left) kms_ccs (random-ccs-data-y-tiled-ccs)
[268.876732] Starting subtest: random-ccs-data-y-tiled-ccs
[268.879058] Starting dynamic subtest: pipe-A-eDP-1
[268.904264] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[268.918577] Starting dynamic subtest: pipe-B-eDP-1
[268.942516] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[268.952528] Starting dynamic subtest: pipe-C-eDP-1
[268.976828] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[268.988666] Starting dynamic subtest: pipe-D-eDP-1
[269.013139] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[269.017522] Subtest random-ccs-data-y-tiled-ccs: SKIP (0.003s)
[271.120305] [033/133] (746s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs)
[271.212931] Starting subtest: bad-aux-stride-4-tiled-mtl-rc-ccs
[271.215515] Starting dynamic subtest: pipe-A-eDP-1
[271.235932] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[271.247360] Starting dynamic subtest: pipe-B-eDP-1
[271.266583] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[271.275622] Starting dynamic subtest: pipe-C-eDP-1
[271.295089] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[271.303886] Starting dynamic subtest: pipe-D-eDP-1
[271.324709] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[271.327269] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs: SUCCESS (0.006s)
[273.486422] [034/133] (744s left) kms_addfb_basic (basic)
[273.553138] Starting subtest: basic
[273.555533] Subtest basic: SUCCESS (0.000s)
[273.718629] [035/133] (743s left) kms_color_pipeline (plane-lut1d-lut1d)
[273.823366] Starting subtest: plane-lut1d-lut1d
[274.005486] Starting dynamic subtest: pipe-A-plane-0
[274.172808] Dynamic subtest pipe-A-plane-0: SUCCESS (0.166s)
[274.182856] Starting dynamic subtest: pipe-A-plane-1
[274.327668] Dynamic subtest pipe-A-plane-1: SUCCESS (0.155s)
[274.338033] Starting dynamic subtest: pipe-A-plane-2
[274.493925] Dynamic subtest pipe-A-plane-2: SUCCESS (0.166s)
[275.673939] Starting dynamic subtest: pipe-B-plane-0
[275.844242] Dynamic subtest pipe-B-plane-0: SUCCESS (0.177s)
[275.854218] Starting dynamic subtest: pipe-B-plane-1
[276.033169] Dynamic subtest pipe-B-plane-1: SUCCESS (0.188s)
[276.044177] Starting dynamic subtest: pipe-B-plane-2
[276.222297] Dynamic subtest pipe-B-plane-2: SUCCESS (0.188s)
[277.407647] Starting dynamic subtest: pipe-C-plane-0
[277.533098] Dynamic subtest pipe-C-plane-0: SUCCESS (0.133s)
[277.542427] Starting dynamic subtest: pipe-C-plane-1
[277.688734] Dynamic subtest pipe-C-plane-1: SUCCESS (0.155s)
[277.698371] Starting dynamic subtest: pipe-C-plane-2
[277.844208] Dynamic subtest pipe-C-plane-2: SUCCESS (0.155s)
[279.065176] Starting dynamic subtest: pipe-D-plane-0
[279.203688] Dynamic subtest pipe-D-plane-0: SUCCESS (0.144s)
[279.212656] Starting dynamic subtest: pipe-D-plane-1
[279.357476] Dynamic subtest pipe-D-plane-1: SUCCESS (0.155s)
[279.367063] Starting dynamic subtest: pipe-D-plane-2
[279.490952] Dynamic subtest pipe-D-plane-2: SUCCESS (0.132s)
[279.779912] Subtest plane-lut1d-lut1d: SUCCESS (5.954s)
[280.608878] [036/133] (736s left) api_intel_allocator (standalone)
[280.665778] Starting subtest: standalone
[280.680464] Subtest standalone: SUCCESS (0.017s)
[280.811315] [037/133] (736s left) prime_self_import (basic-llseek-bad)
[280.846108] Starting subtest: basic-llseek-bad
[280.864039] Subtest basic-llseek-bad: SUCCESS (0.018s)
[280.962366] [038/133] (736s left) kms_vblank (query-forked)
[281.074067] Starting subtest: query-forked
[281.075947] Starting dynamic subtest: pipe-A-eDP-1
[282.893923] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.819s)
[282.909239] Starting dynamic subtest: pipe-D-eDP-1
[285.421089] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.526s)
[285.423384] Subtest query-forked: SUCCESS (4.348s)
[286.270949] [039/133] (731s left) gem_exec_flush (basic-uc-ro-default)
[286.342063] Starting subtest: basic-uc-ro-default
[291.827136] Subtest basic-uc-ro-default: SUCCESS (5.459s)
[291.985262] [040/133] (725s left) perf (per-context-mode-unprivileged)
[292.077778] Starting subtest: per-context-mode-unprivileged
[292.082318] Subtest per-context-mode-unprivileged: SKIP (0.000s)
[292.117365] [041/133] (725s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-render)
[292.215339] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-render
[292.219681] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[292.300224] [042/133] (725s left) i915_pm_rps (min-max-config-idle)
[292.355983] Starting subtest: min-max-config-idle
[292.359937] Subtest min-max-config-idle: SKIP (0.000s)
[292.476591] [043/133] (725s left) gem_exec_balancer (busy)
[292.529234] Starting subtest: busy
[294.267217] Subtest busy: SUCCESS (1.736s)
[294.589521] [044/133] (723s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-render)
[294.688790] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-render
[294.693199] Subtest fbc-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[294.793362] [045/133] (723s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-onoff)
[294.882576] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-onoff
[294.887083] Subtest fbcpsr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[294.985947] [046/133] (723s left) gem_mmap_gtt (big-bo-tiledy)
[295.045590] Subtest big-bo-tiledY: SKIP (0.000s)
[295.115248] [047/133] (722s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-pgflip-blt)
[295.208829] Starting subtest: fbcpsr-1p-primscrn-shrfb-pgflip-blt
[302.763948] Subtest fbcpsr-1p-primscrn-shrfb-pgflip-blt: SUCCESS (7.559s)
[302.901482] [048/133] (715s left) kms_chamelium_edid (vga-edid-read)
[303.287960] Subtest vga-edid-read: SKIP (0.000s)
[304.144435] [049/133] (713s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-blt)
[304.234776] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-blt
[311.193864] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.961s)
[311.340013] [050/133] (706s left) gem_create (hog-create)
[311.393956] Starting subtest: hog-create
[311.396232] Starting dynamic subtest: smem0
[344.321383] Dynamic subtest smem0: SUCCESS (32.924s)
[344.323862] Subtest hog-create: SUCCESS (32.926s)
[344.504320] [051/133] (673s left) kms_getfb (getfb-repeated-different-handles)
[344.621091] Starting subtest: getfb-repeated-different-handles
[344.623401] Subtest getfb-repeated-different-handles: SUCCESS (0.000s)
[344.742616] [052/133] (673s left) kms_big_fb (y-tiled-64bpp-rotate-0)
[344.843028] Starting subtest: y-tiled-64bpp-rotate-0
[344.847247] Subtest y-tiled-64bpp-rotate-0: SKIP (0.000s)
[344.923230] [053/133] (673s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[345.016138] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[345.020369] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[345.112232] [054/133] (673s left) api_intel_bb (simple-bb)
[345.169385] Starting subtest: simple-bb
[345.174923] Subtest simple-bb: SUCCESS (0.007s)
[345.285801] [055/133] (673s left) kms_psr2_sf (pr-overlay-plane-update-sf-dmg-area)
[345.384641] Starting subtest: pr-overlay-plane-update-sf-dmg-area
[345.388983] Subtest pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[345.453872] [056/133] (672s left) kms_flip (blocking-wf_vblank)
[345.556648] Starting subtest: blocking-wf_vblank
[345.558508] Starting dynamic subtest: A-eDP1
[354.468566] Dynamic subtest A-eDP1: SUCCESS (8.877s)
[354.478961] Starting dynamic subtest: B-eDP1
[363.404808] Dynamic subtest B-eDP1: SUCCESS (8.934s)
[363.414715] Starting dynamic subtest: C-eDP1
[372.336589] Dynamic subtest C-eDP1: SUCCESS (8.919s)
[372.347684] Starting dynamic subtest: D-eDP1
[381.274999] Dynamic subtest D-eDP1: SUCCESS (8.933s)
[381.277733] Subtest blocking-wf_vblank: SUCCESS (35.673s)
[382.475789] [057/133] (635s left) kms_cursor_legacy (cursora-vs-flipb-atomic-transitions)
[382.605231] Starting subtest: cursorA-vs-flipB-atomic-transitions
[382.609729] Subtest cursorA-vs-flipB-atomic-transitions: SKIP (0.001s)
[382.747817] [058/133] (635s left) gem_mmap_offset (bad-flags)
[382.803265] Starting subtest: bad-flags
[382.805484] Subtest bad-flags: SUCCESS (0.000s)
[382.925321] [059/133] (635s left) vgem_basic (create)
[383.021094] Starting subtest: create
[383.024667] Subtest create: SUCCESS (0.000s)
[383.078419] [FACT vgem_basic (create)] new: kernel.kmod_is_loaded.vgem: true
[383.081650] [060/133] (635s left) kms_atomic (plane-primary-legacy)
[383.195852] Starting subtest: plane-primary-legacy
[383.197868] Starting dynamic subtest: pipe-A-eDP-1
[383.654905] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.455s)
[383.657161] Subtest plane-primary-legacy: SUCCESS (0.458s)
[384.490417] [061/133] (634s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[384.581692] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[384.585888] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[384.677633] [062/133] (633s left) syncobj_timeline (invalid-single-wait-unsubmitted)
[384.733266] Starting subtest: invalid-single-wait-unsubmitted
[384.735440] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s)
[384.829742] [063/133] (633s left) kms_psr (psr-cursor-render)
[384.925924] Starting subtest: psr-cursor-render
[384.928118] Starting dynamic subtest: eDP-1
[386.687318] Dynamic subtest eDP-1: SUCCESS (1.762s)
[386.689532] Subtest psr-cursor-render: SUCCESS (1.763s)
[387.550882] [064/133] (631s left) kms_ccs (bad-aux-stride-y-tiled-gen12-rc-ccs-cc)
[387.648708] Starting subtest: bad-aux-stride-y-tiled-gen12-rc-ccs-cc
[387.650917] Starting dynamic subtest: pipe-A-eDP-1
[387.672853] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[387.684320] Starting dynamic subtest: pipe-B-eDP-1
[387.705563] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[387.714089] Starting dynamic subtest: pipe-C-eDP-1
[387.735261] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[387.745613] Starting dynamic subtest: pipe-D-eDP-1
[387.766803] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[387.770691] Subtest bad-aux-stride-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[389.827482] [065/133] (628s left) gem_exec_fence (syncobj-timeline-invalid-flags)
[390.362851] Starting subtest: syncobj-timeline-invalid-flags
[390.365039] Subtest syncobj-timeline-invalid-flags: SUCCESS (0.000s)
[391.385428] [066/133] (627s left) kms_pipe_stress (stress-xrgb8888-ytiled)
[391.479746] Starting subtest: stress-xrgb8888-ytiled
[391.484495] Subtest stress-xrgb8888-ytiled: SKIP (0.000s)
[391.563575] [067/133] (627s left) gem_sync (basic-each)
[391.658864] Starting subtest: basic-each
[393.873762] Subtest basic-each: SUCCESS (2.227s)
[394.073913] [068/133] (624s left) kms_big_fb (x-tiled-8bpp-rotate-0)
[394.179305] Starting subtest: x-tiled-8bpp-rotate-0
[395.359467] Subtest x-tiled-8bpp-rotate-0: SUCCESS (1.181s)
[395.485424] [069/133] (623s left) sw_sync (sync_expired_merge)
[395.520598] Starting subtest: sync_expired_merge
[396.595214] Subtest sync_expired_merge: SUCCESS (1.074s)
[396.660414] [070/133] (622s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-plflip-blt)
[396.753801] Starting subtest: fbc-1p-primscrn-shrfb-plflip-blt
[401.334813] Subtest fbc-1p-primscrn-shrfb-plflip-blt: SUCCESS (4.585s)
[402.526319] [071/133] (616s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc)
[402.626727] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc
[402.631121] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[402.712352] [072/133] (616s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-pwrite)
[402.824987] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-pwrite
[402.829243] Subtest fbc-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[402.931262] [073/133] (616s left) kms_plane_scaling (plane-downscale-factor-0-75-with-pixel-format)
[403.027776] Starting subtest: plane-downscale-factor-0-75-with-pixel-format
[403.030023] Starting dynamic subtest: pipe-A
[404.199275] Dynamic subtest pipe-A: SUCCESS (1.173s)
[404.208729] Starting dynamic subtest: pipe-B
[406.450751] Dynamic subtest pipe-B: SUCCESS (2.250s)
[406.468440] Starting dynamic subtest: pipe-C
[407.612892] Dynamic subtest pipe-C: SUCCESS (1.159s)
[407.624695] Starting dynamic subtest: pipe-D
[408.846548] Dynamic subtest pipe-D: SUCCESS (1.232s)
[408.848943] Subtest plane-downscale-factor-0-75-with-pixel-format: SUCCESS (5.822s)
[410.056750] [074/133] (609s left) kms_cursor_edge_walk (64x64-top-bottom)
[410.153253] Starting subtest: 64x64-top-bottom
[410.155646] Starting dynamic subtest: pipe-A-eDP-1
[413.610794] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.458s)
[413.620391] Starting dynamic subtest: pipe-D-eDP-1
[416.725310] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.112s)
[416.727658] Subtest 64x64-top-bottom: SUCCESS (6.573s)
[417.539730] [075/133] (601s left) kms_joiner (basic-ultra-joiner)
[417.643759] Starting subtest: basic-ultra-joiner
[417.647910] Subtest basic-ultra-joiner: SKIP (0.000s)
[417.711464] [076/133] (601s left) gen9_exec_parse (bb-start-param)
[417.769831] Subtest bb-start-param: SKIP (0.000s)
[417.849578] [077/133] (601s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-blt)
[417.944286] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-blt
[424.773581] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (6.831s)
[424.928799] [078/133] (594s left) sw_sync (sync_multi_consumer)
[424.977470] Starting subtest: sync_multi_consumer
[425.400776] Subtest sync_multi_consumer: SUCCESS (0.426s)
[425.465485] [079/133] (593s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs)
[425.528871] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs
[425.533518] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s)
[425.725785] [080/133] (593s left) gem_exec_schedule (pi-common)
[425.911523] Starting subtest: pi-common
[425.913486] Starting dynamic subtest: rcs0
[425.940507] Dynamic subtest rcs0: SUCCESS (0.031s)
[425.954455] Starting dynamic subtest: bcs0
[425.972281] Dynamic subtest bcs0: SUCCESS (0.031s)
[425.986393] Starting dynamic subtest: vcs0
[426.000904] Dynamic subtest vcs0: SUCCESS (0.028s)
[426.014876] Starting dynamic subtest: vcs1
[426.028187] Dynamic subtest vcs1: SUCCESS (0.026s)
[426.042431] Starting dynamic subtest: vecs0
[426.055044] Dynamic subtest vecs0: SUCCESS (0.026s)
[426.069196] Starting dynamic subtest: ccs0
[426.081297] Dynamic subtest ccs0: SUCCESS (0.025s)
[426.083583] Subtest pi-common: SUCCESS (0.173s)
[426.315299] [081/133] (593s left) gem_exec_whisper (basic-contexts-all)
[426.385450] Starting subtest: basic-contexts-all
[437.669473] Subtest basic-contexts-all: SUCCESS (11.279s)
[437.867348] [082/133] (581s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-mc-ccs)
[437.966763] Starting subtest: ccs-on-another-bo-4-tiled-mtl-mc-ccs
[437.968920] Starting dynamic subtest: pipe-A-eDP-1
[437.991421] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.023s)
[438.001413] Starting dynamic subtest: pipe-B-eDP-1
[438.022567] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.023s)
[438.036966] Starting dynamic subtest: pipe-C-eDP-1
[438.056807] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.023s)
[438.068149] Starting dynamic subtest: pipe-D-eDP-1
[438.088762] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.023s)
[438.091132] Subtest ccs-on-another-bo-4-tiled-mtl-mc-ccs: SUCCESS (0.098s)
[440.314189] [083/133] (579s left) kms_frontbuffer_tracking (psr-rgb101010-draw-blt)
[440.424182] Starting subtest: psr-rgb101010-draw-blt
[447.688215] Subtest psr-rgb101010-draw-blt: SUCCESS (7.264s)
[447.820261] [084/133] (571s left) core_setmaster (master-drop-set-shared-fd)
[447.910098] Starting subtest: master-drop-set-shared-fd
[447.931605] Subtest master-drop-set-shared-fd: SUCCESS (0.022s)
[447.972972] [085/133] (571s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-render)
[448.067565] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-render
[454.822247] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-render: SUCCESS (6.758s)
[454.960971] [086/133] (564s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[455.064075] Starting subtest: psr-rgb565-draw-render
[462.196630] Subtest psr-rgb565-draw-render: SUCCESS (7.135s)
[462.309466] [087/133] (557s left) kms_sequence (get-forked-busy)
[462.395887] Starting subtest: get-forked-busy
[462.398089] Starting dynamic subtest: pipe-A-eDP-1
[464.333277] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.934s)
[464.345349] Starting dynamic subtest: pipe-B-eDP-1
[466.903798] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.573s)
[466.913512] Starting dynamic subtest: pipe-C-eDP-1
[469.524275] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.617s)
[469.534179] Starting dynamic subtest: pipe-D-eDP-1
[472.156263] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.631s)
[472.158570] Subtest get-forked-busy: SUCCESS (9.761s)
[473.025139] [088/133] (546s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen)
[473.123409] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen
[473.127360] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[473.217887] [089/133] (546s left) syncobj_wait (multi-wait-for-submit-unsubmitted-signaled)
[473.269150] Starting subtest: multi-wait-for-submit-unsubmitted-signaled
[473.271967] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.000s)
[473.349114] [090/133] (546s left) syncobj_wait (single-wait-for-submit-signaled)
[473.409510] Starting subtest: single-wait-for-submit-signaled
[473.411735] Subtest single-wait-for-submit-signaled: SUCCESS (0.000s)
[473.520466] [091/133] (546s left) kms_dsc (dsc-fractional-bpp)
[473.603292] Starting subtest: dsc-fractional-bpp
[473.615460] Subtest dsc-fractional-bpp: SKIP (0.000s)
[473.688015] [092/133] (546s left) syncobj_wait (wait-all-snapshot)
[473.748249] Starting subtest: wait-all-snapshot
[473.829246] Subtest wait-all-snapshot: SUCCESS (0.082s)
[473.909482] [093/133] (546s left) kms_content_protection (legacy-hdcp14)
[474.061535] Starting subtest: legacy-hdcp14
[474.064912] Subtest legacy-hdcp14: SKIP (0.000s)
[474.180165] [094/133] (545s left) gem_exec_balancer (waits)
[474.233996] Starting subtest: waits
[480.857270] Subtest waits: SUCCESS (6.569s)
[481.107423] [095/133] (538s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[481.194900] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[481.197176] Starting dynamic subtest: pipe-A-eDP-1
[481.206282] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[481.216895] Starting dynamic subtest: pipe-B-eDP-1
[481.225357] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[481.235064] Starting dynamic subtest: pipe-C-eDP-1
[481.243118] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[481.251973] Starting dynamic subtest: pipe-D-eDP-1
[481.260092] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[481.264052] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[483.484443] [096/133] (536s left) i915_hangman (engine-error-state-capture)
[483.549209] Starting subtest: engine-error-state-capture
[483.551405] Starting dynamic subtest: rcs0
[487.259516] Dynamic subtest rcs0: SUCCESS (3.710s)
[487.272556] Starting dynamic subtest: bcs0
[493.274369] Dynamic subtest bcs0: SUCCESS (6.012s)
[493.286656] Starting dynamic subtest: vcs0
[499.226978] Dynamic subtest vcs0: SUCCESS (5.950s)
[499.239591] Starting dynamic subtest: vcs1
[505.180587] Dynamic subtest vcs1: SUCCESS (5.951s)
[505.193679] Starting dynamic subtest: vecs0
[510.236049] Dynamic subtest vecs0: SUCCESS (5.052s)
[510.248567] Starting dynamic subtest: ccs0
[516.251303] Dynamic subtest ccs0: SUCCESS (6.012s)
[516.254019] Subtest engine-error-state-capture: SUCCESS (32.703s)
[516.385476] [097/133] (503s left) perf_pmu (rc6-suspend)
[516.433095] Starting subtest: rc6-suspend
[538.743736] Subtest rc6-suspend: SUCCESS (7.698s)
[539.597432] [098/133] (480s left) gem_exec_parallel (basic)
[539.675715] Starting subtest: basic
[539.678064] Starting dynamic subtest: rcs0
[541.197535] Dynamic subtest rcs0: SUCCESS (1.521s)
[541.209689] Starting dynamic subtest: bcs0
[542.686983] Dynamic subtest bcs0: SUCCESS (1.486s)
[542.707846] Starting dynamic subtest: vcs0
[544.818716] Dynamic subtest vcs0: SUCCESS (2.129s)
[544.831723] Starting dynamic subtest: vcs1
[546.867495] Dynamic subtest vcs1: SUCCESS (2.041s)
[546.881026] Starting dynamic subtest: vecs0
[548.850262] Dynamic subtest vecs0: SUCCESS (1.977s)
[548.868146] Starting dynamic subtest: ccs0
[550.367305] Dynamic subtest ccs0: SUCCESS (1.514s)
[550.369700] Subtest basic: SUCCESS (10.684s)
[550.560308] [099/133] (469s left) kms_psr (psr-primary-blt)
[550.666231] Starting subtest: psr-primary-blt
[550.668495] Starting dynamic subtest: eDP-1
[552.428480] Dynamic subtest eDP-1: SUCCESS (1.760s)
[552.430651] Subtest psr-primary-blt: SUCCESS (1.761s)
[553.298739] [100/133] (466s left) sriov_basic (enable-vfs-bind-unbind-each-numvfs-all)
[553.348054] Starting subtest: enable-vfs-bind-unbind-each-numvfs-all
[553.431961] Subtest enable-vfs-bind-unbind-each-numvfs-all: FAIL (0.032s)
[553.475132] [101/133] (466s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc)
[553.579673] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc
[557.193428] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (3.615s)
[558.384734] [102/133] (461s left) kms_prop_blob (blob-prop-lifetime)
[558.445774] Starting subtest: blob-prop-lifetime
[558.448367] Subtest blob-prop-lifetime: SUCCESS (0.001s)
[558.561255] [103/133] (461s left) gem_userptr_blits (readonly-unsync)
[558.638262] Subtest readonly-unsync: SKIP (0.000s)
[558.780751] [104/133] (461s left) perf (polling)
[558.861629] Starting subtest: polling
[558.864013] Starting dynamic subtest: 0-rcs0
[568.881924] Dynamic subtest 0-rcs0: SUCCESS (10.013s)
[568.897909] Starting dynamic subtest: 1-vcs1
[578.957697] Dynamic subtest 1-vcs1: SUCCESS (10.021s)
[578.960031] Subtest polling: SUCCESS (20.037s)
[579.001688] [105/133] (441s left) i915_query (query-topology-kernel-writes)
[579.078145] Starting subtest: query-topology-kernel-writes
[579.080527] Subtest query-topology-kernel-writes: SUCCESS (0.000s)
[579.184352] [106/133] (441s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[579.307332] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[580.364519] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.057s)
[580.490188] [107/133] (440s left) kms_psr (fbc-pr-sprite-blt)
[580.578891] Starting subtest: fbc-pr-sprite-blt
[580.582612] Subtest fbc-pr-sprite-blt: SKIP (0.000s)
[580.665060] [108/133] (439s left) prime_self_import (basic-with_two_bos)
[580.701849] Starting subtest: basic-with_two_bos
[580.721311] Subtest basic-with_two_bos: SUCCESS (0.020s)
[580.838600] [109/133] (439s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[580.941398] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip
[581.988580] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip: SUCCESS (1.046s)
[582.123385] [110/133] (438s left) gem_exec_reloc (basic-cpu-read)
[582.189128] Subtest basic-cpu-read: SKIP (0.000s)
[582.256149] [111/133] (438s left) gem_ctx_shared (exec-shared-gtt)
[582.320695] Starting subtest: exec-shared-gtt
[582.322950] Starting dynamic subtest: rcs0
[582.325018] Dynamic subtest rcs0: SUCCESS (0.006s)
[582.335777] Starting dynamic subtest: bcs0
[582.337601] Dynamic subtest bcs0: SUCCESS (0.006s)
[582.351372] Starting dynamic subtest: vcs0
[582.353380] Dynamic subtest vcs0: SUCCESS (0.008s)
[582.363648] Starting dynamic subtest: vcs1
[582.365431] Dynamic subtest vcs1: SUCCESS (0.007s)
[582.375230] Starting dynamic subtest: vecs0
[582.377009] Dynamic subtest vecs0: SUCCESS (0.006s)
[582.386576] Starting dynamic subtest: ccs0
[582.388606] Dynamic subtest ccs0: SUCCESS (0.006s)
[582.390596] Subtest exec-shared-gtt: SUCCESS (0.043s)
[582.554470] [112/133] (438s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-5)
[582.643969] Starting subtest: planes-unity-scaling-downscale-factor-0-5
[582.646142] Starting dynamic subtest: pipe-A
[582.664580] Dynamic subtest pipe-A: SKIP (0.017s)
[582.675588] Starting dynamic subtest: pipe-B
[582.695214] Dynamic subtest pipe-B: SKIP (0.031s)
[582.706454] Starting dynamic subtest: pipe-C
[582.725923] Dynamic subtest pipe-C: SKIP (0.030s)
[582.735662] Starting dynamic subtest: pipe-D
[582.756108] Dynamic subtest pipe-D: SKIP (0.030s)
[582.759278] Subtest planes-unity-scaling-downscale-factor-0-5: SKIP (0.111s)
[582.849814] [113/133] (438s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[582.938601] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[590.279004] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.341s)
[590.388589] [114/133] (430s left) kms_getfb (getfb-handle-protection)
[590.477701] Starting subtest: getfb-handle-protection
[590.493369] Subtest getfb-handle-protection: SUCCESS (0.016s)
[590.616311] [115/133] (430s left) gem_ctx_persistence (process)
[590.681768] Starting subtest: process
[590.868041] Subtest process: SUCCESS (0.186s)
[590.952694] [116/133] (430s left) i915_selftest (mock)
[594.318228] Starting subtest: mock
[594.321083] Starting dynamic subtest: sanitycheck
[595.029313] Dynamic subtest sanitycheck: SUCCESS (0.710s)
[595.039656] Starting dynamic subtest: shmem
[595.714008] Dynamic subtest shmem: SUCCESS (0.683s)
[595.723872] Starting dynamic subtest: fence
[602.987537] Dynamic subtest fence: SUCCESS (7.270s)
[602.997621] Starting dynamic subtest: scatterlist
[604.675354] Dynamic subtest scatterlist: SUCCESS (1.686s)
[604.684522] Starting dynamic subtest: syncmap
[607.908844] Dynamic subtest syncmap: SUCCESS (3.231s)
[607.919800] Starting dynamic subtest: uncore
[608.579900] Dynamic subtest uncore: SUCCESS (0.669s)
[608.590998] Starting dynamic subtest: ring
[609.275716] Dynamic subtest ring: SUCCESS (0.694s)
[609.286683] Starting dynamic subtest: engine
[609.967945] Dynamic subtest engine: SUCCESS (0.690s)
[609.978730] Starting dynamic subtest: timelines
[613.837821] Dynamic subtest timelines: SUCCESS (3.866s)
[613.853445] Starting dynamic subtest: requests
[617.429382] Dynamic subtest requests: SUCCESS (3.590s)
[617.443226] Starting dynamic subtest: objects
[618.199212] Dynamic subtest objects: SUCCESS (0.768s)
[618.210019] Starting dynamic subtest: phys
[618.984828] Dynamic subtest phys: SUCCESS (0.782s)
[618.995639] Starting dynamic subtest: dmabuf
[619.750986] Dynamic subtest dmabuf: SUCCESS (0.765s)
[619.762834] Starting dynamic subtest: vma
[625.526811] Dynamic subtest vma: SUCCESS (5.772s)
[625.536583] Starting dynamic subtest: evict
[626.920486] Dynamic subtest evict: SUCCESS (1.393s)
[626.931399] Starting dynamic subtest: gtt
[630.237529] Dynamic subtest gtt: SUCCESS (3.314s)
[630.253814] Starting dynamic subtest: hugepages
[631.154370] Dynamic subtest hugepages: SUCCESS (0.915s)
[631.165540] Starting dynamic subtest: memory_region
[633.729848] Dynamic subtest memory_region: SUCCESS (2.573s)
[633.732766] Subtest mock: SUCCESS (39.405s)
[633.759988] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[633.760705] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true
[633.763939] [117/133] (387s left) kms_pm_rpm (legacy-planes-dpms)
[637.106038] Starting subtest: legacy-planes-dpms
[637.108485] Starting dynamic subtest: plane-65
[645.896005] Dynamic subtest plane-65: SUCCESS (8.792s)
[645.908599] Starting dynamic subtest: plane-95
[654.220874] Dynamic subtest plane-95: SUCCESS (8.323s)
[654.233293] Starting dynamic subtest: plane-125
[662.528838] Dynamic subtest plane-125: SUCCESS (8.306s)
[662.541660] Starting dynamic subtest: plane-135
[670.838029] Dynamic subtest plane-135: SUCCESS (8.307s)
[670.840711] Subtest legacy-planes-dpms: SUCCESS (33.740s)
[671.245670] [FACT kms_pm_rpm (legacy-planes-dpms)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[671.247291] [FACT kms_pm_rpm (legacy-planes-dpms)] new: kernel.kmod_is_loaded.i915: true
[671.252108] [118/133] (349s left) kms_cursor_crc (cursor-random-32x10)
[671.430388] Starting subtest: cursor-random-32x10
[671.484194] Subtest cursor-random-32x10: SKIP (0.048s)
[671.769733] [119/133] (349s left) kms_cursor_crc (cursor-offscreen-32x32)
[671.932840] Starting subtest: cursor-offscreen-32x32
[671.987598] Subtest cursor-offscreen-32x32: SKIP (0.047s)
[672.249599] [120/133] (348s left) syncobj_wait (single-wait-all-for-submit-submitted)
[672.306150] Starting subtest: single-wait-all-for-submit-submitted
[672.414678] Subtest single-wait-all-for-submit-submitted: SUCCESS (0.108s)
[672.496025] [121/133] (348s left) gem_mmap_gtt (cpuset-medium-copy-xy)
[672.556115] Subtest cpuset-medium-copy-XY: SKIP (0.000s)
[672.622416] [122/133] (348s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[672.677213] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[672.679535] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.000s)
[672.772311] [123/133] (348s left) kms_chamelium_hpd (hdmi-hpd)
[673.146128] Subtest hdmi-hpd: SKIP (0.000s)
[673.929214] [124/133] (347s left) gem_exec_reloc (basic-gtt-noreloc)
[673.994484] Subtest basic-gtt-noreloc: SKIP (0.000s)
[674.065256] [125/133] (347s left) kms_flip (2x-wf_vblank-ts-check)
[674.156413] Starting subtest: 2x-wf_vblank-ts-check
[674.168723] Subtest 2x-wf_vblank-ts-check: SKIP (0.011s)
[674.253523] [126/133] (347s left) kms_psr (pr-primary-mmap-cpu)
[674.339282] Starting subtest: pr-primary-mmap-cpu
[674.343227] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[674.411462] [127/133] (347s left) gem_readwrite (read-write)
[674.476027] Subtest read-write: SKIP (0.000s)
[674.552442] [128/133] (346s left) fbdev (write)
[674.597068] Starting subtest: write
[674.959638] Subtest write: SUCCESS (0.361s)
[675.023387] [129/133] (346s left) kms_dp_aux_dev (basic)
[675.073670] Starting subtest: basic
[675.294537] Subtest basic: SUCCESS (0.221s)
[675.367616] [130/133] (346s left) kms_psr (fbc-psr2-sprite-render)
[675.460546] Starting subtest: fbc-psr2-sprite-render
[675.462839] Starting dynamic subtest: eDP-1
[675.466903] Dynamic subtest eDP-1: SKIP (0.000s)
[675.470947] Subtest fbc-psr2-sprite-render: SKIP (0.001s)
[675.550833] [131/133] (346s left) gem_ctx_persistence (engines-cleanup)
[675.612057] Starting subtest: engines-cleanup
[675.614393] Starting dynamic subtest: rcs0
[675.683479] Dynamic subtest rcs0: SUCCESS (0.071s)
[675.697021] Starting dynamic subtest: bcs0
[675.725349] Dynamic subtest bcs0: SUCCESS (0.040s)
[675.736156] Starting dynamic subtest: vcs0
[675.763263] Dynamic subtest vcs0: SUCCESS (0.036s)
[675.773422] Starting dynamic subtest: vcs1
[675.797185] Dynamic subtest vcs1: SUCCESS (0.032s)
[675.806935] Starting dynamic subtest: vecs0
[675.849262] Dynamic subtest vecs0: SUCCESS (0.050s)
[675.861199] Starting dynamic subtest: ccs0
[675.881077] Dynamic subtest ccs0: SUCCESS (0.030s)
[675.883376] Subtest engines-cleanup: SUCCESS (0.270s)
[676.000559] [132/133] (345s left) sysfs_heartbeat_interval (idempotent)
[676.050987] Starting subtest: idempotent
[676.053284] Starting dynamic subtest: vecs0
[676.055488] Dynamic subtest vecs0: SUCCESS (0.001s)
[676.065753] Starting dynamic subtest: ccs0
[676.067897] Dynamic subtest ccs0: SUCCESS (0.001s)
[676.076874] Starting dynamic subtest: vcs0
[676.078660] Dynamic subtest vcs0: SUCCESS (0.001s)
[676.087597] Starting dynamic subtest: bcs0
[676.089724] Dynamic subtest bcs0: SUCCESS (0.001s)
[676.098898] Starting dynamic subtest: rcs0
[676.101049] Dynamic subtest rcs0: SUCCESS (0.001s)
[676.110208] Starting dynamic subtest: vcs1
[676.112407] Dynamic subtest vcs1: SUCCESS (0.001s)
[676.114466] Subtest idempotent: SUCCESS (0.010s)
[676.154055] [133/133] (345s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[676.241247] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[683.351830] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (7.114s)
[683.464672] Closing watchdogs
results: parsing output: 0/ for test: gem_pxp
results: parsing output: 1/ for test: kms_pm_rpm
results: parsing output: 2/ for test: gem_wait
results: parsing output: 3/ for test: gem_exec_gttfill
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_psr
results: parsing output: 6/ for test: perf
results: parsing output: 7/ for test: gem_softpin
results: parsing output: 8/ for test: kms_plane
results: parsing output: 9/ for test: gem_mmap_gtt
results: parsing output: 10/ for test: kms_big_fb
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: gem_ctx_bad_destroy
results: parsing output: 13/ for test: kms_plane
results: parsing output: 14/ for test: syncobj_timeline
results: parsing output: 15/ for test: kms_flip_scaled_crc
results: parsing output: 16/ for test: syncobj_wait
results: parsing output: 17/ for test: i915_drm_fdinfo
results: parsing output: 18/ for test: gem_exec_reloc
results: parsing output: 19/ for test: kms_lease
results: parsing output: 20/ for test: gem_pxp
results: parsing output: 21/ for test: kms_ccs
results: parsing output: 22/ for test: gem_mmap_gtt
results: parsing output: 23/ for test: kms_addfb_basic
results: parsing output: 24/ for test: kms_flip
results: parsing output: 25/ for test: kms_cursor_legacy
results: parsing output: 26/ for test: syncobj_eventfd
results: parsing output: 27/ for test: gem_exec_schedule
results: parsing output: 28/ for test: kms_flip_scaled_crc
results: parsing output: 29/ for test: gem_exec_whisper
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: kms_ccs
results: parsing output: 32/ for test: kms_ccs
results: parsing output: 33/ for test: kms_addfb_basic
results: parsing output: 34/ for test: kms_color_pipeline
results: parsing output: 35/ for test: api_intel_allocator
results: parsing output: 36/ for test: prime_self_import
results: parsing output: 37/ for test: kms_vblank
results: parsing output: 38/ for test: gem_exec_flush
results: parsing output: 39/ for test: perf
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: i915_pm_rps
results: parsing output: 42/ for test: gem_exec_balancer
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: gem_mmap_gtt
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: kms_chamelium_edid
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: gem_create
results: parsing output: 50/ for test: kms_getfb
results: parsing output: 51/ for test: kms_big_fb
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: api_intel_bb
results: parsing output: 54/ for test: kms_psr2_sf
results: parsing output: 55/ for test: kms_flip
results: parsing output: 56/ for test: kms_cursor_legacy
results: parsing output: 57/ for test: gem_mmap_offset
results: parsing output: 58/ for test: vgem_basic
results: parsing output: 59/ for test: kms_atomic
results: parsing output: 60/ for test: kms_big_fb
results: parsing output: 61/ for test: syncobj_timeline
results: parsing output: 62/ for test: kms_psr
results: parsing output: 63/ for test: kms_ccs
results: parsing output: 64/ for test: gem_exec_fence
results: parsing output: 65/ for test: kms_pipe_stress
results: parsing output: 66/ for test: gem_sync
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: sw_sync
results: parsing output: 69/ for test: kms_frontbuffer_tracking
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_plane_scaling
results: parsing output: 73/ for test: kms_cursor_edge_walk
results: parsing output: 74/ for test: kms_joiner
results: parsing output: 75/ for test: gen9_exec_parse
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: sw_sync
results: parsing output: 78/ for test: gem_render_copy
results: parsing output: 79/ for test: gem_exec_schedule
results: parsing output: 80/ for test: gem_exec_whisper
results: parsing output: 81/ for test: kms_ccs
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: core_setmaster
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: kms_sequence
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: syncobj_wait
results: parsing output: 89/ for test: syncobj_wait
results: parsing output: 90/ for test: kms_dsc
results: parsing output: 91/ for test: syncobj_wait
results: parsing output: 92/ for test: kms_content_protection
results: parsing output: 93/ for test: gem_exec_balancer
results: parsing output: 94/ for test: kms_ccs
results: parsing output: 95/ for test: i915_hangman
results: parsing output: 96/ for test: perf_pmu
results: parsing output: 97/ for test: gem_exec_parallel
results: parsing output: 98/ for test: kms_psr
results: parsing output: 99/ for test: sriov_basic
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: kms_prop_blob
results: parsing output: 102/ for test: gem_userptr_blits
results: parsing output: 103/ for test: perf
results: parsing output: 104/ for test: i915_query
results: parsing output: 105/ for test: kms_big_fb
results: parsing output: 106/ for test: kms_psr
results: parsing output: 107/ for test: prime_self_import
results: parsing output: 108/ for test: kms_big_fb
results: parsing output: 109/ for test: gem_exec_reloc
results: parsing output: 110/ for test: gem_ctx_shared
results: parsing output: 111/ for test: kms_plane_scaling
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_getfb
results: parsing output: 114/ for test: gem_ctx_persistence
results: parsing output: 115/ for test: i915_selftest
results: parsing output: 116/ for test: kms_pm_rpm
results: parsing output: 117/ for test: kms_cursor_crc
results: parsing output: 118/ for test: kms_cursor_crc
results: parsing output: 119/ for test: syncobj_wait
results: parsing output: 120/ for test: gem_mmap_gtt
results: parsing output: 121/ for test: syncobj_timeline
results: parsing output: 122/ for test: kms_chamelium_hpd
results: parsing output: 123/ for test: gem_exec_reloc
results: parsing output: 124/ for test: kms_flip
results: parsing output: 125/ for test: kms_psr
results: parsing output: 126/ for test: gem_readwrite
results: parsing output: 127/ for test: fbdev
results: parsing output: 128/ for test: kms_dp_aux_dev
results: parsing output: 129/ for test: kms_psr
results: parsing output: 130/ for test: gem_ctx_persistence
results: parsing output: 131/ for test: sysfs_heartbeat_interval
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.