[59.318194] Initializing watchdogs
[59.318241]   /dev/watchdog0
[59.331462] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[59.335661] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.337893] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.340889] [001/133] (960s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt)
[59.467397] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt
[63.956385] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (4.484s)
[65.166175] [002/133] (954s left) prime_busy (hang)
[65.231597] Starting subtest: hang
[65.234054] Starting dynamic subtest: rcs0
[91.449048] Dynamic subtest rcs0: SUCCESS (26.192s)
[91.458465] Starting dynamic subtest: bcs0
[98.594949] Dynamic subtest bcs0: SUCCESS (7.157s)
[98.601853] Starting dynamic subtest: vcs0
[105.571743] Dynamic subtest vcs0: SUCCESS (6.976s)
[105.578670] Starting dynamic subtest: vcs1
[112.556259] Dynamic subtest vcs1: SUCCESS (6.973s)
[112.565096] Starting dynamic subtest: vecs0
[119.580361] Dynamic subtest vecs0: SUCCESS (7.034s)
[119.587132] Starting dynamic subtest: ccs0
[133.420404] Dynamic subtest ccs0: SUCCESS (13.839s)
[133.423110] Subtest hang: SUCCESS (68.175s)
[133.526191] [003/133] (886s left) gem_exec_store (basic)
[133.587158] Starting subtest: basic
[133.684921] Subtest basic: SUCCESS (0.099s)
[133.864110] [004/133] (886s left) syncobj_timeline (invalid-query-one-illegal-handle)
[133.919913] Starting subtest: invalid-query-one-illegal-handle
[133.922470] Subtest invalid-query-one-illegal-handle: SUCCESS (0.000s)
[134.035009] [005/133] (885s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-blt)
[134.144256] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-blt
[134.148875] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s)
[134.238297] [006/133] (885s left) i915_drm_fdinfo (busy-idle)
[134.276652] Starting subtest: busy-idle
[134.278626] Starting dynamic subtest: rcs0
[134.309925] Dynamic subtest rcs0: SKIP (0.031s)
[134.319732] Starting dynamic subtest: bcs0
[134.323849] Dynamic subtest bcs0: SKIP (0.001s)
[134.331128] Starting dynamic subtest: vcs0
[134.335500] Dynamic subtest vcs0: SKIP (0.000s)
[134.342262] Starting dynamic subtest: vcs1
[134.346334] Dynamic subtest vcs1: SKIP (0.000s)
[134.353106] Starting dynamic subtest: vecs0
[134.357113] Dynamic subtest vecs0: SKIP (0.000s)
[134.364040] Starting dynamic subtest: ccs0
[134.368135] Dynamic subtest ccs0: SKIP (0.000s)
[134.372196] Subtest busy-idle: SKIP (0.035s)
[134.407660] [007/133] (885s left) kms_draw_crc (draw-method-blt)
[134.498288] Starting subtest: draw-method-blt
[134.500282] Starting dynamic subtest: xrgb8888-untiled
[134.739930] Dynamic subtest xrgb8888-untiled: SUCCESS (0.244s)
[134.748861] Starting dynamic subtest: rgb565-untiled
[134.939422] Dynamic subtest rgb565-untiled: SUCCESS (0.199s)
[134.946937] Starting dynamic subtest: xrgb2101010-untiled
[135.151625] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.211s)
[135.162412] Starting dynamic subtest: xbgr16161616f-untiled
[135.362540] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.210s)
[135.370820] Starting dynamic subtest: xrgb8888-xtiled
[135.484420] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.122s)
[135.493536] Starting dynamic subtest: rgb565-xtiled
[135.606343] Dynamic subtest rgb565-xtiled: SUCCESS (0.121s)
[135.614716] Starting dynamic subtest: xrgb2101010-xtiled
[135.717470] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.110s)
[135.729486] Starting dynamic subtest: xbgr16161616f-xtiled
[135.840487] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.121s)
[135.846933] Starting dynamic subtest: xrgb8888-4tiled
[135.950636] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.110s)
[135.958475] Starting dynamic subtest: rgb565-4tiled
[136.061860] Dynamic subtest rgb565-4tiled: SUCCESS (0.111s)
[136.070454] Starting dynamic subtest: xrgb2101010-4tiled
[136.175484] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.111s)
[136.185298] Starting dynamic subtest: xbgr16161616f-4tiled
[136.272852] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.100s)
[136.274781] Subtest draw-method-blt: SUCCESS (1.778s)
[136.377430] [008/133] (883s left) gem_mmap_gtt (cpuset-medium-copy-odd)
[136.421992] Subtest cpuset-medium-copy-odd: SKIP (0.000s)
[136.479186] [009/133] (883s left) perf (polling)
[136.601530] Starting subtest: polling
[136.603368] Starting dynamic subtest: 0-rcs0
[146.684103] Dynamic subtest 0-rcs0: SUCCESS (10.030s)
[146.693089] Starting dynamic subtest: 1-vecs0
[156.707793] Dynamic subtest 1-vecs0: SUCCESS (10.023s)
[156.710846] Subtest polling: SUCCESS (20.053s)
[156.746301] [010/133] (863s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc)
[156.849150] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc
[156.851618] Starting dynamic subtest: pipe-A-eDP-1
[156.911753] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[156.920635] Starting dynamic subtest: pipe-B-eDP-1
[156.977208] Dynamic subtest pipe-B-eDP-1: SKIP (0.002s)
[156.987924] Starting dynamic subtest: pipe-C-eDP-1
[157.045152] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[157.053194] Starting dynamic subtest: pipe-D-eDP-1
[157.109468] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[157.113619] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.008s)
[159.023115] [011/133] (861s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-onoff)
[159.125820] Starting subtest: fbc-2p-scndscrn-spr-indfb-onoff
[159.130037] Subtest fbc-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[159.228965] [012/133] (861s left) kms_big_fb (yf-tiled-addfb-size-offset-overflow)
[159.337397] Starting subtest: yf-tiled-addfb-size-offset-overflow
[159.341294] Subtest yf-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[159.415683] [013/133] (860s left) kms_plane (pixel-format-y-tiled-ccs-modifier)
[159.499123] Starting subtest: pixel-format-y-tiled-ccs-modifier
[159.503623] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.000s)
[159.566708] [014/133] (860s left) kms_big_fb (linear-addfb)
[159.680493] Starting subtest: linear-addfb
[159.682477] Subtest linear-addfb: SUCCESS (0.000s)
[159.772098] [015/133] (860s left) kms_psr (psr-dpms)
[159.853613] Starting subtest: psr-dpms
[159.855882] Starting dynamic subtest: eDP-1
[162.868073] Dynamic subtest eDP-1: SUCCESS (3.013s)
[162.870511] Subtest psr-dpms: SUCCESS (3.014s)
[163.721812] [016/133] (856s left) kms_psr (psr-cursor-mmap-cpu)
[163.813998] Starting subtest: psr-cursor-mmap-cpu
[163.816395] Starting dynamic subtest: eDP-1
[165.525731] Dynamic subtest eDP-1: SUCCESS (1.711s)
[165.527801] Subtest psr-cursor-mmap-cpu: SUCCESS (1.712s)
[166.390972] [017/133] (854s left) i915_query (query-topology-kernel-writes)
[166.451866] Starting subtest: query-topology-kernel-writes
[166.453859] Subtest query-topology-kernel-writes: SUCCESS (0.000s)
[166.545908] [018/133] (853s left) gem_exec_reloc (basic-wc-cpu-active)
[166.595986] Subtest basic-wc-cpu-active: SKIP (0.000s)
[166.680571] [019/133] (853s left) gem_lmem_swapping (heavy-random)
[166.720850] Subtest heavy-random: SKIP (0.000s)
[166.762530] [020/133] (853s left) gem_mmap_gtt (zero-extend)
[166.814572] Subtest zero-extend: SKIP (0.000s)
[166.874077] [021/133] (853s left) kms_psr (fbc-psr2-suspend)
[166.963618] Starting subtest: fbc-psr2-suspend
[166.965926] Starting dynamic subtest: eDP-1
[166.970419] Dynamic subtest eDP-1: SKIP (0.000s)
[166.974895] Subtest fbc-psr2-suspend: SKIP (0.000s)
[167.031091] [022/133] (853s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-cpu)
[167.136097] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-cpu
[171.071221] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (3.939s)
[172.202077] [023/133] (848s left) kms_ccs (crc-primary-basic-4-tiled-lnl-ccs)
[172.294800] Starting subtest: crc-primary-basic-4-tiled-lnl-ccs
[172.300352] Subtest crc-primary-basic-4-tiled-lnl-ccs: SKIP (0.000s)
[173.414020] [024/133] (847s left) gem_bad_reloc (negative-reloc-lut)
[173.485270] Subtest negative-reloc-lut: SKIP (0.000s)
[173.568029] [025/133] (847s left) kms_flip (2x-flip-vs-dpms)
[173.664958] Starting subtest: 2x-flip-vs-dpms
[173.672861] Subtest 2x-flip-vs-dpms: SKIP (0.010s)
[173.797276] [026/133] (846s left) kms_async_flips (async-flip-with-page-flip-events-linear-atomic)
[173.898057] Starting subtest: async-flip-with-page-flip-events-linear-atomic
[174.269843] Starting dynamic subtest: pipe-A-eDP-1
[177.056318] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.733s)
[177.365107] Starting dynamic subtest: pipe-B-eDP-1
[180.191713] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.780s)
[180.514700] Starting dynamic subtest: pipe-C-eDP-1
[183.323323] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.762s)
[183.634876] Starting dynamic subtest: pipe-D-eDP-1
[186.454161] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.775s)
[186.456286] Subtest async-flip-with-page-flip-events-linear-atomic: SUCCESS (12.505s)
[187.586316] [027/133] (833s left) kms_plane (planar-pixel-format-settings)
[187.688212] Starting subtest: planar-pixel-format-settings
[187.752792] Subtest planar-pixel-format-settings: SUCCESS (0.064s)
[187.869895] [028/133] (832s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-sf)
[187.973733] Starting subtest: psr2-cursor-plane-move-continuous-exceed-sf
[187.976082] Starting dynamic subtest: pipe-A-eDP-1
[198.647386] Dynamic subtest pipe-A-eDP-1: SUCCESS (10.681s)
[198.655353] Starting dynamic subtest: pipe-B-eDP-1
[210.105243] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.456s)
[210.107463] Subtest psr2-cursor-plane-move-continuous-exceed-sf: SUCCESS (22.140s)
[210.957549] [029/133] (809s left) i915_hangman (error-state-basic)
[211.038269] Starting subtest: error-state-basic
[211.165319] Subtest error-state-basic: SUCCESS (0.129s)
[211.242791] [030/133] (809s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[211.340303] Starting subtest: 4-tiled-16bpp-rotate-0
[212.673442] Subtest 4-tiled-16bpp-rotate-0: SUCCESS (1.333s)
[212.782644] [031/133] (808s left) gem_render_copy (y-tiled-ccs-to-yf-tiled)
[212.846063] Starting subtest: y-tiled-ccs-to-yf-tiled
[212.849895] Subtest y-tiled-ccs-to-yf-tiled: SKIP (0.000s)
[213.039964] [032/133] (807s left) gem_exec_parallel (engines)
[213.095392] Starting subtest: engines
[213.097709] Starting dynamic subtest: basic
[214.933093] Dynamic subtest basic: SUCCESS (1.836s)
[214.944082] Starting dynamic subtest: contexts
[219.303779] Dynamic subtest contexts: SUCCESS (4.369s)
[219.315336] Starting dynamic subtest: fds
[223.105672] Dynamic subtest fds: SUCCESS (3.802s)
[223.116487] Starting dynamic subtest: userptr
[224.917113] Dynamic subtest userptr: SUCCESS (1.809s)
[224.919566] Subtest engines: SUCCESS (11.821s)
[225.101986] [033/133] (795s left) gem_exec_balancer (waits)
[225.162705] Starting subtest: waits
[231.641103] Subtest waits: SUCCESS (6.476s)
[231.944230] [034/133] (789s left) kms_chamelium_edid (hdmi-mode-timings)
[232.316956] Subtest hdmi-mode-timings: SKIP (0.000s)
[233.160848] [035/133] (787s left) vgem_basic (dmabuf-mmap)
[233.300730] Starting subtest: dmabuf-mmap
[233.306797] Subtest dmabuf-mmap: SUCCESS (0.009s)
[233.361131] [FACT vgem_basic (dmabuf-mmap)] new: kernel.kmod_is_loaded.vgem: true
[233.364232] [036/133] (787s left) kms_pm_rpm (modeset-pc8-residency-stress)
[235.087817] Starting subtest: modeset-pc8-residency-stress
[235.093357] Subtest modeset-pc8-residency-stress: SKIP (0.000s)
[235.618918] [037/133] (785s left) kms_big_fb (y-tiled-64bpp-rotate-90)
[235.723695] Starting subtest: y-tiled-64bpp-rotate-90
[235.727791] Subtest y-tiled-64bpp-rotate-90: SKIP (0.000s)
[235.822669] [038/133] (785s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[235.936484] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[235.940601] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[236.034198] [039/133] (785s left) i915_suspend (basic-s3-without-i915)
[236.064935] Starting subtest: basic-s3-without-i915
[239.299740] Subtest basic-s3-without-i915: SKIP (3.229s)
[240.858106] [040/133] (780s left) gem_ctx_param (get-priority-new-ctx)
[240.929169] Starting subtest: get-priority-new-ctx
[240.931467] Subtest get-priority-new-ctx: SUCCESS (0.002s)
[241.026792] [041/133] (780s left) gem_exec_fence (syncobj-channel)
[241.443932] Starting subtest: syncobj-channel
[242.462953] Subtest syncobj-channel: SUCCESS (1.018s)
[242.995469] [042/133] (778s left) gem_exec_params (rel-constants-invalid-ring)
[243.057801] Starting subtest: rel-constants-invalid-ring
[243.060441] Subtest rel-constants-invalid-ring: SUCCESS (0.000s)
[243.153800] [043/133] (778s left) prime_mmap (test_invalid_sync_flags)
[243.213268] Starting subtest: test_invalid_sync_flags
[243.215505] Starting dynamic subtest: test_invalid_sync_flags-smem
[243.217703] Dynamic subtest test_invalid_sync_flags-smem: SUCCESS (0.000s)
[243.219888] Subtest test_invalid_sync_flags: SUCCESS (0.000s)
[243.310471] [044/133] (778s left) kms_psr (fbc-pr-sprite-mmap-gtt)
[243.397998] Starting subtest: fbc-pr-sprite-mmap-gtt
[243.402361] Subtest fbc-pr-sprite-mmap-gtt: SKIP (0.000s)
[243.482052] [045/133] (778s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[243.576145] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[243.580128] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[243.671542] [046/133] (777s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode)
[244.048761] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s)
[244.855372] [047/133] (776s left) kms_cursor_legacy (cursorb-vs-flipa-legacy)
[244.976557] Starting subtest: cursorB-vs-flipA-legacy
[244.981349] Subtest cursorB-vs-flipA-legacy: SKIP (0.001s)
[245.126085] [048/133] (776s left) kms_panel_fitting (legacy)
[245.211796] Starting subtest: legacy
[245.214184] Starting dynamic subtest: pipe-A-eDP-1
[245.767380] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.557s)
[245.792409] Starting dynamic subtest: pipe-B-eDP-1
[247.318334] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.531s)
[247.346224] Starting dynamic subtest: pipe-C-eDP-1
[248.837118] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.498s)
[248.862765] Starting dynamic subtest: pipe-D-eDP-1
[250.381784] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.525s)
[250.384101] Subtest legacy: SUCCESS (5.171s)
[251.613899] [049/133] (770s left) kms_flip (wf_vblank-ts-check)
[251.712459] Starting subtest: wf_vblank-ts-check
[251.714894] Starting dynamic subtest: A-eDP1
[260.692281] Dynamic subtest A-eDP1: SUCCESS (8.945s)
[260.700121] Starting dynamic subtest: B-eDP1
[269.622194] Dynamic subtest B-eDP1: SUCCESS (8.929s)
[269.630739] Starting dynamic subtest: C-eDP1
[278.549863] Dynamic subtest C-eDP1: SUCCESS (8.915s)
[278.557897] Starting dynamic subtest: D-eDP1
[287.480640] Dynamic subtest D-eDP1: SUCCESS (8.927s)
[287.482676] Subtest wf_vblank-ts-check: SUCCESS (35.724s)
[288.656275] [050/133] (733s left) kms_plane_scaling (planes-upscale-20x20)
[288.763236] Starting subtest: planes-upscale-20x20
[288.765446] Starting dynamic subtest: pipe-A
[288.827523] Dynamic subtest pipe-A: SUCCESS (0.064s)
[288.837437] Starting dynamic subtest: pipe-B
[289.987648] Dynamic subtest pipe-B: SUCCESS (1.159s)
[289.997271] Starting dynamic subtest: pipe-C
[291.101471] Dynamic subtest pipe-C: SUCCESS (1.112s)
[291.110037] Starting dynamic subtest: pipe-D
[292.226189] Dynamic subtest pipe-D: SUCCESS (1.124s)
[292.228323] Subtest planes-upscale-20x20: SUCCESS (3.464s)
[293.408556] [051/133] (728s left) core_debugfs (read-all-entries)
[293.465434] Starting subtest: read-all-entries
[293.563497] Subtest read-all-entries: SUCCESS (0.098s)
[293.626986] [052/133] (728s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted)
[293.679045] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted
[293.785085] Subtest etime-multi-wait-all-for-submit-unsubmitted: SUCCESS (0.105s)
[293.859341] [053/133] (727s left) kms_flip (2x-flip-vs-expired-vblank)
[293.953228] Starting subtest: 2x-flip-vs-expired-vblank
[293.963721] Subtest 2x-flip-vs-expired-vblank: SKIP (0.010s)
[294.041605] [054/133] (727s left) kms_hdr (static-toggle)
[294.125435] Starting subtest: static-toggle
[294.132059] Subtest static-toggle: SKIP (0.000s)
[294.196591] [055/133] (727s left) gem_exec_reloc (basic-cpu-gtt)
[294.267184] Subtest basic-cpu-gtt: SKIP (0.000s)
[294.337633] [056/133] (727s left) gem_softpin (evict-prime-sanity-check)
[294.398073] Starting subtest: evict-prime-sanity-check
[294.400475] Starting dynamic subtest: rcs0
[295.564778] Dynamic subtest rcs0: SUCCESS (1.166s)
[295.573893] Starting dynamic subtest: bcs0
[296.686097] Dynamic subtest bcs0: SUCCESS (1.119s)
[296.696626] Starting dynamic subtest: vcs0
[297.858195] Dynamic subtest vcs0: SUCCESS (1.168s)
[297.868673] Starting dynamic subtest: vcs1
[299.850750] Dynamic subtest vcs1: SUCCESS (1.989s)
[299.867634] Starting dynamic subtest: vecs0
[301.903434] Dynamic subtest vecs0: SUCCESS (2.049s)
[301.920187] Starting dynamic subtest: ccs0
[303.039592] Dynamic subtest ccs0: SUCCESS (1.135s)
[303.055520] Starting dynamic subtest: all
[304.161108] Dynamic subtest all: SUCCESS (1.119s)
[304.163547] Subtest evict-prime-sanity-check: SUCCESS (9.764s)
[304.244491] [057/133] (717s left) kms_frontbuffer_tracking (psr-2p-pri-indfb-multidraw)
[304.348165] Starting subtest: psr-2p-pri-indfb-multidraw
[304.353281] Subtest psr-2p-pri-indfb-multidraw: SKIP (0.000s)
[304.468551] [058/133] (717s left) gem_exec_flush (basic-wb-rw-default)
[304.526657] Starting subtest: basic-wb-rw-default
[310.017536] Subtest basic-wb-rw-default: SUCCESS (5.462s)
[310.179220] [059/133] (711s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping)
[310.281046] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping
[310.285394] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s)
[310.366073] [060/133] (711s left) gem_pwrite (basic-exhaustion)
[310.419812] Subtest basic-exhaustion: SKIP (0.000s)
[310.482600] [061/133] (711s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[310.575791] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu
[317.304043] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (6.731s)
[317.429496] [062/133] (704s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[317.520912] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-gtt
[317.525310] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[317.611897] [063/133] (704s left) kms_pm_dc (dc5-psr)
[318.715420] Starting subtest: dc5-psr
[321.609551] Subtest dc5-psr: SUCCESS (2.894s)
[322.448900] [064/133] (699s left) prime_vgem (basic-fence-flip)
[322.519306] Starting subtest: basic-fence-flip
[322.839355] Subtest basic-fence-flip: SUCCESS (0.319s)
[322.955226] [065/133] (699s left) kms_color (ctm-max)
[323.048397] Starting subtest: ctm-max
[323.050286] Starting dynamic subtest: pipe-A-eDP-1
[323.756212] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.710s)
[323.764845] Starting dynamic subtest: pipe-B-eDP-1
[325.169532] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.412s)
[325.178051] Starting dynamic subtest: pipe-C-eDP-1
[326.546069] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.375s)
[326.554096] Starting dynamic subtest: pipe-D-eDP-1
[327.857521] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.311s)
[327.859854] Subtest ctm-max: SUCCESS (4.812s)
[328.660908] [066/133] (693s left) kms_ccs (crc-primary-rotation-180-y-tiled-ccs)
[328.768268] Starting subtest: crc-primary-rotation-180-y-tiled-ccs
[328.770512] Starting dynamic subtest: pipe-A-eDP-1
[328.793526] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[328.804181] Starting dynamic subtest: pipe-B-eDP-1
[328.826357] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[328.836027] Starting dynamic subtest: pipe-C-eDP-1
[328.857845] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[328.866501] Starting dynamic subtest: pipe-D-eDP-1
[328.888221] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[328.892582] Subtest crc-primary-rotation-180-y-tiled-ccs: SKIP (0.006s)
[331.013646] [067/133] (691s left) kms_psr (pr-sprite-blt)
[331.109103] Starting subtest: pr-sprite-blt
[331.113525] Subtest pr-sprite-blt: SKIP (0.000s)
[331.179502] [068/133] (691s left) kms_flip (2x-wf_vblank-ts-check)
[331.280219] Starting subtest: 2x-wf_vblank-ts-check
[331.288411] Subtest 2x-wf_vblank-ts-check: SKIP (0.010s)
[331.367315] [069/133] (691s left) kms_vblank (wait-idle-hang)
[331.459190] Starting subtest: wait-idle-hang
[331.461382] Starting dynamic subtest: pipe-A-eDP-1
[357.660465] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.199s)
[357.673128] Starting dynamic subtest: pipe-D-eDP-1
[382.680181] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.017s)
[382.682560] Subtest wait-idle-hang: SUCCESS (51.220s)
[383.489025] [070/133] (639s left) core_sysfs (read-all-entries)
[383.558597] Starting subtest: read-all-entries
[383.563959] Subtest read-all-entries: SUCCESS (0.004s)
[383.662069] [071/133] (638s left) kms_busy (extended-modeset-hang-newfb-with-reset)
[383.775477] Starting subtest: extended-modeset-hang-newfb-with-reset
[383.777297] Starting dynamic subtest: pipe-A
[398.810720] Dynamic subtest pipe-A: SUCCESS (15.033s)
[398.819758] Starting dynamic subtest: pipe-D
[413.879057] Dynamic subtest pipe-D: SUCCESS (15.065s)
[413.881428] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (30.102s)
[414.689431] [072/133] (607s left) gem_userptr_blits (sd-probe)
[414.760064] Starting subtest: sd-probe
[414.762461] Subtest sd-probe: SUCCESS (0.000s)
[414.874618] [073/133] (607s left) gem_softpin (evict-active-interruptible)
[414.937651] Starting subtest: evict-active-interruptible
[414.944704] Subtest evict-active-interruptible: SUCCESS (0.007s)
[415.064588] [074/133] (607s left) gem_compute (compute-square)
[415.109242] Starting subtest: compute-square
[415.113691] Subtest compute-square: SUCCESS (0.007s)
[415.229769] [075/133] (607s left) gem_userptr_blits (unsync-unmap)
[415.291345] Subtest unsync-unmap: SKIP (0.000s)
[415.431031] [076/133] (607s left) gem_exec_schedule (semaphore-noskip)
[415.503454] Starting subtest: semaphore-noskip
[415.907955] Subtest semaphore-noskip: SUCCESS (0.411s)
[416.285965] [077/133] (606s left) gem_close (many-handles-one-vma)
[416.355117] Starting subtest: many-handles-one-vma
[416.374015] Subtest many-handles-one-vma: SUCCESS (0.019s)
[416.483593] [078/133] (606s left) gem_exec_reloc (basic-cpu)
[416.551461] Subtest basic-cpu: SKIP (0.000s)
[416.627229] [079/133] (606s left) gem_ctx_shared (q-smoketest)
[416.693488] Starting subtest: Q-smoketest
[416.695856] Starting dynamic subtest: rcs0
[422.285348] Dynamic subtest rcs0: SUCCESS (5.488s)
[422.294727] Starting dynamic subtest: bcs0
[427.775514] Dynamic subtest bcs0: SUCCESS (5.488s)
[427.785473] Starting dynamic subtest: vcs0
[433.256932] Dynamic subtest vcs0: SUCCESS (5.480s)
[433.269396] Starting dynamic subtest: vcs1
[438.745066] Dynamic subtest vcs1: SUCCESS (5.483s)
[438.756238] Starting dynamic subtest: vecs0
[444.246539] Dynamic subtest vecs0: SUCCESS (5.504s)
[444.256484] Starting dynamic subtest: ccs0
[449.732042] Dynamic subtest ccs0: SUCCESS (5.485s)
[449.734550] Subtest Q-smoketest: SUCCESS (32.936s)
[449.820746] [080/133] (573s left) kms_frontbuffer_tracking (fbcpsr-stridechange)
[449.911502] Starting subtest: fbcpsr-stridechange
[456.096464] Subtest fbcpsr-stridechange: SUCCESS (6.187s)
[456.230031] [081/133] (566s left) gem_exec_reloc (basic-cpu-wc-active)
[456.312151] Subtest basic-cpu-wc-active: SKIP (0.000s)
[456.394339] [082/133] (566s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt)
[456.487677] Starting subtest: psr-rgb565-draw-mmap-gtt
[456.492171] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[456.582287] [083/133] (566s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[456.679045] Starting subtest: flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[456.683178] Subtest flip-64bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[456.748711] [084/133] (566s left) gem_exec_balancer (individual)
[456.809022] Starting subtest: individual
[458.902382] Subtest individual: SUCCESS (2.094s)
[459.240420] [085/133] (563s left) kms_big_fb (yf-tiled-16bpp-rotate-90)
[459.360482] Starting subtest: yf-tiled-16bpp-rotate-90
[459.364840] Subtest yf-tiled-16bpp-rotate-90: SKIP (0.000s)
[459.466377] [086/133] (563s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[459.555266] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[459.559586] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.000s)
[459.637919] [087/133] (563s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-wc)
[459.731439] Starting subtest: fbcpsr-rgb101010-draw-mmap-wc
[466.444890] Subtest fbcpsr-rgb101010-draw-mmap-wc: SUCCESS (6.716s)
[466.559807] [088/133] (556s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs-cc)
[466.654328] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs-cc
[466.656567] Starting dynamic subtest: pipe-A-eDP-1
[466.678891] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[466.687933] Starting dynamic subtest: pipe-B-eDP-1
[466.709321] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[466.717691] Starting dynamic subtest: pipe-C-eDP-1
[466.739169] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[466.747235] Starting dynamic subtest: pipe-D-eDP-1
[466.768832] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[466.773167] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[468.923821] [089/133] (554s left) api_intel_allocator (fork-simple-stress)
[468.985651] Starting subtest: fork-simple-stress
[474.441606] Subtest fork-simple-stress: SUCCESS (5.405s)
[474.518106] [090/133] (548s left) kms_psr (fbc-pr-cursor-plane-move)
[474.630275] Starting subtest: fbc-pr-cursor-plane-move
[474.634895] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s)
[474.704503] [091/133] (548s left) kms_cursor_legacy (2x-long-flip-vs-cursor-legacy)
[474.834748] Starting subtest: 2x-long-flip-vs-cursor-legacy
[474.839268] Subtest 2x-long-flip-vs-cursor-legacy: SKIP (0.001s)
[474.982759] [092/133] (548s left) syncobj_timeline (single-wait-available-signaled)
[475.044352] Starting subtest: single-wait-available-signaled
[475.046791] Subtest single-wait-available-signaled: SUCCESS (0.001s)
[475.174404] [093/133] (548s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-render)
[475.284056] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-render
[475.288106] Subtest fbc-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[475.402122] [094/133] (548s left) kms_content_protection (legacy-hdcp14)
[475.555636] Starting subtest: legacy-hdcp14
[475.559121] Subtest legacy-hdcp14: SKIP (0.000s)
[475.688090] [095/133] (547s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[475.800999] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-hflip
[476.883501] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-hflip: SUCCESS (1.082s)
[477.020635] [096/133] (546s left) gem_exec_schedule (noreorder-priority)
[477.210923] Starting subtest: noreorder-priority
[477.213515] Starting dynamic subtest: rcs0
[478.346774] Dynamic subtest rcs0: SUCCESS (1.135s)
[478.356439] Starting dynamic subtest: vcs0
[479.895085] Dynamic subtest vcs0: SUCCESS (1.545s)
[479.907686] Starting dynamic subtest: vcs1
[481.870123] Dynamic subtest vcs1: SUCCESS (1.973s)
[481.881474] Starting dynamic subtest: vecs0
[483.920236] Dynamic subtest vecs0: SUCCESS (2.047s)
[483.931485] Starting dynamic subtest: ccs0
[485.071815] Dynamic subtest ccs0: SUCCESS (1.150s)
[485.074250] Subtest noreorder-priority: SUCCESS (7.862s)
[485.261292] [097/133] (538s left) kms_force_connector_basic (force-connector-state)
[485.353851] Starting subtest: force-connector-state
[485.969019] Subtest force-connector-state: SUCCESS (0.618s)
[486.867265] [098/133] (536s left) kms_cdclk (mode-transition)
[486.967303] Starting subtest: mode-transition
[486.969653] Starting dynamic subtest: pipe-A-eDP-1
[487.261410] Dynamic subtest pipe-A-eDP-1: SKIP (0.292s)
[487.270982] Starting dynamic subtest: pipe-B-eDP-1
[487.275826] Dynamic subtest pipe-B-eDP-1: SKIP (0.004s)
[487.284466] Starting dynamic subtest: pipe-C-eDP-1
[487.289221] Dynamic subtest pipe-C-eDP-1: SKIP (0.004s)
[487.301579] Starting dynamic subtest: pipe-D-eDP-1
[487.306542] Dynamic subtest pipe-D-eDP-1: SKIP (0.004s)
[487.311306] Subtest mode-transition: SKIP (0.314s)
[488.055975] [099/133] (535s left) gem_ctx_param (invalid-size-get)
[488.106946] Starting subtest: invalid-size-get
[488.109882] Subtest invalid-size-get: SUCCESS (0.001s)
[488.212267] [100/133] (535s left) syncobj_timeline (reset-signaled)
[488.282197] Starting subtest: reset-signaled
[488.284617] Subtest reset-signaled: SUCCESS (0.000s)
[488.402231] [101/133] (535s left) syncobj_timeline (etime-single-wait-submitted)
[488.460922] Starting subtest: etime-single-wait-submitted
[488.569091] Subtest etime-single-wait-submitted: SUCCESS (0.109s)
[488.653463] [102/133] (535s left) i915_pm_rc6_residency (media-rc6-accuracy)
[488.715686] Starting subtest: media-rc6-accuracy
[488.720523] Subtest media-rc6-accuracy: SKIP (0.000s)
[488.812280] [103/133] (535s left) gen9_exec_parse (allowed-single)
[488.869934] Subtest allowed-single: SKIP (0.000s)
[488.952488] [104/133] (535s left) sysfs_heartbeat_interval (idempotent)
[489.016716] Starting subtest: idempotent
[489.019161] Starting dynamic subtest: vecs0
[489.021501] Dynamic subtest vecs0: SUCCESS (0.001s)
[489.032320] Starting dynamic subtest: ccs0
[489.034589] Dynamic subtest ccs0: SUCCESS (0.001s)
[489.043630] Starting dynamic subtest: vcs0
[489.045850] Dynamic subtest vcs0: SUCCESS (0.000s)
[489.054325] Starting dynamic subtest: bcs0
[489.056527] Dynamic subtest bcs0: SUCCESS (0.001s)
[489.065685] Starting dynamic subtest: rcs0
[489.067906] Dynamic subtest rcs0: SUCCESS (0.001s)
[489.078643] Starting dynamic subtest: vcs1
[489.080732] Dynamic subtest vcs1: SUCCESS (0.000s)
[489.082852] Subtest idempotent: SUCCESS (0.008s)
[489.120477] [105/133] (534s left) kms_frontbuffer_tracking (fbc-2p-pri-indfb-multidraw)
[489.209618] Starting subtest: fbc-2p-pri-indfb-multidraw
[489.213711] Subtest fbc-2p-pri-indfb-multidraw: SKIP (0.000s)
[489.316728] [106/133] (534s left) gem_ctx_isolation (dirty-switch)
[489.383665] Starting subtest: dirty-switch
[489.385964] Starting dynamic subtest: rcs0
[489.572993] Dynamic subtest rcs0: SUCCESS (0.189s)
[489.585547] Starting dynamic subtest: bcs0
[489.791435] Dynamic subtest bcs0: SUCCESS (0.218s)
[489.800943] Starting dynamic subtest: vcs0
[490.013788] Dynamic subtest vcs0: SUCCESS (0.221s)
[490.022150] Starting dynamic subtest: vcs1
[492.124432] Dynamic subtest vcs1: SUCCESS (2.109s)
[492.134804] Starting dynamic subtest: vecs0
[494.108774] Dynamic subtest vecs0: SUCCESS (1.983s)
[494.121543] Starting dynamic subtest: ccs0
[496.116331] Dynamic subtest ccs0: SUCCESS (2.006s)
[496.118859] Subtest dirty-switch: SUCCESS (6.733s)
[496.360677] [107/133] (527s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted)
[496.423690] Starting subtest: invalid-multi-wait-unsubmitted-submitted
[496.426162] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s)
[496.548667] [108/133] (527s left) gem_ctx_persistence (legacy-engines-cleanup)
[496.604546] Starting subtest: legacy-engines-cleanup
[496.606981] Starting dynamic subtest: render
[496.649457] Dynamic subtest render: SUCCESS (0.044s)
[496.660547] Starting dynamic subtest: bsd1
[496.709748] Dynamic subtest bsd1: SUCCESS (0.059s)
[496.721319] Starting dynamic subtest: bsd2
[496.743513] Dynamic subtest bsd2: SUCCESS (0.032s)
[496.755617] Starting dynamic subtest: blt
[496.784578] Dynamic subtest blt: SUCCESS (0.040s)
[496.794559] Starting dynamic subtest: vebox
[496.822443] Dynamic subtest vebox: SUCCESS (0.036s)
[496.824727] Subtest legacy-engines-cleanup: SUCCESS (0.218s)
[496.901441] [109/133] (527s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-pwrite)
[497.009329] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-pwrite
[497.013748] Subtest fbc-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[497.100154] [110/133] (527s left) kms_pipe_crc_basic (nonblocking-crc)
[497.200293] Starting subtest: nonblocking-crc
[497.202624] Starting dynamic subtest: pipe-A-eDP-1
[497.947463] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.745s)
[497.957533] Starting dynamic subtest: pipe-B-eDP-1
[499.317464] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.370s)
[499.331080] Starting dynamic subtest: pipe-C-eDP-1
[500.681478] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.362s)
[500.691442] Starting dynamic subtest: pipe-D-eDP-1
[502.076138] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.393s)
[502.078282] Subtest nonblocking-crc: SUCCESS (4.876s)
[502.949627] [111/133] (521s left) kms_joiner (switch-modeset-ultra-joiner-big-joiner)
[503.050706] Starting subtest: switch-modeset-ultra-joiner-big-joiner
[503.054596] Subtest switch-modeset-ultra-joiner-big-joiner: SKIP (0.000s)
[503.115751] [112/133] (521s left) kms_sequence (get-forked-busy)
[503.204133] Starting subtest: get-forked-busy
[503.205984] Starting dynamic subtest: pipe-A-eDP-1
[505.140144] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.933s)
[505.150487] Starting dynamic subtest: pipe-B-eDP-1
[507.722627] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.582s)
[507.732421] Starting dynamic subtest: pipe-C-eDP-1
[510.304111] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.580s)
[510.313521] Starting dynamic subtest: pipe-D-eDP-1
[512.904013] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.599s)
[512.906209] Subtest get-forked-busy: SUCCESS (9.702s)
[513.741877] [113/133] (510s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc)
[513.843819] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc
[513.847993] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[513.941073] [114/133] (510s left) gem_userptr_blits (relocations)
[514.019142] Starting subtest: relocations
[514.023369] Subtest relocations: SKIP (0.000s)
[514.156820] [115/133] (510s left) gem_exec_params (cliprects-invalid)
[514.212028] Starting subtest: cliprects-invalid
[514.214725] Subtest cliprects-invalid: SUCCESS (0.000s)
[514.320492] [116/133] (510s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-plflip-blt)
[514.438693] Starting subtest: fbcpsr-1p-primscrn-indfb-plflip-blt
[521.763427] Subtest fbcpsr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.326s)
[521.887261] [117/133] (502s left) perf (gen12-group-exclusive-stream-sample-oa)
[522.014884] Starting subtest: gen12-group-exclusive-stream-sample-oa
[522.037065] Subtest gen12-group-exclusive-stream-sample-oa: SUCCESS (0.021s)
[522.088485] [118/133] (502s left) kms_cursor_legacy (cursorb-vs-flipb-atomic-transitions-varying-size)
[522.202046] Starting subtest: cursorB-vs-flipB-atomic-transitions-varying-size
[522.206277] Subtest cursorB-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s)
[522.347944] [119/133] (502s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180)
[522.439986] Starting subtest: linear-max-hw-stride-64bpp-rotate-180
[523.455479] Subtest linear-max-hw-stride-64bpp-rotate-180: SUCCESS (1.016s)
[523.579265] [120/133] (501s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area)
[523.680156] Starting subtest: fbc-pr-overlay-plane-update-sf-dmg-area
[523.684077] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[523.749477] [121/133] (500s left) kms_addfb_basic (invalid-set-prop)
[523.799089] Starting subtest: invalid-set-prop
[523.800669] Subtest invalid-set-prop: SUCCESS (0.000s)
[523.926533] [122/133] (500s left) kms_cursor_crc (cursor-rapid-movement-128x42)
[524.174222] Starting subtest: cursor-rapid-movement-128x42
[524.226595] Subtest cursor-rapid-movement-128x42: SKIP (0.050s)
[524.429290] [123/133] (500s left) gem_softpin (softpin)
[524.481561] Starting subtest: softpin
[556.840267] Subtest softpin: SUCCESS (32.353s)
[556.976836] [124/133] (467s left) gem_mmap_gtt (coherency)
[557.045453] Subtest coherency: SKIP (0.000s)
[557.104690] [125/133] (467s left) kms_rotation_crc (primary-rotation-180)
[557.193497] Starting subtest: primary-rotation-180
[564.203903] Subtest primary-rotation-180: SUCCESS (7.012s)
[565.456848] [126/133] (459s left) kms_cursor_crc (cursor-sliding-32x10)
[565.619050] Starting subtest: cursor-sliding-32x10
[565.675264] Subtest cursor-sliding-32x10: SKIP (0.052s)
[565.971606] [127/133] (458s left) gem_create (create-invalid-size)
[566.042526] Starting subtest: create-invalid-size
[566.044711] Subtest create-invalid-size: SUCCESS (0.000s)
[566.227319] [128/133] (458s left) gem_pxp (reject-modify-context-protection-off-2)
[566.355654] Starting subtest: reject-modify-context-protection-off-2
[566.358257] Subtest reject-modify-context-protection-off-2: SUCCESS (0.002s)
[566.461303] [129/133] (458s left) kms_force_connector_basic (prune-stale-modes)
[566.534935] Starting subtest: prune-stale-modes
[566.977649] Subtest prune-stale-modes: SUCCESS (0.445s)
[567.124138] [130/133] (457s left) perf_pmu (render-node-busy-idle)
[567.190766] Starting subtest: render-node-busy-idle
[567.192695] Starting dynamic subtest: rcs0
[567.877170] Dynamic subtest rcs0: SUCCESS (0.685s)
[567.889382] Starting dynamic subtest: bcs0
[568.538876] Dynamic subtest bcs0: SUCCESS (0.659s)
[568.550890] Starting dynamic subtest: vcs0
[569.942234] Dynamic subtest vcs0: SUCCESS (1.399s)
[569.954886] Starting dynamic subtest: vcs1
[571.925575] Dynamic subtest vcs1: SUCCESS (1.980s)
[571.937880] Starting dynamic subtest: vecs0
[573.908959] Dynamic subtest vecs0: SUCCESS (1.981s)
[573.919088] Starting dynamic subtest: ccs0
[574.576191] Dynamic subtest ccs0: SUCCESS (0.666s)
[574.578672] Subtest render-node-busy-idle: SUCCESS (7.386s)
[574.657743] [131/133] (450s left) kms_cursor_crc (cursor-onscreen-32x32)
[574.800989] Starting subtest: cursor-onscreen-32x32
[574.849419] Subtest cursor-onscreen-32x32: SKIP (0.044s)
[575.145086] [132/133] (449s left) kms_debugfs (display-on-read-all)
[575.238112] Starting subtest: display-on-read-all
[575.400267] Subtest display-on-read-all: SUCCESS (0.164s)
[575.525554] [133/133] (449s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[575.624150] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[575.627408] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[575.715755] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: prime_busy
results: parsing output: 2/ for test: gem_exec_store
results: parsing output: 3/ for test: syncobj_timeline
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: i915_drm_fdinfo
results: parsing output: 6/ for test: kms_draw_crc
results: parsing output: 7/ for test: gem_mmap_gtt
results: parsing output: 8/ for test: perf
results: parsing output: 9/ for test: kms_ccs
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_big_fb
results: parsing output: 12/ for test: kms_plane
results: parsing output: 13/ for test: kms_big_fb
results: parsing output: 14/ for test: kms_psr
results: parsing output: 15/ for test: kms_psr
results: parsing output: 16/ for test: i915_query
results: parsing output: 17/ for test: gem_exec_reloc
results: parsing output: 18/ for test: gem_lmem_swapping
results: parsing output: 19/ for test: gem_mmap_gtt
results: parsing output: 20/ for test: kms_psr
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: kms_ccs
results: parsing output: 23/ for test: gem_bad_reloc
results: parsing output: 24/ for test: kms_flip
results: parsing output: 25/ for test: kms_async_flips
results: parsing output: 26/ for test: kms_plane
results: parsing output: 27/ for test: kms_psr2_sf
results: parsing output: 28/ for test: i915_hangman
results: parsing output: 29/ for test: kms_big_fb
results: parsing output: 30/ for test: gem_render_copy
results: parsing output: 31/ for test: gem_exec_parallel
results: parsing output: 32/ for test: gem_exec_balancer
results: parsing output: 33/ for test: kms_chamelium_edid
results: parsing output: 34/ for test: vgem_basic
results: parsing output: 35/ for test: kms_pm_rpm
results: parsing output: 36/ for test: kms_big_fb
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: i915_suspend
results: parsing output: 39/ for test: gem_ctx_param
results: parsing output: 40/ for test: gem_exec_fence
results: parsing output: 41/ for test: gem_exec_params
results: parsing output: 42/ for test: prime_mmap
results: parsing output: 43/ for test: kms_psr
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: kms_chamelium_hpd
results: parsing output: 46/ for test: kms_cursor_legacy
results: parsing output: 47/ for test: kms_panel_fitting
results: parsing output: 48/ for test: kms_flip
results: parsing output: 49/ for test: kms_plane_scaling
results: parsing output: 50/ for test: core_debugfs
results: parsing output: 51/ for test: syncobj_timeline
results: parsing output: 52/ for test: kms_flip
results: parsing output: 53/ for test: kms_hdr
results: parsing output: 54/ for test: gem_exec_reloc
results: parsing output: 55/ for test: gem_softpin
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: gem_exec_flush
results: parsing output: 58/ for test: kms_plane
results: parsing output: 59/ for test: gem_pwrite
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: kms_pm_dc
results: parsing output: 63/ for test: prime_vgem
results: parsing output: 64/ for test: kms_color
results: parsing output: 65/ for test: kms_ccs
results: parsing output: 66/ for test: kms_psr
results: parsing output: 67/ for test: kms_flip
results: parsing output: 68/ for test: kms_vblank
results: parsing output: 69/ for test: core_sysfs
results: parsing output: 70/ for test: kms_busy
results: parsing output: 71/ for test: gem_userptr_blits
results: parsing output: 72/ for test: gem_softpin
results: parsing output: 73/ for test: gem_compute
results: parsing output: 74/ for test: gem_userptr_blits
results: parsing output: 75/ for test: gem_exec_schedule
results: parsing output: 76/ for test: gem_close
results: parsing output: 77/ for test: gem_exec_reloc
results: parsing output: 78/ for test: gem_ctx_shared
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: gem_exec_reloc
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_flip_scaled_crc
results: parsing output: 83/ for test: gem_exec_balancer
results: parsing output: 84/ for test: kms_big_fb
results: parsing output: 85/ for test: kms_flip_scaled_crc
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_ccs
results: parsing output: 88/ for test: api_intel_allocator
results: parsing output: 89/ for test: kms_psr
results: parsing output: 90/ for test: kms_cursor_legacy
results: parsing output: 91/ for test: syncobj_timeline
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_content_protection
results: parsing output: 94/ for test: kms_big_fb
results: parsing output: 95/ for test: gem_exec_schedule
results: parsing output: 96/ for test: kms_force_connector_basic
results: parsing output: 97/ for test: kms_cdclk
results: parsing output: 98/ for test: gem_ctx_param
results: parsing output: 99/ for test: syncobj_timeline
results: parsing output: 100/ for test: syncobj_timeline
results: parsing output: 101/ for test: i915_pm_rc6_residency
results: parsing output: 102/ for test: gen9_exec_parse
results: parsing output: 103/ for test: sysfs_heartbeat_interval
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: gem_ctx_isolation
results: parsing output: 106/ for test: syncobj_wait
results: parsing output: 107/ for test: gem_ctx_persistence
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_pipe_crc_basic
results: parsing output: 110/ for test: kms_joiner
results: parsing output: 111/ for test: kms_sequence
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: gem_userptr_blits
results: parsing output: 114/ for test: gem_exec_params
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: perf
results: parsing output: 117/ for test: kms_cursor_legacy
results: parsing output: 118/ for test: kms_big_fb
results: parsing output: 119/ for test: kms_psr2_sf
results: parsing output: 120/ for test: kms_addfb_basic
results: parsing output: 121/ for test: kms_cursor_crc
results: parsing output: 122/ for test: gem_softpin
results: parsing output: 123/ for test: gem_mmap_gtt
results: parsing output: 124/ for test: kms_rotation_crc
results: parsing output: 125/ for test: kms_cursor_crc
results: parsing output: 126/ for test: gem_create
results: parsing output: 127/ for test: gem_pxp
results: parsing output: 128/ for test: kms_force_connector_basic
results: parsing output: 129/ for test: perf_pmu
results: parsing output: 130/ for test: kms_cursor_crc
results: parsing output: 131/ for test: kms_debugfs
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.