[58.336920] Initializing watchdogs
[58.336968]   /dev/watchdog0
[58.355291] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7dd5 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Graphics]
[58.359205] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.361255] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.364442] [001/155] (960s left) gem_close_race (multigpu-basic-process)
[58.461062] Starting subtest: multigpu-basic-process
[58.465674] Subtest multigpu-basic-process: SKIP (0.000s)
[58.694211] [002/155] (960s left) kms_frontbuffer_tracking (psr-rgb565-draw-render)
[58.787125] Starting subtest: psr-rgb565-draw-render
[65.870305] Subtest psr-rgb565-draw-render: SUCCESS (7.109s)
[65.966562] [003/155] (952s left) syncobj_timeline (multi-wait-signaled)
[66.022245] Starting subtest: multi-wait-signaled
[66.024713] Subtest multi-wait-signaled: SUCCESS (0.001s)
[66.147508] [004/155] (952s left) kms_big_fb (x-tiled-32bpp-rotate-180)
[66.235997] Starting subtest: x-tiled-32bpp-rotate-180
[67.701088] Subtest x-tiled-32bpp-rotate-180: SUCCESS (1.467s)
[67.820185] [005/155] (951s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-indfb-msflip-blt)
[67.896488] Starting subtest: fbchdr-2p-primscrn-indfb-msflip-blt
[67.899882] Subtest fbchdr-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[67.998892] [006/155] (951s left) kms_chamelium_hpd (hdmi-hpd-fast)
[68.358397] Subtest hdmi-hpd-fast: SKIP (0.000s)
[69.144289] [007/155] (949s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move)
[69.228177] Starting subtest: psr-2p-primscrn-cur-indfb-move
[69.232809] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[69.322346] [008/155] (949s left) api_intel_bb (object-noreloc-purge-cache-simple)
[69.365793] Starting subtest: object-noreloc-purge-cache-simple
[69.370621] Subtest object-noreloc-purge-cache-simple: SUCCESS (0.007s)
[69.469904] [009/155] (949s left) perf (gen12-mi-rpc)
[69.581900] Starting subtest: gen12-mi-rpc
[69.584371] Starting dynamic subtest: rcs0
[69.599766] Dynamic subtest rcs0: SUCCESS (0.017s)
[69.602157] Subtest gen12-mi-rpc: SUCCESS (0.017s)
[69.637022] [010/155] (949s left) kms_flip (2x-nonexisting-fb)
[69.734927] Starting subtest: 2x-nonexisting-fb
[69.742577] Subtest 2x-nonexisting-fb: SKIP (0.008s)
[69.815255] [011/155] (949s left) kms_cursor_legacy (cursorb-vs-flipb-varying-size)
[69.911047] Starting subtest: cursorB-vs-flipB-varying-size
[69.915634] Subtest cursorB-vs-flipB-varying-size: SKIP (0.001s)
[70.067444] [012/155] (949s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-onoff)
[70.157098] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-onoff
[77.239675] Subtest fbcpsr-1p-primscrn-cur-indfb-onoff: SUCCESS (7.090s)
[77.358932] [013/155] (941s left) kms_psr (psr-suspend)
[77.434191] Starting subtest: psr-suspend
[77.436544] Starting dynamic subtest: eDP-1
[95.713923] Dynamic subtest eDP-1: SUCCESS (3.050s)
[95.716165] Subtest psr-suspend: SUCCESS (3.050s)
[96.571765] [014/155] (922s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb565-draw-blt)
[96.672592] Starting subtest: fbcpsrhdr-rgb565-draw-blt
[96.676798] Subtest fbcpsrhdr-rgb565-draw-blt: SKIP (0.000s)
[96.776832] [015/155] (922s left) gem_ctx_shared (detached-shared-gtt)
[96.843426] Starting subtest: detached-shared-gtt
[98.980048] Subtest detached-shared-gtt: SUCCESS (2.152s)
[99.292800] [016/155] (920s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-spr-indfb-draw-render)
[99.378040] Starting subtest: fbchdr-2p-scndscrn-spr-indfb-draw-render
[99.383109] Subtest fbchdr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[99.487567] [017/155] (919s left) kms_cursor_legacy (cursorb-vs-flipa-toggle)
[99.583437] Starting subtest: cursorB-vs-flipA-toggle
[99.588035] Subtest cursorB-vs-flipA-toggle: SKIP (0.001s)
[99.720850] [018/155] (919s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-pri-indfb-draw-blt)
[99.803551] Starting subtest: fbchdr-1p-primscrn-pri-indfb-draw-blt
[99.807796] Subtest fbchdr-1p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[99.906157] [019/155] (919s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-downscaling)
[99.975433] Starting subtest: flip-32bpp-linear-to-64bpp-linear-downscaling
[99.977750] Starting dynamic subtest: pipe-A-default-mode
[101.106216] Dynamic subtest pipe-A-default-mode: SKIP (1.133s)
[101.110451] Subtest flip-32bpp-linear-to-64bpp-linear-downscaling: SKIP (1.135s)
[101.257946] [020/155] (918s left) dumb_buffer (invalid-bpp)
[101.313065] Starting subtest: invalid-bpp
[101.315530] Subtest invalid-bpp: SUCCESS (0.000s)
[101.415442] [021/155] (918s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-spr-indfb-draw-blt)
[101.490216] Starting subtest: fbchdr-2p-primscrn-spr-indfb-draw-blt
[101.494377] Subtest fbchdr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[101.590432] [022/155] (918s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[101.682938] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-hflip
[102.678805] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-hflip: SUCCESS (1.000s)
[102.788054] [023/155] (916s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-spr-indfb-move)
[102.869475] Starting subtest: psrhdr-2p-scndscrn-spr-indfb-move
[102.873474] Subtest psrhdr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[102.976692] [024/155] (916s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-mc-ccs)
[103.056892] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-mc-ccs
[103.058849] Starting dynamic subtest: pipe-A-eDP-1
[103.078100] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[103.088488] Starting dynamic subtest: pipe-B-eDP-1
[103.106871] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[103.114716] Starting dynamic subtest: pipe-C-eDP-1
[103.131784] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[103.139735] Starting dynamic subtest: pipe-D-eDP-1
[103.157837] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[103.161375] Subtest crc-primary-rotation-180-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[105.320830] [025/155] (914s left) gem_exec_fence (syncobj-timeline-chain-engines)
[105.891466] Starting subtest: syncobj-timeline-chain-engines
[105.988642] Subtest syncobj-timeline-chain-engines: SUCCESS (0.098s)
[107.549570] [FACT gem_exec_fence (syncobj-timeline-chain-engines)] new: kernel.kmod_is_loaded.vgem: true
[107.553494] [026/155] (912s left) gem_ccs (block-copy-uncompressed)
[107.615999] Starting subtest: block-copy-uncompressed
[107.618316] Starting dynamic subtest: linear-uncompressed-compfmt0-smem-smem
[107.637479] Dynamic subtest linear-uncompressed-compfmt0-smem-smem: SUCCESS (0.021s)
[107.645969] Starting dynamic subtest: xmajor-uncompressed-compfmt0-smem-smem
[107.656292] Dynamic subtest xmajor-uncompressed-compfmt0-smem-smem: SUCCESS (0.019s)
[107.664519] Starting dynamic subtest: tile4-uncompressed-compfmt0-smem-smem
[107.672428] Dynamic subtest tile4-uncompressed-compfmt0-smem-smem: SUCCESS (0.016s)
[107.682723] Starting dynamic subtest: tile64-uncompressed-compfmt0-smem-smem
[107.695254] Dynamic subtest tile64-uncompressed-compfmt0-smem-smem: SUCCESS (0.022s)
[107.697770] Subtest block-copy-uncompressed: SUCCESS (0.079s)
[107.819360] [027/155] (912s left) kms_dsc (dsc-with-output-formats)
[107.906792] Starting subtest: dsc-with-output-formats
[107.928570] Subtest dsc-with-output-formats: SKIP (0.001s)
[107.977126] [028/155] (911s left) kms_cursor_crc (cursor-offscreen-32x10)
[108.123712] Starting subtest: cursor-offscreen-32x10
[108.175564] Subtest cursor-offscreen-32x10: SKIP (0.047s)
[108.428622] [029/155] (911s left) kms_cursor_legacy (flip-vs-cursor-crc-legacy)
[108.519615] Starting subtest: flip-vs-cursor-crc-legacy
[109.191745] Subtest flip-vs-cursor-crc-legacy: SUCCESS (0.671s)
[110.040231] [030/155] (909s left) kms_chamelium_audio (hdmi-audio-edid)
[110.405760] Subtest hdmi-audio-edid: SKIP (0.000s)
[111.237330] [031/155] (908s left) syncobj_timeline (multi-wait-all-available-submitted)
[111.290992] Starting subtest: multi-wait-all-available-submitted
[111.293850] Subtest multi-wait-all-available-submitted: SUCCESS (0.001s)
[111.405387] [032/155] (908s left) gem_exec_reloc (basic-range)
[111.460165] Subtest basic-range: SKIP (0.000s)
[111.537263] [033/155] (908s left) kms_chamelium_frames (hdmi-crc-single)
[111.901144] Subtest hdmi-crc-single: SKIP (0.000s)
[112.756037] [034/155] (907s left) kms_color (invalid-ctm-matrix-sizes)
[112.821762] Starting subtest: invalid-ctm-matrix-sizes
[112.824176] Starting dynamic subtest: pipe-A
[112.826716] Dynamic subtest pipe-A: SUCCESS (0.002s)
[112.837161] Starting dynamic subtest: pipe-B
[112.839121] Dynamic subtest pipe-B: SUCCESS (0.003s)
[112.847541] Starting dynamic subtest: pipe-C
[112.849774] Dynamic subtest pipe-C: SUCCESS (0.003s)
[112.858178] Starting dynamic subtest: pipe-D
[112.860475] Dynamic subtest pipe-D: SUCCESS (0.004s)
[112.862446] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.013s)
[112.904398] [035/155] (907s left) kms_cursor_legacy (cursor-vs-flip-atomic-transitions)
[113.006502] Starting subtest: cursor-vs-flip-atomic-transitions
[143.173841] Subtest cursor-vs-flip-atomic-transitions: SUCCESS (30.178s)
[144.000704] [036/155] (876s left) kms_cursor_legacy (short-flip-after-cursor-toggle)
[144.109623] Starting subtest: short-flip-after-cursor-toggle
[145.049044] Subtest short-flip-after-cursor-toggle: SUCCESS (0.939s)
[145.931004] [037/155] (874s left) kms_psr (psr-cursor-plane-onoff)
[146.011723] Starting subtest: psr-cursor-plane-onoff
[146.014048] Starting dynamic subtest: eDP-1
[147.719068] Dynamic subtest eDP-1: SUCCESS (1.704s)
[147.720993] Subtest psr-cursor-plane-onoff: SUCCESS (1.705s)
[148.596245] [038/155] (871s left) kms_cursor_legacy (cursor-vs-flip-toggle)
[148.700617] Starting subtest: cursor-vs-flip-toggle
[179.773282] Subtest cursor-vs-flip-toggle: SUCCESS (31.082s)
[180.602996] [039/155] (839s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-pwrite)
[180.702461] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-pwrite
[190.029032] Subtest psr-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (9.336s)
[190.141919] [040/155] (830s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs)
[190.210306] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs
[190.212578] Starting dynamic subtest: pipe-A-eDP-1
[190.232705] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[190.243111] Starting dynamic subtest: pipe-B-eDP-1
[190.262202] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[190.270567] Starting dynamic subtest: pipe-C-eDP-1
[190.289362] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[190.297149] Starting dynamic subtest: pipe-D-eDP-1
[190.315272] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[190.317065] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs: SUCCESS (0.005s)
[192.546011] [041/155] (827s left) i915_query (query-topology-known-pci-ids)
[192.594747] Starting subtest: query-topology-known-pci-ids
[192.599017] Subtest query-topology-known-pci-ids: SKIP (0.000s)
[192.717454] [042/155] (827s left) kms_frontbuffer_tracking (fbchdr-rgb565-draw-pwrite)
[192.813280] Starting subtest: fbchdr-rgb565-draw-pwrite
[192.817408] Subtest fbchdr-rgb565-draw-pwrite: SKIP (0.000s)
[192.905784] [043/155] (827s left) kms_cursor_edge_walk (64x64-top-bottom)
[192.986535] Starting subtest: 64x64-top-bottom
[192.988824] Starting dynamic subtest: pipe-A-eDP-1
[196.441164] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.452s)
[196.451043] Starting dynamic subtest: pipe-D-eDP-1
[199.566073] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.122s)
[199.568821] Subtest 64x64-top-bottom: SUCCESS (6.577s)
[200.371706] [044/155] (820s left) kms_flip (2x-blocking-absolute-wf_vblank)
[200.463106] Starting subtest: 2x-blocking-absolute-wf_vblank
[200.470019] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.008s)
[200.560625] [045/155] (820s left) kms_frontbuffer_tracking (psrhdr-rgb565-draw-pwrite)
[200.639421] Starting subtest: psrhdr-rgb565-draw-pwrite
[200.643401] Subtest psrhdr-rgb565-draw-pwrite: SKIP (0.000s)
[200.746466] [046/155] (819s left) gem_exec_async (forked-writes)
[200.799168] Starting subtest: forked-writes
[200.801529] Starting dynamic subtest: rcs0
[200.824394] Dynamic subtest rcs0: SUCCESS (0.025s)
[200.834165] Starting dynamic subtest: bcs0
[200.845856] Dynamic subtest bcs0: SUCCESS (0.021s)
[200.856667] Starting dynamic subtest: vcs0
[200.866701] Dynamic subtest vcs0: SUCCESS (0.020s)
[200.877190] Starting dynamic subtest: vcs1
[200.890827] Dynamic subtest vcs1: SUCCESS (0.023s)
[200.900196] Starting dynamic subtest: vecs0
[200.913867] Dynamic subtest vecs0: SUCCESS (0.022s)
[200.923474] Starting dynamic subtest: ccs0
[200.934614] Dynamic subtest ccs0: SUCCESS (0.020s)
[200.936928] Subtest forked-writes: SUCCESS (0.136s)
[201.166703] [047/155] (819s left) gem_linear_blits (interruptible)
[201.456494] Starting subtest: interruptible
[205.650332] Subtest interruptible: SUCCESS (4.192s)
[205.778477] [048/155] (814s left) kms_psr (psr2-cursor-mmap-gtt)
[205.899697] Starting subtest: psr2-cursor-mmap-gtt
[205.902173] Starting dynamic subtest: eDP-1
[207.669871] Dynamic subtest eDP-1: SUCCESS (1.769s)
[207.672157] Subtest psr2-cursor-mmap-gtt: SUCCESS (1.770s)
[208.554639] [049/155] (812s left) syncobj_wait (wait-for-submit-complex)
[208.632516] Starting subtest: wait-for-submit-complex
[208.696842] Subtest wait-for-submit-complex: SUCCESS (0.062s)
[208.784567] [050/155] (812s left) kms_plane_scaling (plane-scaler-unity-scaling-with-modifiers)
[208.863192] Starting subtest: plane-scaler-unity-scaling-with-modifiers
[208.865602] Starting dynamic subtest: pipe-A
[209.200516] Dynamic subtest pipe-A: SUCCESS (0.338s)
[209.211529] Starting dynamic subtest: pipe-B
[210.644934] Dynamic subtest pipe-B: SUCCESS (1.443s)
[210.655151] Starting dynamic subtest: pipe-C
[212.080532] Dynamic subtest pipe-C: SUCCESS (1.435s)
[212.091019] Starting dynamic subtest: pipe-D
[213.517882] Dynamic subtest pipe-D: SUCCESS (1.436s)
[213.519977] Subtest plane-scaler-unity-scaling-with-modifiers: SUCCESS (4.656s)
[214.681389] [051/155] (806s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-spr-indfb-fullscreen)
[214.758725] Starting subtest: psrhdr-1p-primscrn-spr-indfb-fullscreen
[214.763040] Subtest psrhdr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[214.865551] [052/155] (806s left) kms_pm_dc (dc5-dpms-negative)
[215.953913] Starting subtest: dc5-dpms-negative
[215.958706] Subtest dc5-dpms-negative: SKIP (0.000s)
[216.039950] [053/155] (804s left) gem_mmap_wc (write)
[216.094517] Subtest write: SKIP (0.000s)
[216.152430] [054/155] (804s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-factor-0-25)
[216.227880] Starting subtest: planes-downscale-factor-0-75-upscale-factor-0-25
[216.230163] Starting dynamic subtest: pipe-A
[216.292470] Dynamic subtest pipe-A: SUCCESS (0.065s)
[216.301898] Starting dynamic subtest: pipe-B
[217.406028] Dynamic subtest pipe-B: SUCCESS (1.113s)
[217.417428] Starting dynamic subtest: pipe-C
[218.528763] Dynamic subtest pipe-C: SUCCESS (1.121s)
[218.539016] Starting dynamic subtest: pipe-D
[219.652237] Dynamic subtest pipe-D: SUCCESS (1.122s)
[219.654680] Subtest planes-downscale-factor-0-75-upscale-factor-0-25: SUCCESS (3.425s)
[220.821744] [055/155] (800s left) kms_frontbuffer_tracking (fbcpsrhdr-suspend)
[220.903187] Starting subtest: fbcpsrhdr-suspend
[220.907333] Subtest fbcpsrhdr-suspend: SKIP (0.000s)
[221.010702] [056/155] (800s left) gem_render_copy (yf-tiled-mc-ccs-to-vebox-y-tiled)
[221.084366] Starting subtest: yf-tiled-mc-ccs-to-vebox-y-tiled
[221.088809] Subtest yf-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[221.274237] [057/155] (799s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-wc)
[221.353344] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-wc
[224.875031] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (3.527s)
[226.019307] [058/155] (795s left) kms_plane (pixel-format-y-tiled-modifier)
[226.094296] Starting subtest: pixel-format-y-tiled-modifier
[226.098434] Subtest pixel-format-y-tiled-modifier: SKIP (0.000s)
[226.168176] [059/155] (795s left) i915_query (query-topology-matches-eu-total)
[226.216390] Starting subtest: query-topology-matches-eu-total
[226.218594] Subtest query-topology-matches-eu-total: SUCCESS (0.000s)
[226.314979] [060/155] (794s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc)
[226.394054] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc
[226.396435] Starting dynamic subtest: pipe-A-eDP-1
[226.419716] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[226.430836] Starting dynamic subtest: pipe-B-eDP-1
[226.453176] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[226.461856] Starting dynamic subtest: pipe-C-eDP-1
[226.483869] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[226.492720] Starting dynamic subtest: pipe-D-eDP-1
[226.514982] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[226.519131] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.005s)
[228.685523] [061/155] (792s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-downscaling)
[228.766130] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-downscaling
[228.770490] Subtest flip-64bpp-yftile-to-16bpp-yftile-downscaling: SKIP (0.000s)
[228.839381] [062/155] (792s left) gem_mmap_gtt (big-bo)
[228.902419] Subtest big-bo: SKIP (0.000s)
[228.970650] [063/155] (792s left) gem_render_copy (yf-tiled-ccs-to-y-tiled)
[229.030938] Starting subtest: yf-tiled-ccs-to-y-tiled
[229.035531] Subtest yf-tiled-ccs-to-y-tiled: SKIP (0.000s)
[229.225697] [064/155] (792s left) kms_addfb_basic (tile-pitch-mismatch)
[229.269917] Starting subtest: tile-pitch-mismatch
[229.274033] Subtest tile-pitch-mismatch: SKIP (0.000s)
[229.397462] [065/155] (792s left) kms_vblank (ts-continuation-modeset-rpm)
[229.474325] Starting subtest: ts-continuation-modeset-rpm
[229.476583] Starting dynamic subtest: pipe-A-eDP-1
[231.958822] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.482s)
[231.975767] Starting dynamic subtest: pipe-D-eDP-1
[234.210238] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.249s)
[234.212652] Subtest ts-continuation-modeset-rpm: SUCCESS (4.735s)
[235.028677] [066/155] (786s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[235.107591] Starting subtest: psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[235.111636] Subtest psrhdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[235.214171] [067/155] (786s left) kms_big_fb (y-tiled-addfb-size-offset-overflow)
[235.298931] Starting subtest: y-tiled-addfb-size-offset-overflow
[235.303403] Subtest y-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[235.398440] [068/155] (786s left) kms_frontbuffer_tracking (hdr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[235.477890] Starting subtest: hdr-1p-primscrn-pri-indfb-draw-mmap-cpu
[235.482315] Subtest hdr-1p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[235.574710] [069/155] (786s left) gem_media_fill (media-fill)
[235.635674] Subtest media-fill: SKIP (0.000s)
[235.761639] [070/155] (785s left) kms_plane_multiple (tiling-yf)
[235.838474] Starting subtest: tiling-yf
[235.842942] Subtest tiling-yf: SKIP (0.000s)
[235.905884] [071/155] (785s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[235.988378] Starting subtest: yf-tiled-8bpp-rotate-270
[235.991972] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[236.086255] [072/155] (785s left) api_intel_allocator (simple-allocator)
[236.141907] Starting subtest: simple-allocator
[236.143825] Starting dynamic subtest: basic
[236.145656] Dynamic subtest basic: SUCCESS (0.003s)
[236.154739] Starting dynamic subtest: parallel-one
[236.318132] Dynamic subtest parallel-one: SUCCESS (0.172s)
[236.328926] Starting dynamic subtest: print
[236.331033] Dynamic subtest print: SUCCESS (0.000s)
[236.340532] Starting dynamic subtest: reuse
[236.342816] Dynamic subtest reuse: SUCCESS (0.000s)
[236.351430] Starting dynamic subtest: reserve
[236.353731] Dynamic subtest reserve: SUCCESS (0.000s)
[236.362472] Starting dynamic subtest: fork-reopen-allocator
[236.364734] Dynamic subtest fork-reopen-allocator: SUCCESS (0.010s)
[236.367026] Subtest simple-allocator: SUCCESS (0.191s)
[236.451517] [073/155] (785s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[236.525824] Starting subtest: compare-crc-sanitycheck-xr24
[236.528188] Starting dynamic subtest: pipe-A-eDP-1
[237.174930] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.649s)
[237.184978] Starting dynamic subtest: pipe-B-eDP-1
[238.509299] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.333s)
[238.519194] Starting dynamic subtest: pipe-C-eDP-1
[239.789415] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.278s)
[239.799567] Starting dynamic subtest: pipe-D-eDP-1
[241.012769] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.221s)
[241.015002] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.487s)
[241.823611] [074/155] (779s left) kms_psr (fbc-psr2-sprite-mmap-cpu)
[241.903059] Starting subtest: fbc-psr2-sprite-mmap-cpu
[241.905370] Starting dynamic subtest: eDP-1
[241.909655] Dynamic subtest eDP-1: SKIP (0.000s)
[241.913930] Subtest fbc-psr2-sprite-mmap-cpu: SKIP (0.001s)
[241.976076] [075/155] (779s left) kms_frontbuffer_tracking (fbcpsr-modesetfrombusy)
[242.056547] Starting subtest: fbcpsr-modesetfrombusy
[248.187548] Subtest fbcpsr-modesetfrombusy: SUCCESS (6.138s)
[248.313407] [076/155] (773s left) gem_exec_balancer (parallel-balancer)
[248.577355] Starting subtest: parallel-balancer
[249.466669] Subtest parallel-balancer: SUCCESS (0.889s)
[249.589120] [077/155] (772s left) kms_flip (flip-vs-panning)
[249.676180] Starting subtest: flip-vs-panning
[249.678657] Starting dynamic subtest: A-eDP1
[258.393418] Dynamic subtest A-eDP1: SUCCESS (8.720s)
[258.404156] Starting dynamic subtest: B-eDP1
[267.133858] Dynamic subtest B-eDP1: SUCCESS (8.741s)
[267.148143] Starting dynamic subtest: C-eDP1
[275.838460] Dynamic subtest C-eDP1: SUCCESS (8.704s)
[275.847828] Starting dynamic subtest: D-eDP1
[284.556668] Dynamic subtest D-eDP1: SUCCESS (8.719s)
[284.561387] Subtest flip-vs-panning: SUCCESS (34.893s)
[285.728851] [078/155] (736s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0)
[285.815215] Starting subtest: linear-max-hw-stride-32bpp-rotate-0
[286.958662] Subtest linear-max-hw-stride-32bpp-rotate-0: SUCCESS (1.144s)
[287.068222] [079/155] (734s left) kms_psr (pr-basic)
[287.143314] Starting subtest: pr-basic
[287.146962] Subtest pr-basic: SKIP (0.000s)
[287.216029] [080/155] (734s left) gem_exec_schedule (u-semaphore-codependency)
[287.282243] Starting subtest: u-semaphore-codependency
[287.289276] Subtest u-semaphore-codependency: SUCCESS (0.012s)
[287.641411] [081/155] (734s left) gem_mmap_gtt (zero-extend)
[287.696879] Subtest zero-extend: SKIP (0.000s)
[287.749032] [082/155] (734s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-wc)
[287.824741] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-wc
[294.405522] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (6.588s)
[294.531500] [083/155] (727s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-wc)
[294.611931] Starting subtest: fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-wc
[294.615858] Subtest fbcpsrhdr-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[294.696466] [084/155] (727s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-spr-indfb-move)
[294.769187] Starting subtest: fbcpsrhdr-2p-primscrn-spr-indfb-move
[294.773150] Subtest fbcpsrhdr-2p-primscrn-spr-indfb-move: SKIP (0.000s)
[294.859210] [085/155] (727s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-sf)
[294.930674] Starting subtest: psr2-cursor-plane-move-continuous-exceed-sf
[294.932861] Starting dynamic subtest: pipe-A-eDP-1
[305.608799] Dynamic subtest pipe-A-eDP-1: SUCCESS (10.685s)
[305.620423] Starting dynamic subtest: pipe-B-eDP-1
[317.053302] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.445s)
[317.055608] Subtest psr2-cursor-plane-move-continuous-exceed-sf: SUCCESS (22.133s)
[317.912192] [086/155] (704s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[318.021555] Starting subtest: fbcpsrhdr-2p-primscrn-cur-indfb-draw-mmap-gtt
[318.025771] Subtest fbcpsrhdr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[318.119656] [087/155] (704s left) i915_suspend (fence-restore-tiled2untiled)
[318.171596] Starting subtest: fence-restore-tiled2untiled
[318.176157] Subtest fence-restore-tiled2untiled: SKIP (0.000s)
[318.275036] [088/155] (704s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[318.362535] Starting subtest: hdr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[318.366642] Subtest hdr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[318.462648] [089/155] (703s left) kms_frontbuffer_tracking (hdr-2p-primscrn-pri-indfb-draw-mmap-wc)
[318.544796] Starting subtest: hdr-2p-primscrn-pri-indfb-draw-mmap-wc
[318.549363] Subtest hdr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[318.630425] [090/155] (703s left) kms_prop_blob (blob-multiple)
[318.684882] Starting subtest: blob-multiple
[318.687147] Subtest blob-multiple: SUCCESS (0.002s)
[318.789558] [091/155] (703s left) gem_exec_params (mmapped)
[318.855715] Starting subtest: mmapped
[318.860247] Subtest mmapped: SUCCESS (0.002s)
[318.978609] [092/155] (703s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[319.050182] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt
[319.053871] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[319.152773] [093/155] (703s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-move)
[319.228857] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-move
[319.232227] Subtest fbcpsr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[319.326848] [094/155] (703s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted-signa
[319.381070] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted-signaled
[319.487621] Subtest etime-multi-wait-all-for-submit-available-unsubmitted-signaled: SUCCESS (0.106s)
[319.561094] [095/155] (703s left) gem_linear_blits (basic)
[319.756904] Starting subtest: basic
[319.764980] Subtest basic: SUCCESS (0.008s)
[319.901950] [096/155] (702s left) kms_properties (colorop-properties-legacy)
[320.039137] Starting subtest: colorop-properties-legacy
[320.041320] Starting dynamic subtest: pipe-A-eDP-1
[320.430477] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.391s)
[320.441629] Starting dynamic subtest: pipe-B-eDP-1
[321.482138] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.049s)
[321.491832] Starting dynamic subtest: pipe-C-eDP-1
[322.527875] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.044s)
[322.538183] Starting dynamic subtest: pipe-D-eDP-1
[323.570301] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.042s)
[323.572672] Subtest colorop-properties-legacy: SUCCESS (3.531s)
[324.374188] [097/155] (698s left) kms_universal_plane (universal-plane-pageflip-windowed)
[324.452053] Starting subtest: universal-plane-pageflip-windowed
[324.454403] Starting dynamic subtest: pipe-A-eDP-1
[325.020196] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.567s)
[325.029459] Starting dynamic subtest: pipe-B-eDP-1
[326.264453] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.241s)
[326.274359] Starting dynamic subtest: pipe-C-eDP-1
[327.488163] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.222s)
[327.498389] Starting dynamic subtest: pipe-D-eDP-1
[328.721245] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.229s)
[328.723396] Subtest universal-plane-pageflip-windowed: SUCCESS (4.268s)
[329.602307] [098/155] (693s left) syncobj_timeline (wait-for-submit-snapshot)
[329.658425] Starting subtest: wait-for-submit-snapshot
[329.740977] Subtest wait-for-submit-snapshot: SUCCESS (0.082s)
[329.818742] [099/155] (692s left) gem_exec_whisper (basic-forked)
[329.890154] Starting subtest: basic-forked
[337.100001] Subtest basic-forked: SUCCESS (7.205s)
[337.302125] [100/155] (685s left) kms_invalid_mode (bad-vtotal)
[337.383388] Starting subtest: bad-vtotal
[337.385762] Starting dynamic subtest: pipe-A-eDP-1
[337.667546] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s)
[337.678061] Starting dynamic subtest: pipe-B-eDP-1
[337.680483] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[337.689536] Starting dynamic subtest: pipe-C-eDP-1
[337.691526] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[337.700200] Starting dynamic subtest: pipe-D-eDP-1
[337.702753] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[337.705218] Subtest bad-vtotal: SUCCESS (0.290s)
[338.540833] [101/155] (684s left) gem_exec_reloc (basic-gtt-read-noreloc)
[338.602152] Subtest basic-gtt-read-noreloc: SKIP (0.000s)
[338.664426] [102/155] (684s left) gem_exec_balancer (semaphore)
[338.720499] Starting subtest: semaphore
[340.474970] Subtest semaphore: SUCCESS (1.752s)
[340.796511] [103/155] (682s left) gem_eio (wait-wedge-10ms)
[341.018676] Starting subtest: wait-wedge-10ms
[342.555368] Subtest wait-wedge-10ms: SUCCESS (1.536s)
[342.696413] [104/155] (680s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[342.934860] Starting subtest: cursor-rapid-movement-512x512
[342.939319] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[343.085381] [105/155] (679s left) perf_pmu (all-busy-idle-check-all)
[343.131731] Starting subtest: all-busy-idle-check-all
[344.443929] Subtest all-busy-idle-check-all: SUCCESS (1.312s)
[344.532694] [106/155] (678s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[344.623379] Starting subtest: read-crc-frame-sequence
[344.625613] Starting dynamic subtest: pipe-A-eDP-1
[345.325413] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.701s)
[345.336781] Starting dynamic subtest: pipe-B-eDP-1
[346.716955] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.388s)
[346.729979] Starting dynamic subtest: pipe-C-eDP-1
[348.112284] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.393s)
[348.123179] Starting dynamic subtest: pipe-D-eDP-1
[349.438307] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.325s)
[349.440966] Subtest read-crc-frame-sequence: SUCCESS (4.814s)
[350.275716] [107/155] (672s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[350.364878] Starting subtest: fbcpsrhdr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[350.369381] Subtest fbcpsrhdr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[350.473942] [108/155] (672s left) gem_exec_schedule (pi-userfault)
[350.665231] Starting subtest: pi-userfault
[350.667750] Starting dynamic subtest: rcs0
[350.673597] Dynamic subtest rcs0: SUCCESS (0.011s)
[350.685765] Starting dynamic subtest: bcs0
[350.688044] Dynamic subtest bcs0: SUCCESS (0.007s)
[350.698331] Starting dynamic subtest: vcs0
[350.700603] Dynamic subtest vcs0: SUCCESS (0.008s)
[350.710868] Starting dynamic subtest: vcs1
[350.713410] Dynamic subtest vcs1: SUCCESS (0.007s)
[350.722986] Starting dynamic subtest: vecs0
[350.724960] Dynamic subtest vecs0: SUCCESS (0.007s)
[350.734079] Starting dynamic subtest: ccs0
[350.735954] Dynamic subtest ccs0: SUCCESS (0.007s)
[350.737869] Subtest pi-userfault: SUCCESS (0.053s)
[350.893894] [109/155] (672s left) gem_set_tiling_vs_blt (untiled-to-tiled)
[350.958863] Subtest untiled-to-tiled: SKIP (0.000s)
[351.021116] [110/155] (672s left) gem_userptr_blits (sd-probe)
[351.097620] Starting subtest: sd-probe
[351.099555] Subtest sd-probe: SUCCESS (0.000s)
[351.216703] [111/155] (672s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-shrfb-msflip-blt)
[351.292969] Starting subtest: psrhdr-2p-primscrn-shrfb-msflip-blt
[351.297437] Subtest psrhdr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[351.381834] [112/155] (671s left) kms_psr2_su (page_flip-nv12)
[351.440200] Subtest page_flip-NV12: SKIP (0.000s)
[351.498834] [113/155] (671s left) gem_userptr_blits (unsync-unmap)
[351.561528] Subtest unsync-unmap: SKIP (0.000s)
[351.687538] [114/155] (671s left) gem_lmem_evict (dontneed-evict-race)
[351.726240] Subtest dontneed-evict-race: SKIP (0.000s)
[351.764894] [115/155] (671s left) i915_pm_rpm (debugfs-forcewake-user)
[353.662831] Starting subtest: debugfs-forcewake-user
[365.040081] Subtest debugfs-forcewake-user: SUCCESS (11.381s)
[365.452296] [116/155] (658s left) gem_mmap_gtt (basic)
[365.506858] Subtest basic: SKIP (0.000s)
[365.571630] [117/155] (657s left) kms_content_protection (dp-mst-lic-type-0)
[365.692074] Starting subtest: dp-mst-lic-type-0
[365.696376] Subtest dp-mst-lic-type-0: SKIP (0.000s)
[365.824086] [118/155] (657s left) kms_frontbuffer_tracking (fbcpsr-2p-rte)
[365.906266] Starting subtest: fbcpsr-2p-rte
[365.910376] Subtest fbcpsr-2p-rte: SKIP (0.000s)
[366.023223] [119/155] (657s left) gem_ctx_param (get-priority-new-ctx)
[366.075891] Starting subtest: get-priority-new-ctx
[366.078168] Subtest get-priority-new-ctx: SUCCESS (0.001s)
[366.174712] [120/155] (657s left) i915_drm_fdinfo (memory-info-idle)
[366.216820] Starting subtest: memory-info-idle
[366.219310] Starting dynamic subtest: smem0
[366.260181] Dynamic subtest smem0: SUCCESS (0.045s)
[366.262828] Subtest memory-info-idle: SUCCESS (0.046s)
[366.347851] [121/155] (657s left) gem_shrink (reclaim)
[366.400783] Starting subtest: reclaim
[368.824619] Subtest reclaim: SUCCESS (2.418s)
[368.961705] [122/155] (654s left) kms_addfb_basic (unused-pitches)
[369.012147] Starting subtest: unused-pitches
[369.014328] Subtest unused-pitches: SUCCESS (0.000s)
[369.133493] [123/155] (654s left) gem_spin_batch (legacy)
[369.193601] Starting subtest: legacy
[369.195817] Starting dynamic subtest: default
[372.430211] Dynamic subtest default: SUCCESS (3.234s)
[372.442864] Starting dynamic subtest: render
[375.663523] Dynamic subtest render: SUCCESS (3.230s)
[375.675839] Starting dynamic subtest: bsd
[378.898950] Dynamic subtest bsd: SUCCESS (3.232s)
[378.911646] Starting dynamic subtest: bsd1
[382.135198] Dynamic subtest bsd1: SUCCESS (3.233s)
[382.148630] Starting dynamic subtest: bsd2
[385.371219] Dynamic subtest bsd2: SUCCESS (3.232s)
[385.383716] Starting dynamic subtest: blt
[388.606750] Dynamic subtest blt: SUCCESS (3.232s)
[388.618879] Starting dynamic subtest: vebox
[391.840221] Dynamic subtest vebox: SUCCESS (3.230s)
[391.842314] Subtest legacy: SUCCESS (22.645s)
[392.527078] [124/155] (631s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-shrfb-plflip-blt)
[392.615157] Starting subtest: fbchdr-1p-primscrn-shrfb-plflip-blt
[392.619360] Subtest fbchdr-1p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[392.716386] [125/155] (631s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-pwrite)
[392.801249] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-pwrite
[392.805435] Subtest psr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[392.917790] [126/155] (631s left) gen7_exec_parse (load-register-reg)
[392.986618] Subtest load-register-reg: SKIP (0.000s)
[393.057704] [127/155] (630s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-upscaling)
[393.134262] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-upscaling
[393.138695] Subtest flip-64bpp-ytile-to-32bpp-ytile-upscaling: SKIP (0.000s)
[393.207913] [128/155] (630s left) i915_hangman (error-state-basic)
[393.283400] Starting subtest: error-state-basic
[393.390736] Subtest error-state-basic: SUCCESS (0.108s)
[393.469708] [129/155] (630s left) gem_mmap_gtt (basic-write-read)
[393.523960] Subtest basic-write-read: SKIP (0.000s)
[393.583991] [130/155] (630s left) kms_big_fb (4-tiled-8bpp-rotate-270)
[393.667081] Starting subtest: 4-tiled-8bpp-rotate-270
[393.689195] Subtest 4-tiled-8bpp-rotate-270: SKIP (0.021s)
[393.793955] [131/155] (630s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-pwrite)
[393.876219] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-pwrite
[393.879683] Subtest psr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[393.977732] [132/155] (630s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt)
[394.055431] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt
[394.058988] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[394.144554] [133/155] (630s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[394.218823] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[394.222305] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[394.319384] [134/155] (629s left) kms_ccs (bad-aux-stride-4-tiled-mtl-mc-ccs)
[394.384458] Starting subtest: bad-aux-stride-4-tiled-mtl-mc-ccs
[394.386293] Starting dynamic subtest: pipe-A-eDP-1
[394.444144] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.060s)
[394.454732] Starting dynamic subtest: pipe-B-eDP-1
[394.503970] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.059s)
[394.514271] Starting dynamic subtest: pipe-C-eDP-1
[394.565483] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.059s)
[394.577894] Starting dynamic subtest: pipe-D-eDP-1
[394.624143] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.059s)
[394.626012] Subtest bad-aux-stride-4-tiled-mtl-mc-ccs: SUCCESS (0.242s)
[396.876565] [135/155] (627s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[396.932262] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[396.934711] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[397.019182] [136/155] (627s left) syncobj_timeline (etime-single-wait-for-submit-submitted)
[397.075079] Starting subtest: etime-single-wait-for-submit-submitted
[397.183797] Subtest etime-single-wait-for-submit-submitted: SUCCESS (0.107s)
[397.260961] [137/155] (627s left) gem_exec_nop (basic-series)
[397.322404] Starting subtest: basic-series
[413.439334] Subtest basic-series: SUCCESS (16.124s)
[413.663445] [138/155] (610s left) kms_async_flips (async-flip-dpms)
[413.755523] Starting subtest: async-flip-dpms
[414.144053] Starting dynamic subtest: pipe-A-eDP-1
[418.090746] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.947s)
[418.483161] Starting dynamic subtest: pipe-B-eDP-1
[421.340867] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.867s)
[421.706552] Starting dynamic subtest: pipe-C-eDP-1
[424.614260] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.913s)
[424.979709] Starting dynamic subtest: pipe-D-eDP-1
[427.800734] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.833s)
[427.802959] Subtest async-flip-dpms: SUCCESS (14.047s)
[428.979491] [139/155] (595s left) kms_frontbuffer_tracking (hdr-2p-primscrn-cur-indfb-draw-blt)
[429.064341] Starting subtest: hdr-2p-primscrn-cur-indfb-draw-blt
[429.068796] Subtest hdr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[429.164803] [140/155] (595s left) gem_pxp (create-regular-context-2)
[429.277806] Starting subtest: create-regular-context-2
[429.280471] Subtest create-regular-context-2: SUCCESS (0.002s)
[429.390963] [141/155] (595s left) sw_sync (sync_multi_consumer_producer)
[429.425161] Starting subtest: sync_multi_consumer_producer
[429.710163] Subtest sync_multi_consumer_producer: SUCCESS (0.284s)
[429.774172] [142/155] (594s left) gem_exec_reloc (basic-wc-gtt-noreloc)
[429.827737] Subtest basic-wc-gtt-noreloc: SKIP (0.000s)
[429.895351] [143/155] (594s left) kms_frontbuffer_tracking (hdr-rgb101010-draw-blt)
[429.982725] Starting subtest: hdr-rgb101010-draw-blt
[429.987152] Subtest hdr-rgb101010-draw-blt: SKIP (0.000s)
[430.083360] [144/155] (594s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-indfb-draw-mmap-wc)
[430.156850] Starting subtest: psrhdr-1p-primscrn-pri-indfb-draw-mmap-wc
[430.161139] Subtest psrhdr-1p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[430.258738] [145/155] (594s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-shrfb-draw-render)
[430.346726] Starting subtest: fbcpsrhdr-1p-offscreen-pri-shrfb-draw-render
[430.350864] Subtest fbcpsrhdr-1p-offscreen-pri-shrfb-draw-render: SKIP (0.000s)
[430.455323] [146/155] (594s left) perf_pmu (init-wait)
[430.494852] Starting subtest: init-wait
[430.497173] Starting dynamic subtest: rcs0
[430.499627] Dynamic subtest rcs0: SUCCESS (0.002s)
[430.511166] Starting dynamic subtest: bcs0
[430.513371] Dynamic subtest bcs0: SUCCESS (0.000s)
[430.523074] Starting dynamic subtest: vcs0
[430.525338] Dynamic subtest vcs0: SUCCESS (0.001s)
[430.535070] Starting dynamic subtest: vcs1
[430.537400] Dynamic subtest vcs1: SUCCESS (0.001s)
[430.547130] Starting dynamic subtest: vecs0
[430.549399] Dynamic subtest vecs0: SUCCESS (0.000s)
[430.558871] Starting dynamic subtest: ccs0
[430.560862] Dynamic subtest ccs0: SUCCESS (0.000s)
[430.562808] Subtest init-wait: SUCCESS (0.008s)
[430.602057] [147/155] (594s left) gem_ctx_param (vm)
[430.657038] Starting subtest: vm
[430.701250] Subtest vm: SUCCESS (0.044s)
[430.823185] [148/155] (593s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-wc)
[430.910351] Starting subtest: psr-rgb565-draw-mmap-wc
[437.634585] Subtest psr-rgb565-draw-mmap-wc: SUCCESS (6.728s)
[437.749984] [149/155] (587s left) prime_busy (before)
[437.805215] Starting subtest: before
[437.809952] Starting dynamic subtest: rcs0
[437.842261] Dynamic subtest rcs0: SUCCESS (0.034s)
[437.853647] Starting dynamic subtest: bcs0
[437.893634] Dynamic subtest bcs0: SUCCESS (0.051s)
[437.903864] Starting dynamic subtest: vcs0
[437.932955] Dynamic subtest vcs0: SUCCESS (0.037s)
[437.942639] Starting dynamic subtest: vcs1
[437.974906] Dynamic subtest vcs1: SUCCESS (0.042s)
[437.985168] Starting dynamic subtest: vecs0
[438.014381] Dynamic subtest vecs0: SUCCESS (0.037s)
[438.031300] Starting dynamic subtest: ccs0
[438.054259] Dynamic subtest ccs0: SUCCESS (0.040s)
[438.162583] Subtest before: SUCCESS (0.355s)
[438.233288] [150/155] (586s left) kms_async_flips (test-time-stamp)
[438.313971] Starting subtest: test-time-stamp
[438.707332] Starting dynamic subtest: pipe-A-eDP-1
[439.509133] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.801s)
[439.899572] Starting dynamic subtest: pipe-B-eDP-1
[440.743814] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.851s)
[441.121304] Starting dynamic subtest: pipe-C-eDP-1
[441.966568] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.851s)
[442.336015] Starting dynamic subtest: pipe-D-eDP-1
[443.110272] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.780s)
[443.112637] Subtest test-time-stamp: SUCCESS (4.796s)
[444.278406] [151/155] (580s left) gem_fenced_exec_thrash (no-spare-fences-busy)
[444.337729] Subtest no-spare-fences-busy: SKIP (0.000s)
[444.400954] [152/155] (580s left) kms_cursor_legacy (torture-move)
[444.506419] Starting subtest: torture-move
[444.508298] Starting dynamic subtest: pipe-A
[450.712592] Dynamic subtest pipe-A: SUCCESS (6.204s)
[450.732226] Starting dynamic subtest: pipe-B
[456.454614] Dynamic subtest pipe-B: SUCCESS (5.741s)
[456.466470] Starting dynamic subtest: pipe-C
[463.215771] Dynamic subtest pipe-C: SUCCESS (6.759s)
[463.230716] Starting dynamic subtest: pipe-D
[471.176319] Dynamic subtest pipe-D: SUCCESS (7.959s)
[471.189138] Starting dynamic subtest: all-pipes
[477.758717] Dynamic subtest all-pipes: SUCCESS (6.584s)
[477.760997] Subtest torture-move: SUCCESS (33.257s)
[477.922288] [153/155] (547s left) kms_atomic_interruptible (legacy-dpms)
[477.997940] Starting subtest: legacy-dpms
[478.000084] Starting dynamic subtest: pipe-A-eDP-1
[485.401498] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.402s)
[485.403800] Subtest legacy-dpms: SUCCESS (7.403s)
[486.234380] [154/155] (538s left) kms_flip (2x-flip-vs-dpms)
[486.312185] Starting subtest: 2x-flip-vs-dpms
[486.319637] Subtest 2x-flip-vs-dpms: SKIP (0.007s)
[486.410062] [155/155] (538s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc)
[486.484893] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc
[486.487150] Starting dynamic subtest: pipe-A-eDP-1
[486.990603] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.472s)
[487.003816] Starting dynamic subtest: pipe-B-eDP-1
[488.515284] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.526s)
[488.525708] Starting dynamic subtest: pipe-C-eDP-1
[489.961712] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.447s)
[489.972149] Starting dynamic subtest: pipe-D-eDP-1
[491.406746] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.443s)
[491.409009] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs-cc: SUCCESS (4.895s)
[492.566442] Closing watchdogs
results: parsing output: 0/ for test: gem_close_race
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: syncobj_timeline
results: parsing output: 3/ for test: kms_big_fb
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_chamelium_hpd
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: api_intel_bb
results: parsing output: 8/ for test: perf
results: parsing output: 9/ for test: kms_flip
results: parsing output: 10/ for test: kms_cursor_legacy
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: kms_psr
results: parsing output: 13/ for test: kms_frontbuffer_tracking
results: parsing output: 14/ for test: gem_ctx_shared
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: kms_cursor_legacy
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: kms_flip_scaled_crc
results: parsing output: 19/ for test: dumb_buffer
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: kms_ccs
results: parsing output: 24/ for test: gem_exec_fence
results: parsing output: 25/ for test: gem_ccs
results: parsing output: 26/ for test: kms_dsc
results: parsing output: 27/ for test: kms_cursor_crc
results: parsing output: 28/ for test: kms_cursor_legacy
results: parsing output: 29/ for test: kms_chamelium_audio
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: gem_exec_reloc
results: parsing output: 32/ for test: kms_chamelium_frames
results: parsing output: 33/ for test: kms_color
results: parsing output: 34/ for test: kms_cursor_legacy
results: parsing output: 35/ for test: kms_cursor_legacy
results: parsing output: 36/ for test: kms_psr
results: parsing output: 37/ for test: kms_cursor_legacy
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: kms_ccs
results: parsing output: 40/ for test: i915_query
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: kms_cursor_edge_walk
results: parsing output: 43/ for test: kms_flip
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: gem_exec_async
results: parsing output: 46/ for test: gem_linear_blits
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: syncobj_wait
results: parsing output: 49/ for test: kms_plane_scaling
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: kms_pm_dc
results: parsing output: 52/ for test: gem_mmap_wc
results: parsing output: 53/ for test: kms_plane_scaling
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: gem_render_copy
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_plane
results: parsing output: 58/ for test: i915_query
results: parsing output: 59/ for test: kms_ccs
results: parsing output: 60/ for test: kms_flip_scaled_crc
results: parsing output: 61/ for test: gem_mmap_gtt
results: parsing output: 62/ for test: gem_render_copy
results: parsing output: 63/ for test: kms_addfb_basic
results: parsing output: 64/ for test: kms_vblank
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_big_fb
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: gem_media_fill
results: parsing output: 69/ for test: kms_plane_multiple
results: parsing output: 70/ for test: kms_big_fb
results: parsing output: 71/ for test: api_intel_allocator
results: parsing output: 72/ for test: kms_pipe_crc_basic
results: parsing output: 73/ for test: kms_psr
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: gem_exec_balancer
results: parsing output: 76/ for test: kms_flip
results: parsing output: 77/ for test: kms_big_fb
results: parsing output: 78/ for test: kms_psr
results: parsing output: 79/ for test: gem_exec_schedule
results: parsing output: 80/ for test: gem_mmap_gtt
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_psr2_sf
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: i915_suspend
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: kms_prop_blob
results: parsing output: 90/ for test: gem_exec_params
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: syncobj_timeline
results: parsing output: 94/ for test: gem_linear_blits
results: parsing output: 95/ for test: kms_properties
results: parsing output: 96/ for test: kms_universal_plane
results: parsing output: 97/ for test: syncobj_timeline
results: parsing output: 98/ for test: gem_exec_whisper
results: parsing output: 99/ for test: kms_invalid_mode
results: parsing output: 100/ for test: gem_exec_reloc
results: parsing output: 101/ for test: gem_exec_balancer
results: parsing output: 102/ for test: gem_eio
results: parsing output: 103/ for test: kms_cursor_crc
results: parsing output: 104/ for test: perf_pmu
results: parsing output: 105/ for test: kms_pipe_crc_basic
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: gem_exec_schedule
results: parsing output: 108/ for test: gem_set_tiling_vs_blt
results: parsing output: 109/ for test: gem_userptr_blits
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_psr2_su
results: parsing output: 112/ for test: gem_userptr_blits
results: parsing output: 113/ for test: gem_lmem_evict
results: parsing output: 114/ for test: i915_pm_rpm
results: parsing output: 115/ for test: gem_mmap_gtt
results: parsing output: 116/ for test: kms_content_protection
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: gem_ctx_param
results: parsing output: 119/ for test: i915_drm_fdinfo
results: parsing output: 120/ for test: gem_shrink
results: parsing output: 121/ for test: kms_addfb_basic
results: parsing output: 122/ for test: gem_spin_batch
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: gen7_exec_parse
results: parsing output: 126/ for test: kms_flip_scaled_crc
results: parsing output: 127/ for test: i915_hangman
results: parsing output: 128/ for test: gem_mmap_gtt
results: parsing output: 129/ for test: kms_big_fb
results: parsing output: 130/ for test: kms_frontbuffer_tracking
results: parsing output: 131/ for test: kms_frontbuffer_tracking
results: parsing output: 132/ for test: kms_frontbuffer_tracking
results: parsing output: 133/ for test: kms_ccs
results: parsing output: 134/ for test: syncobj_wait
results: parsing output: 135/ for test: syncobj_timeline
results: parsing output: 136/ for test: gem_exec_nop
results: parsing output: 137/ for test: kms_async_flips
results: parsing output: 138/ for test: kms_frontbuffer_tracking
results: parsing output: 139/ for test: gem_pxp
results: parsing output: 140/ for test: sw_sync
results: parsing output: 141/ for test: gem_exec_reloc
results: parsing output: 142/ for test: kms_frontbuffer_tracking
results: parsing output: 143/ for test: kms_frontbuffer_tracking
results: parsing output: 144/ for test: kms_frontbuffer_tracking
results: parsing output: 145/ for test: perf_pmu
results: parsing output: 146/ for test: gem_ctx_param
results: parsing output: 147/ for test: kms_frontbuffer_tracking
results: parsing output: 148/ for test: prime_busy
results: parsing output: 149/ for test: kms_async_flips
results: parsing output: 150/ for test: gem_fenced_exec_thrash
results: parsing output: 151/ for test: kms_cursor_legacy
results: parsing output: 152/ for test: kms_atomic_interruptible
results: parsing output: 153/ for test: kms_flip
results: parsing output: 154/ for test: kms_ccs
Done.