[107.398634] Initializing watchdogs
[107.398699]   /dev/watchdog0
[107.419734] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[107.431060] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[107.434736] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[107.436840] [001/133] (960s left) gem_partial_pwrite_pread (write-snoop)
[107.520141] Subtest write-snoop: SKIP (0.000s)
[107.646651] [002/133] (960s left) kms_content_protection (content-type-change)
[109.220766] Starting subtest: content-type-change
[109.227879] Subtest content-type-change: SKIP (0.005s)
[109.428106] [003/133] (958s left) kms_rotation_crc (multiplane-rotation)
[110.932124] Starting subtest: multiplane-rotation
[141.121077] Subtest multiplane-rotation: SUCCESS (30.191s)
[141.334604] [004/133] (926s left) kms_chamelium_color (ctm-red-to-blue)
[142.837932] Subtest ctm-red-to-blue: SKIP (0.000s)
[142.889944] [005/133] (925s left) syncobj_wait (invalid-reset-one-illegal-handle)
[142.963160] Starting subtest: invalid-reset-one-illegal-handle
[142.964058] Subtest invalid-reset-one-illegal-handle: SUCCESS (0.000s)
[143.160860] [006/133] (925s left) kms_pipe_crc_basic (disable-crc-after-crtc)
[144.663443] Starting subtest: disable-crc-after-crtc
[144.664335] Starting dynamic subtest: pipe-A-HDMI-A-3
[145.289408] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.625s)
[145.297970] Starting dynamic subtest: pipe-B-HDMI-A-3
[145.732807] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.442s)
[145.742230] Starting dynamic subtest: pipe-C-HDMI-A-3
[146.160649] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.426s)
[146.170023] Starting dynamic subtest: pipe-D-HDMI-A-3
[146.626037] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.463s)
[146.626961] Subtest disable-crc-after-crtc: SUCCESS (1.963s)
[146.868135] [007/133] (921s left) gem_set_tiling_vs_blt (tiled-to-tiled)
[146.945265] Subtest tiled-to-tiled: SKIP (0.000s)
[147.018711] [008/133] (921s left) syncobj_wait (wait-all-interrupted)
[147.085169] Starting subtest: wait-all-interrupted
[147.188531] Subtest wait-all-interrupted: SUCCESS (0.102s)
[147.337673] [009/133] (921s left) syncobj_wait (wait-all-complex)
[147.406178] Starting subtest: wait-all-complex
[147.644381] Subtest wait-all-complex: SUCCESS (0.216s)
[147.803636] [010/133] (920s left) gem_pxp (reject-modify-context-protection-on)
[150.402654] Starting subtest: reject-modify-context-protection-on
[150.404557] Subtest reject-modify-context-protection-on: SKIP (0.000s)
[150.522788] [011/133] (918s left) kms_cursor_legacy (cursora-vs-flipb-varying-size)
[152.029609] Starting subtest: cursorA-vs-flipB-varying-size
[152.031329] Subtest cursorA-vs-flipB-varying-size: SKIP (0.001s)
[152.189397] [012/133] (916s left) kms_rotation_crc (primary-rotation-90)
[153.728261] Starting subtest: primary-rotation-90
[153.730089] Subtest primary-rotation-90: SKIP (0.001s)
[153.900436] [013/133] (914s left) syncobj_wait (reset-multiple-signaled)
[154.001257] Starting subtest: reset-multiple-signaled
[154.002166] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[154.183272] [014/133] (914s left) kms_ccs (crc-primary-rotation-180-4-tiled-bmg-ccs)
[155.696485] Starting subtest: crc-primary-rotation-180-4-tiled-bmg-ccs
[155.698285] Subtest crc-primary-rotation-180-4-tiled-bmg-ccs: SKIP (0.000s)
[155.944351] [015/133] (913s left) gem_softpin (noreloc-s3)
[156.038044] Starting subtest: noreloc-S3
[176.313495] Subtest noreloc-S3: SUCCESS (5.474s)
[181.496452] [016/133] (892s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt)
[183.058593] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt
[186.028223] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (2.900s)
[186.258408] [017/133] (887s left) gem_ctx_param (invalid-ctx-set)
[186.330382] Starting subtest: invalid-ctx-set
[186.332358] Subtest invalid-ctx-set: SUCCESS (0.001s)
[186.495730] [018/133] (887s left) syncobj_wait (single-wait-all-for-submit-unsubmitted)
[186.571320] Starting subtest: single-wait-all-for-submit-unsubmitted
[186.678058] Subtest single-wait-all-for-submit-unsubmitted: SUCCESS (0.104s)
[186.818512] [019/133] (887s left) kms_big_fb (x-tiled-64bpp-rotate-90)
[188.367263] Starting subtest: x-tiled-64bpp-rotate-90
[188.435073] Subtest x-tiled-64bpp-rotate-90: SKIP (0.066s)
[188.679647] [020/133] (885s left) gem_mmap_gtt (cpuset-basic-small-copy-xy)
[188.750931] Subtest cpuset-basic-small-copy-XY: SKIP (0.000s)
[188.812097] [021/133] (885s left) kms_psr (fbc-psr-cursor-plane-move)
[190.332910] Subtest fbc-psr-cursor-plane-move: SKIP (0.000s)
[190.382605] [022/133] (883s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180)
[191.921148] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180
[193.219911] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.287s)
[193.430293] [023/133] (880s left) kms_flip (2x-flip-vs-rmfb)
[194.941498] Starting subtest: 2x-flip-vs-rmfb
[194.953447] Subtest 2x-flip-vs-rmfb: SKIP (0.013s)
[195.111757] [024/133] (879s left) kms_plane_cursor (viewport)
[196.662128] Starting subtest: viewport
[196.663888] Starting dynamic subtest: pipe-A-HDMI-A-3-size-64
[199.955230] Dynamic subtest pipe-A-HDMI-A-3-size-64: SUCCESS (3.277s)
[200.034228] Starting dynamic subtest: pipe-A-HDMI-A-3-size-128
[203.247234] Dynamic subtest pipe-A-HDMI-A-3-size-128: SUCCESS (3.216s)
[203.354352] Starting dynamic subtest: pipe-A-HDMI-A-3-size-256
[206.571956] Dynamic subtest pipe-A-HDMI-A-3-size-256: SUCCESS (3.248s)
[206.671361] Starting dynamic subtest: pipe-B-HDMI-A-3-size-64
[209.909401] Dynamic subtest pipe-B-HDMI-A-3-size-64: SUCCESS (3.241s)
[209.970952] Starting dynamic subtest: pipe-B-HDMI-A-3-size-128
[213.127099] Dynamic subtest pipe-B-HDMI-A-3-size-128: SUCCESS (3.166s)
[213.188925] Starting dynamic subtest: pipe-B-HDMI-A-3-size-256
[216.429054] Dynamic subtest pipe-B-HDMI-A-3-size-256: SUCCESS (3.250s)
[216.514048] Starting dynamic subtest: pipe-C-HDMI-A-3-size-64
[219.780022] Dynamic subtest pipe-C-HDMI-A-3-size-64: SUCCESS (3.274s)
[219.837700] Starting dynamic subtest: pipe-C-HDMI-A-3-size-128
[223.014494] Dynamic subtest pipe-C-HDMI-A-3-size-128: SUCCESS (3.183s)
[223.072602] Starting dynamic subtest: pipe-C-HDMI-A-3-size-256
[226.249027] Dynamic subtest pipe-C-HDMI-A-3-size-256: SUCCESS (3.183s)
[226.349843] Starting dynamic subtest: pipe-D-HDMI-A-3-size-64
[229.597033] Dynamic subtest pipe-D-HDMI-A-3-size-64: SUCCESS (3.255s)
[229.674767] Starting dynamic subtest: pipe-D-HDMI-A-3-size-128
[232.899235] Dynamic subtest pipe-D-HDMI-A-3-size-128: SUCCESS (3.249s)
[232.966782] Starting dynamic subtest: pipe-D-HDMI-A-3-size-256
[236.032812] Dynamic subtest pipe-D-HDMI-A-3-size-256: SUCCESS (3.083s)
[236.106537] Subtest viewport: SUCCESS (39.398s)
[236.364531] [025/133] (838s left) kms_cdclk (mode-transition)
[237.868730] Starting subtest: mode-transition
[237.869610] Starting dynamic subtest: pipe-A-HDMI-A-3
[237.914046] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.044s)
[237.923324] Starting dynamic subtest: pipe-B-HDMI-A-3
[237.925160] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.002s)
[237.934520] Starting dynamic subtest: pipe-C-HDMI-A-3
[237.936275] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.002s)
[237.945359] Starting dynamic subtest: pipe-D-HDMI-A-3
[237.947039] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.002s)
[237.948765] Subtest mode-transition: SKIP (0.056s)
[238.129860] [026/133] (836s left) gem_exec_balancer (fairslice)
[238.212521] Starting subtest: fairslice
[243.835380] Subtest fairslice: SUCCESS (5.620s)
[244.284519] [027/133] (830s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[245.786758] Starting subtest: basic-flip-before-cursor-varying-size
[246.781365] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.993s)
[247.049798] [028/133] (827s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-downscaling)
[248.564825] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-downscaling
[248.565781] Starting dynamic subtest: pipe-A-valid-mode
[248.605009] Dynamic subtest pipe-A-valid-mode: SKIP (0.038s)
[248.606809] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-downscaling: SKIP (0.039s)
[248.808069] [029/133] (826s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling)
[250.314014] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling
[250.314897] Starting dynamic subtest: pipe-A-valid-mode
[251.168752] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.853s)
[251.169705] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SUCCESS (0.854s)
[251.430818] [030/133] (823s left) core_getstats (basic)
[251.499308] Starting subtest: basic
[251.500190] Subtest basic: SUCCESS (0.000s)
[251.671405] [031/133] (823s left) kms_rmfb (close-fd)
[253.181939] Starting subtest: close-fd
[253.182822] Starting dynamic subtest: pipe-A-HDMI-A-3
[253.377412] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.194s)
[253.417102] Starting dynamic subtest: pipe-B-HDMI-A-3
[253.622074] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.238s)
[253.637822] Starting dynamic subtest: pipe-C-HDMI-A-3
[253.829765] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.205s)
[253.845321] Starting dynamic subtest: pipe-D-HDMI-A-3
[254.045457] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.213s)
[254.046582] Subtest close-fd: SUCCESS (0.865s)
[254.324095] [032/133] (820s left) gem_exec_reloc (basic-gtt-wc)
[254.396400] Subtest basic-gtt-wc: SKIP (0.000s)
[254.466715] [033/133] (820s left) kms_properties (crtc-properties-legacy)
[255.970792] Starting subtest: crtc-properties-legacy
[255.971747] Starting dynamic subtest: pipe-A-HDMI-A-3
[256.288041] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.314s)
[256.330907] Starting dynamic subtest: pipe-B-HDMI-A-3
[256.597561] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.303s)
[256.609144] Starting dynamic subtest: pipe-C-HDMI-A-3
[256.863973] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.264s)
[256.875423] Starting dynamic subtest: pipe-D-HDMI-A-3
[257.130507] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.264s)
[257.131412] Subtest crtc-properties-legacy: SUCCESS (1.160s)
[257.393815] [034/133] (817s left) kms_invalid_mode (zero-hdisplay)
[258.899764] Starting subtest: zero-hdisplay
[258.900681] Starting dynamic subtest: pipe-A-HDMI-A-3
[258.944822] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.044s)
[258.956050] Starting dynamic subtest: pipe-B-HDMI-A-3
[258.956988] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.001s)
[258.966499] Starting dynamic subtest: pipe-C-HDMI-A-3
[258.967490] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.001s)
[258.976473] Starting dynamic subtest: pipe-D-HDMI-A-3
[258.977345] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.001s)
[258.978283] Subtest zero-hdisplay: SUCCESS (0.054s)
[259.186193] [035/133] (816s left) kms_plane_scaling (plane-upscale-factor-0-25-with-pixel-format)
[260.688018] Starting subtest: plane-upscale-factor-0-25-with-pixel-format
[260.688858] Starting dynamic subtest: pipe-A
[262.372891] Dynamic subtest pipe-A: SUCCESS (1.684s)
[262.390406] Starting dynamic subtest: pipe-B
[264.014270] Dynamic subtest pipe-B: SUCCESS (1.639s)
[264.030509] Starting dynamic subtest: pipe-C
[264.239253] Dynamic subtest pipe-C: SUCCESS (0.223s)
[264.271556] Starting dynamic subtest: pipe-D
[264.480146] Dynamic subtest pipe-D: SUCCESS (0.238s)
[264.481226] Subtest plane-upscale-factor-0-25-with-pixel-format: SUCCESS (3.792s)
[264.780759] [036/133] (810s left) kms_pm_rpm (legacy-planes-dpms)
[268.819296] Starting subtest: legacy-planes-dpms
[268.820418] Starting dynamic subtest: plane-63
[275.790530] Dynamic subtest plane-63: SUCCESS (6.966s)
[275.838079] Starting dynamic subtest: plane-93
[282.689647] Dynamic subtest plane-93: SUCCESS (6.898s)
[282.731064] Starting dynamic subtest: plane-123
[289.582087] Dynamic subtest plane-123: SUCCESS (6.892s)
[289.629139] Starting dynamic subtest: plane-133
[296.472271] Dynamic subtest plane-133: SUCCESS (6.887s)
[296.477087] Subtest legacy-planes-dpms: SUCCESS (27.658s)
[297.525761] [037/133] (778s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[299.030883] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt
[299.032641] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[299.258730] [038/133] (776s left) kms_dirtyfb (default-dirtyfb-ioctl)
[300.768022] Starting subtest: default-dirtyfb-ioctl
[300.768977] Starting dynamic subtest: A-HDMI-A-3
[302.187135] Dynamic subtest A-HDMI-A-3: SUCCESS (1.419s)
[302.188013] Subtest default-dirtyfb-ioctl: SUCCESS (1.421s)
[302.441644] [039/133] (773s left) kms_cursor_legacy (cursorb-vs-flipa-legacy)
[303.946989] Starting subtest: cursorB-vs-flipA-legacy
[303.950287] Subtest cursorB-vs-flipA-legacy: SKIP (0.002s)
[304.098145] [040/133] (771s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[304.199232] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[304.200180] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.000s)
[304.396229] [041/133] (771s left) kms_prime (basic-crc-vgem)
[305.945407] Subtest basic-crc-vgem: SKIP (0.000s)
[306.143910] [FACT kms_prime (basic-crc-vgem)] new: kernel.kmod_is_loaded.vgem: true
[306.146008] [042/133] (769s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c)
[306.224229] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s)
[306.308568] [043/133] (769s left) i915_drm_fdinfo (busy)
[306.380248] Starting subtest: busy
[306.381288] Starting dynamic subtest: rcs0
[306.403171] Dynamic subtest rcs0: SKIP (0.023s)
[306.413491] Starting dynamic subtest: bcs0
[306.423066] Dynamic subtest bcs0: SKIP (0.019s)
[306.434166] Starting dynamic subtest: vcs0
[306.436135] Dynamic subtest vcs0: SKIP (0.000s)
[306.447379] Starting dynamic subtest: vcs1
[306.449662] Dynamic subtest vcs1: SKIP (0.000s)
[306.460776] Starting dynamic subtest: vecs0
[306.463203] Dynamic subtest vecs0: SKIP (0.000s)
[306.474310] Starting dynamic subtest: vecs1
[306.476565] Dynamic subtest vecs1: SKIP (0.000s)
[306.486593] Starting dynamic subtest: ccs0
[306.488749] Dynamic subtest ccs0: SKIP (0.000s)
[306.490992] Subtest busy: SKIP (0.052s)
[306.551241] [044/133] (769s left) gem_userptr_blits (nohangcheck)
[306.650331] Starting subtest: nohangcheck
[306.967615] Subtest nohangcheck: SUCCESS (0.316s)
[307.180957] [045/133] (769s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[308.714923] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[309.420783] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.705s)
[309.704388] [046/133] (766s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs)
[311.224000] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs
[311.225813] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[311.495476] [047/133] (764s left) kms_scaling_modes (scaling-mode-full)
[313.010199] Starting subtest: scaling-mode-full
[313.015617] Subtest scaling-mode-full: SKIP (0.001s)
[313.190591] [048/133] (763s left) kms_psr (fbc-pr-basic)
[314.724249] Subtest fbc-pr-basic: SKIP (0.000s)
[314.783845] [049/133] (761s left) gem_ringfill (basic-all)
[315.234820] Starting subtest: basic-all
[317.017037] Subtest basic-all: SUCCESS (1.784s)
[317.226171] [050/133] (759s left) gem_exec_whisper (basic-fds-forked-all)
[317.317182] Starting subtest: basic-fds-forked-all
[340.050631] Subtest basic-fds-forked-all: SUCCESS (22.728s)
[340.335616] [051/133] (736s left) api_intel_bb (full-batch)
[340.414315] Starting subtest: full-batch
[340.441257] Subtest full-batch: SUCCESS (0.028s)
[340.661423] [052/133] (736s left) kms_cursor_crc (cursor-sliding-256x85)
[342.420197] Starting subtest: cursor-sliding-256x85
[342.425294] Starting dynamic subtest: pipe-A-HDMI-A-3
[346.770284] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (4.344s)
[346.807498] Starting dynamic subtest: pipe-D-HDMI-A-3
[351.095281] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (4.297s)
[351.096181] Subtest cursor-sliding-256x85: SUCCESS (8.674s)
[351.427535] [053/133] (725s left) kms_ccs (crc-sprite-planes-basic-y-tiled-ccs)
[352.940984] Starting subtest: crc-sprite-planes-basic-y-tiled-ccs
[352.941842] Starting dynamic subtest: pipe-A-HDMI-A-3
[352.963286] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.002s)
[352.974062] Starting dynamic subtest: pipe-B-HDMI-A-3
[352.995586] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.002s)
[353.006484] Starting dynamic subtest: pipe-C-HDMI-A-3
[353.028396] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.002s)
[353.039028] Starting dynamic subtest: pipe-D-HDMI-A-3
[353.061289] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.002s)
[353.062972] Subtest crc-sprite-planes-basic-y-tiled-ccs: SKIP (0.015s)
[353.268654] [054/133] (723s left) gen9_exec_parse (allowed-single)
[353.356257] Subtest allowed-single: SKIP (0.000s)
[353.424018] [055/133] (723s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[354.943788] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu
[354.945432] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[355.176247] [056/133] (722s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[356.707286] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip
[356.709249] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[356.942427] [057/133] (720s left) gem_exec_fence (expired-history)
[357.532797] Starting subtest: expired-history
[364.125143] Subtest expired-history: SUCCESS (6.590s)
[365.557919] [058/133] (711s left) kms_psr (fbc-psr-sprite-plane-move)
[367.068270] Subtest fbc-psr-sprite-plane-move: SKIP (0.000s)
[367.130473] [059/133] (710s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc)
[368.653842] Starting subtest: fbcpsr-rgb565-draw-mmap-wc
[368.655813] Subtest fbcpsr-rgb565-draw-mmap-wc: SKIP (0.000s)
[368.886523] [060/133] (708s left) gem_ctx_bad_destroy (double-destroy)
[368.964576] Starting subtest: double-destroy
[368.965431] Subtest double-destroy: SUCCESS (0.000s)
[369.128973] [061/133] (708s left) syncobj_timeline (invalid-signal-illegal-handle)
[369.210282] Starting subtest: invalid-signal-illegal-handle
[369.211190] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[369.364718] [062/133] (708s left) kms_chamelium_hpd (common-hpd-after-suspend)
[370.951953] Subtest common-hpd-after-suspend: SKIP (0.000s)
[371.154299] [063/133] (706s left) kms_frontbuffer_tracking (fbc-tiling-4)
[372.668848] Starting subtest: fbc-tiling-4
[375.328976] Subtest fbc-tiling-4: SUCCESS (2.659s)
[375.595540] [064/133] (702s left) gem_cs_tlb (engines)
[375.678228] Starting subtest: engines
[375.679144] Starting dynamic subtest: rcs0
[377.833552] Dynamic subtest rcs0: SUCCESS (2.153s)
[377.844455] Starting dynamic subtest: bcs0
[379.990175] Dynamic subtest bcs0: SUCCESS (2.152s)
[380.001035] Starting dynamic subtest: vcs0
[382.143537] Dynamic subtest vcs0: SUCCESS (2.154s)
[382.154299] Starting dynamic subtest: vcs1
[384.297311] Dynamic subtest vcs1: SUCCESS (2.152s)
[384.308107] Starting dynamic subtest: vecs0
[386.451063] Dynamic subtest vecs0: SUCCESS (2.152s)
[386.462010] Starting dynamic subtest: vecs1
[388.607653] Dynamic subtest vecs1: SUCCESS (2.155s)
[388.618503] Starting dynamic subtest: ccs0
[390.762974] Dynamic subtest ccs0: SUCCESS (2.153s)
[390.763849] Subtest engines: SUCCESS (15.079s)
[390.961071] [065/133] (687s left) gem_mmap_gtt (hang-busy)
[391.039011] Subtest hang-busy: SKIP (0.000s)
[391.113556] [066/133] (686s left) kms_psr (psr2-sprite-plane-onoff)
[392.626124] Subtest psr2-sprite-plane-onoff: SKIP (0.000s)
[392.679224] [067/133] (685s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[394.209902] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[394.884578] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.674s)
[395.151542] [068/133] (683s left) kms_big_fb (y-tiled-64bpp-rotate-270)
[396.673899] Starting subtest: y-tiled-64bpp-rotate-270
[396.675768] Subtest y-tiled-64bpp-rotate-270: SKIP (0.000s)
[396.891358] [069/133] (681s left) gem_bad_reloc (negative-reloc-lut)
[396.978230] Subtest negative-reloc-lut: SKIP (0.000s)
[397.067729] [070/133] (681s left) gem_ctx_persistence (engines-mixed)
[397.154225] Starting subtest: engines-mixed
[397.155142] Starting dynamic subtest: rcs0
[397.277301] Dynamic subtest rcs0: SUCCESS (0.122s)
[397.299129] Starting dynamic subtest: bcs0
[397.341136] Dynamic subtest bcs0: SUCCESS (0.061s)
[397.384145] Starting dynamic subtest: vcs0
[397.424275] Dynamic subtest vcs0: SUCCESS (0.079s)
[397.449843] Starting dynamic subtest: vcs1
[397.492390] Dynamic subtest vcs1: SUCCESS (0.066s)
[397.510174] Starting dynamic subtest: vecs0
[397.555949] Dynamic subtest vecs0: SUCCESS (0.061s)
[397.598267] Starting dynamic subtest: vecs1
[397.642461] Dynamic subtest vecs1: SUCCESS (0.083s)
[397.672491] Starting dynamic subtest: ccs0
[397.731106] Dynamic subtest ccs0: SUCCESS (0.086s)
[397.736700] Subtest engines-mixed: SUCCESS (0.578s)
[397.907407] [071/133] (680s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-factor-0-25)
[399.421951] Starting subtest: planes-downscale-factor-0-75-upscale-factor-0-25
[399.422817] Starting dynamic subtest: pipe-A
[399.503192] Dynamic subtest pipe-A: SUCCESS (0.081s)
[399.514886] Starting dynamic subtest: pipe-B
[399.628181] Dynamic subtest pipe-B: SUCCESS (0.125s)
[399.645123] Starting dynamic subtest: pipe-C
[399.773062] Dynamic subtest pipe-C: SUCCESS (0.144s)
[399.786207] Starting dynamic subtest: pipe-D
[399.897148] Dynamic subtest pipe-D: SUCCESS (0.122s)
[399.898059] Subtest planes-downscale-factor-0-75-upscale-factor-0-25: SUCCESS (0.477s)
[400.147210] [072/133] (678s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[401.660792] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[401.662541] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[401.883257] [073/133] (676s left) gem_exec_schedule (semaphore-noskip)
[401.978324] Starting subtest: semaphore-noskip
[402.788058] Subtest semaphore-noskip: SUCCESS (0.809s)
[403.203248] [074/133] (675s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[404.719818] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc
[404.721633] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[404.952857] [075/133] (673s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-render)
[406.474834] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-render
[406.476719] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[406.699727] [076/133] (672s left) kms_big_fb (4-tiled-16bpp-rotate-0)
[408.224580] Starting subtest: 4-tiled-16bpp-rotate-0
[410.021927] Subtest 4-tiled-16bpp-rotate-0: SUCCESS (1.797s)
[410.273831] [077/133] (668s left) gem_exec_basic (basic)
[410.355496] Starting subtest: basic
[410.356338] Starting dynamic subtest: rcs0-smem
[410.358848] Dynamic subtest rcs0-smem: SUCCESS (0.003s)
[410.371492] Starting dynamic subtest: bcs0-smem
[410.372320] Dynamic subtest bcs0-smem: SUCCESS (0.001s)
[410.383487] Starting dynamic subtest: vcs0-smem
[410.384534] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[410.395474] Starting dynamic subtest: vcs1-smem
[410.396609] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[410.407030] Starting dynamic subtest: vecs0-smem
[410.408129] Dynamic subtest vecs0-smem: SUCCESS (0.001s)
[410.418511] Starting dynamic subtest: vecs1-smem
[410.419538] Dynamic subtest vecs1-smem: SUCCESS (0.000s)
[410.430043] Starting dynamic subtest: ccs0-smem
[410.431274] Dynamic subtest ccs0-smem: SUCCESS (0.001s)
[410.441603] Starting dynamic subtest: rcs0-lmem0
[410.442591] Dynamic subtest rcs0-lmem0: SUCCESS (0.001s)
[410.453001] Starting dynamic subtest: bcs0-lmem0
[410.454013] Dynamic subtest bcs0-lmem0: SUCCESS (0.000s)
[410.464377] Starting dynamic subtest: vcs0-lmem0
[410.465444] Dynamic subtest vcs0-lmem0: SUCCESS (0.000s)
[410.475886] Starting dynamic subtest: vcs1-lmem0
[410.477070] Dynamic subtest vcs1-lmem0: SUCCESS (0.000s)
[410.487618] Starting dynamic subtest: vecs0-lmem0
[410.488608] Dynamic subtest vecs0-lmem0: SUCCESS (0.000s)
[410.499368] Starting dynamic subtest: vecs1-lmem0
[410.500367] Dynamic subtest vecs1-lmem0: SUCCESS (0.000s)
[410.511374] Starting dynamic subtest: ccs0-lmem0
[410.512445] Dynamic subtest ccs0-lmem0: SUCCESS (0.000s)
[410.513614] Subtest basic: SUCCESS (0.022s)
[410.626662] [078/133] (668s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[412.143029] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[412.144813] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[412.367273] [079/133] (666s left) gem_mmap (short-mmap)
[412.447026] Subtest short-mmap: SKIP (0.000s)
[412.514814] [080/133] (666s left) gem_exec_reloc (basic-gtt-wc-active)
[412.597229] Subtest basic-gtt-wc-active: SKIP (0.000s)
[412.693598] [081/133] (666s left) gem_ctx_shared (create-shared-gtt)
[412.781234] Starting subtest: create-shared-gtt
[414.930905] Subtest create-shared-gtt: SUCCESS (2.150s)
[417.577265] [082/133] (661s left) gem_exec_reloc (basic-write-wc)
[417.659259] Subtest basic-write-wc: SKIP (0.000s)
[417.730918] [083/133] (661s left) gem_eio (wait-immediate)
[418.033270] Starting subtest: wait-immediate
[418.634764] Subtest wait-immediate: SUCCESS (0.602s)
[420.252685] [084/133] (659s left) gem_ctx_persistence (legacy-engines-mixed)
[420.353670] Starting subtest: legacy-engines-mixed
[420.354535] Starting dynamic subtest: render
[420.475188] Dynamic subtest render: SUCCESS (0.121s)
[420.493048] Starting dynamic subtest: bsd1
[420.539896] Dynamic subtest bsd1: SUCCESS (0.062s)
[420.579909] Starting dynamic subtest: bsd2
[420.632918] Dynamic subtest bsd2: SUCCESS (0.089s)
[420.675217] Starting dynamic subtest: blt
[420.735979] Dynamic subtest blt: SUCCESS (0.099s)
[420.778273] Starting dynamic subtest: vebox
[420.808173] Dynamic subtest vebox: SUCCESS (0.067s)
[420.809259] Subtest legacy-engines-mixed: SUCCESS (0.455s)
[421.033135] [085/133] (658s left) perf_pmu (semaphore-busy)
[421.106017] Starting subtest: semaphore-busy
[421.106974] Starting dynamic subtest: rcs0
[422.785986] Dynamic subtest rcs0: SUCCESS (1.679s)
[422.834467] Starting dynamic subtest: bcs0
[424.434486] Dynamic subtest bcs0: SUCCESS (1.642s)
[424.455009] Starting dynamic subtest: vcs0
[426.082489] Dynamic subtest vcs0: SUCCESS (1.643s)
[426.096186] Starting dynamic subtest: vcs1
[427.723119] Dynamic subtest vcs1: SUCCESS (1.637s)
[427.744394] Starting dynamic subtest: vecs0
[429.373599] Dynamic subtest vecs0: SUCCESS (1.645s)
[429.395019] Starting dynamic subtest: vecs1
[431.019980] Dynamic subtest vecs1: SUCCESS (1.642s)
[431.040760] Starting dynamic subtest: ccs0
[432.666424] Dynamic subtest ccs0: SUCCESS (1.641s)
[432.668298] Subtest semaphore-busy: SUCCESS (11.563s)
[432.908575] [086/133] (646s left) gem_exec_schedule (pi-common)
[433.128809] Starting subtest: pi-common
[433.130291] Starting dynamic subtest: rcs0
[433.180875] Dynamic subtest rcs0: SUCCESS (0.051s)
[433.193127] Starting dynamic subtest: bcs0
[433.217588] Dynamic subtest bcs0: SUCCESS (0.036s)
[433.231448] Starting dynamic subtest: vcs0
[433.251748] Dynamic subtest vcs0: SUCCESS (0.033s)
[433.264140] Starting dynamic subtest: vcs1
[433.284387] Dynamic subtest vcs1: SUCCESS (0.032s)
[433.298312] Starting dynamic subtest: vecs0
[433.315081] Dynamic subtest vecs0: SUCCESS (0.030s)
[433.328958] Starting dynamic subtest: vecs1
[433.344694] Dynamic subtest vecs1: SUCCESS (0.029s)
[433.357250] Starting dynamic subtest: ccs0
[433.373619] Dynamic subtest ccs0: SUCCESS (0.028s)
[433.374543] Subtest pi-common: SUCCESS (0.246s)
[433.678365] [087/133] (646s left) i915_hangman (engine-error-state-capture)
[433.767833] Starting subtest: engine-error-state-capture
[433.768815] Starting dynamic subtest: rcs0
[436.367609] Dynamic subtest rcs0: SUCCESS (2.600s)
[436.384210] Starting dynamic subtest: bcs0
[440.358218] Dynamic subtest bcs0: SUCCESS (3.989s)
[440.372009] Starting dynamic subtest: vcs0
[444.391222] Dynamic subtest vcs0: SUCCESS (4.032s)
[444.405009] Starting dynamic subtest: vcs1
[448.359193] Dynamic subtest vcs1: SUCCESS (3.967s)
[448.372959] Starting dynamic subtest: vecs0
[452.408207] Dynamic subtest vecs0: SUCCESS (4.048s)
[452.421889] Starting dynamic subtest: vecs1
[456.359273] Dynamic subtest vecs1: SUCCESS (3.950s)
[456.372042] Starting dynamic subtest: ccs0
[460.355142] Dynamic subtest ccs0: SUCCESS (3.995s)
[460.356089] Subtest engine-error-state-capture: SUCCESS (26.590s)
[460.548460] [088/133] (619s left) syncobj_timeline (wait-for-submit-snapshot)
[460.626311] Starting subtest: wait-for-submit-snapshot
[460.711261] Subtest wait-for-submit-snapshot: SUCCESS (0.084s)
[460.903715] [089/133] (619s left) kms_color (ctm-blue-to-red)
[462.416886] Starting subtest: ctm-blue-to-red
[462.417823] Starting dynamic subtest: pipe-A-HDMI-A-3
[463.122230] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.705s)
[463.136325] Starting dynamic subtest: pipe-B-HDMI-A-3
[463.618788] Dynamic subtest pipe-B-HDMI-A-3: SUCCESS (0.495s)
[463.631023] Starting dynamic subtest: pipe-C-HDMI-A-3
[464.115355] Dynamic subtest pipe-C-HDMI-A-3: SUCCESS (0.497s)
[464.128927] Starting dynamic subtest: pipe-D-HDMI-A-3
[464.618902] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.502s)
[464.619844] Subtest ctm-blue-to-red: SUCCESS (2.203s)
[464.872904] [090/133] (615s left) prime_vgem (basic-gtt)
[464.975762] Starting subtest: basic-gtt
[464.977904] Subtest basic-gtt: SKIP (0.000s)
[465.173846] [091/133] (614s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[466.687830] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[466.689513] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[466.924430] [092/133] (613s left) api_intel_allocator (default-alignment)
[467.002309] Starting subtest: default-alignment
[467.008212] Subtest default-alignment: SUCCESS (0.006s)
[467.234973] [093/133] (613s left) i915_pm_rps (fence-order)
[467.322343] Starting subtest: fence-order
[471.721481] Subtest fence-order: SUCCESS (4.397s)
[471.904085] [094/133] (608s left) kms_vblank (query-busy)
[473.413940] Starting subtest: query-busy
[473.414829] Starting dynamic subtest: pipe-A-HDMI-A-3
[475.863096] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.448s)
[475.878982] Starting dynamic subtest: pipe-D-HDMI-A-3
[478.232594] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.366s)
[478.233435] Subtest query-busy: SUCCESS (4.820s)
[478.471329] [095/133] (602s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0)
[479.993363] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0
[479.995100] Subtest y-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[480.198963] [096/133] (600s left) kms_addfb_basic (invalid-get-prop-any)
[480.279465] Starting subtest: invalid-get-prop-any
[480.280350] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[481.954658] [097/133] (598s left) kms_psr (fbc-psr2-cursor-mmap-gtt)
[483.476316] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.000s)
[483.531272] [098/133] (597s left) kms_flip (2x-blocking-absolute-wf_vblank)
[485.046787] Starting subtest: 2x-blocking-absolute-wf_vblank
[485.059430] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.013s)
[485.274629] [099/133] (595s left) kms_cursor_crc (cursor-onscreen-256x85)
[487.039629] Starting subtest: cursor-onscreen-256x85
[487.044882] Starting dynamic subtest: pipe-A-HDMI-A-3
[489.658860] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (2.614s)
[489.698620] Starting dynamic subtest: pipe-D-HDMI-A-3
[492.234277] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (2.547s)
[492.235147] Subtest cursor-onscreen-256x85: SUCCESS (5.194s)
[492.567710] [100/133] (588s left) kms_flip (2x-modeset-vs-vblank-race)
[494.079159] Starting subtest: 2x-modeset-vs-vblank-race
[494.092284] Subtest 2x-modeset-vs-vblank-race: SKIP (0.013s)
[494.292509] [101/133] (586s left) kms_atomic_interruptible (atomic-setmode)
[495.808022] Starting subtest: atomic-setmode
[495.810183] Starting dynamic subtest: pipe-A-HDMI-A-3
[501.995642] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (6.184s)
[501.996523] Subtest atomic-setmode: SUCCESS (6.186s)
[502.226615] [102/133] (578s left) kms_frontbuffer_tracking (psr-argb161616f-draw-render)
[503.744833] Starting subtest: psr-argb161616f-draw-render
[503.746693] Subtest psr-argb161616f-draw-render: SKIP (0.000s)
[503.978072] [103/133] (577s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[505.504768] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt
[505.506638] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[505.744442] [104/133] (575s left) kms_plane_scaling (invalid-num-scalers)
[507.257004] Starting subtest: invalid-num-scalers
[507.260744] Starting dynamic subtest: pipe-A-HDMI-A-3-invalid-num-scalers
[507.281345] Dynamic subtest pipe-A-HDMI-A-3-invalid-num-scalers: SUCCESS (0.020s)
[507.297678] Starting dynamic subtest: pipe-B-HDMI-A-3-invalid-num-scalers
[507.322726] Dynamic subtest pipe-B-HDMI-A-3-invalid-num-scalers: SUCCESS (0.036s)
[507.339281] Starting dynamic subtest: pipe-C-HDMI-A-3-invalid-num-scalers
[507.363118] Dynamic subtest pipe-C-HDMI-A-3-invalid-num-scalers: SUCCESS (0.036s)
[507.380333] Starting dynamic subtest: pipe-D-HDMI-A-3-invalid-num-scalers
[507.404295] Dynamic subtest pipe-D-HDMI-A-3-invalid-num-scalers: SUCCESS (0.036s)
[507.405139] Subtest invalid-num-scalers: SUCCESS (0.149s)
[507.575006] [105/133] (573s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[509.095795] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt
[509.097639] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[509.330807] [106/133] (572s left) sw_sync (alloc_fence_invalid_timeline)
[509.381100] Starting subtest: alloc_fence_invalid_timeline
[509.381985] Subtest alloc_fence_invalid_timeline: SUCCESS (0.000s)
[509.533440] [107/133] (572s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[509.614343] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[509.717759] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.103s)
[509.897219] [108/133] (571s left) kms_flip (flip-vs-absolute-wf_vblank-interruptible)
[511.413277] Starting subtest: flip-vs-absolute-wf_vblank-interruptible
[511.419502] Starting dynamic subtest: A-HDMI-A3
[519.431292] Dynamic subtest A-HDMI-A3: SUCCESS (8.010s)
[519.446352] Starting dynamic subtest: B-HDMI-A3
[527.382690] Dynamic subtest B-HDMI-A3: SUCCESS (7.947s)
[527.399221] Starting dynamic subtest: C-HDMI-A3
[535.333418] Dynamic subtest C-HDMI-A3: SUCCESS (7.944s)
[535.348905] Starting dynamic subtest: D-HDMI-A3
[543.301812] Dynamic subtest D-HDMI-A3: SUCCESS (7.966s)
[543.302744] Subtest flip-vs-absolute-wf_vblank-interruptible: SUCCESS (31.884s)
[543.584486] [109/133] (538s left) kms_addfb_basic (size-max)
[545.100124] Starting subtest: size-max
[545.101039] Subtest size-max: SUCCESS (0.000s)
[545.378950] [110/133] (536s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[547.126807] Starting subtest: cursor-rapid-movement-256x256
[547.132186] Starting dynamic subtest: pipe-A-HDMI-A-3
[547.566455] Dynamic subtest pipe-A-HDMI-A-3: SUCCESS (0.435s)
[547.602223] Starting dynamic subtest: pipe-D-HDMI-A-3
[547.920360] Dynamic subtest pipe-D-HDMI-A-3: SUCCESS (0.331s)
[547.921210] Subtest cursor-rapid-movement-256x256: SUCCESS (0.794s)
[548.341882] [111/133] (533s left) gem_exec_whisper (basic-queues-all)
[548.446353] Starting subtest: basic-queues-all
[570.240927] Subtest basic-queues-all: SUCCESS (21.788s)
[570.504712] [112/133] (511s left) kms_dsc (dsc-fractional-bpp)
[572.013005] Starting subtest: dsc-fractional-bpp
[572.018257] Subtest dsc-fractional-bpp: SKIP (0.000s)
[572.188572] [113/133] (510s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-downscaling)
[573.715796] Starting subtest: flip-64bpp-yftile-to-32bpp-yftile-downscaling
[573.716706] Starting dynamic subtest: pipe-A-valid-mode
[573.766010] Dynamic subtest pipe-A-valid-mode: SKIP (0.049s)
[573.767738] Subtest flip-64bpp-yftile-to-32bpp-yftile-downscaling: SKIP (0.050s)
[573.991290] [114/133] (508s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-wc)
[575.505864] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-wc
[575.507624] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[575.741116] [115/133] (506s left) gem_softpin (evict-prime)
[575.829803] Starting subtest: evict-prime
[575.830763] Starting dynamic subtest: rcs0
[577.054262] Dynamic subtest rcs0: SUCCESS (1.224s)
[577.076582] Starting dynamic subtest: bcs0
[578.245204] Dynamic subtest bcs0: SUCCESS (1.189s)
[578.261348] Starting dynamic subtest: vcs0
[579.430288] Dynamic subtest vcs0: SUCCESS (1.184s)
[579.446808] Starting dynamic subtest: vcs1
[580.575267] Dynamic subtest vcs1: SUCCESS (1.144s)
[580.588940] Starting dynamic subtest: vecs0
[581.730256] Dynamic subtest vecs0: SUCCESS (1.154s)
[581.745181] Starting dynamic subtest: vecs1
[582.867222] Dynamic subtest vecs1: SUCCESS (1.136s)
[582.881633] Starting dynamic subtest: ccs0
[584.038269] Dynamic subtest ccs0: SUCCESS (1.170s)
[584.054580] Starting dynamic subtest: all
[585.180390] Dynamic subtest all: SUCCESS (1.141s)
[585.181356] Subtest evict-prime: SUCCESS (9.349s)
[585.370342] [116/133] (497s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt)
[586.886862] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt
[586.888668] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[587.105324] [117/133] (495s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[588.623871] Subtest addfb25-x-tiled-mismatch-legacy: SKIP (0.000s)
[588.865969] [118/133] (494s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted-signa
[588.945214] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled
[589.053369] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.108s)
[589.219630] [119/133] (493s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-gtt)
[590.740023] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-gtt
[590.741796] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[590.964190] [120/133] (492s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-move)
[592.479015] Starting subtest: fbc-1p-primscrn-cur-indfb-move
[595.651375] Subtest fbc-1p-primscrn-cur-indfb-move: SUCCESS (3.172s)
[595.886469] [121/133] (487s left) gem_mmap_wc (bad-size)
[595.965147] Subtest bad-size: SKIP (0.000s)
[596.058463] [122/133] (487s left) kms_hdr (static-toggle-suspend)
[597.570228] Starting subtest: static-toggle-suspend
[597.572771] Subtest static-toggle-suspend: SKIP (0.000s)
[597.771734] [123/133] (485s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[599.290652] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[599.292292] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[599.521677] [124/133] (483s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-sf)
[601.042234] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[601.099038] [125/133] (482s left) kms_frontbuffer_tracking (fbcpsr-1p-indfb-fliptrack-mmap-gtt)
[602.622781] Starting subtest: fbcpsr-1p-indfb-fliptrack-mmap-gtt
[602.624426] Subtest fbcpsr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[602.894035] [126/133] (480s left) kms_ccs (bad-pixel-format-4-tiled-mtl-mc-ccs)
[604.406943] Starting subtest: bad-pixel-format-4-tiled-mtl-mc-ccs
[604.407856] Starting dynamic subtest: pipe-A-HDMI-A-3
[604.416079] Dynamic subtest pipe-A-HDMI-A-3: SKIP (0.000s)
[604.428746] Starting dynamic subtest: pipe-B-HDMI-A-3
[604.437328] Dynamic subtest pipe-B-HDMI-A-3: SKIP (0.000s)
[604.449401] Starting dynamic subtest: pipe-C-HDMI-A-3
[604.457720] Dynamic subtest pipe-C-HDMI-A-3: SKIP (0.000s)
[604.469657] Starting dynamic subtest: pipe-D-HDMI-A-3
[604.479009] Dynamic subtest pipe-D-HDMI-A-3: SKIP (0.000s)
[604.481405] Subtest bad-pixel-format-4-tiled-mtl-mc-ccs: SKIP (0.007s)
[604.730930] [127/133] (479s left) syncobj_timeline (single-wait-all-available-submitted)
[604.807215] Starting subtest: single-wait-all-available-submitted
[604.808113] Subtest single-wait-all-available-submitted: SUCCESS (0.000s)
[605.019163] [128/133] (478s left) gem_exec_parallel (userptr)
[605.108654] Starting subtest: userptr
[605.109544] Starting dynamic subtest: rcs0
[606.658099] Dynamic subtest rcs0: SUCCESS (1.548s)
[606.675107] Starting dynamic subtest: bcs0
[608.118126] Dynamic subtest bcs0: SUCCESS (1.458s)
[608.136997] Starting dynamic subtest: vcs0
[609.628498] Dynamic subtest vcs0: SUCCESS (1.509s)
[609.644931] Starting dynamic subtest: vcs1
[611.145523] Dynamic subtest vcs1: SUCCESS (1.515s)
[611.162365] Starting dynamic subtest: vecs0
[612.625144] Dynamic subtest vecs0: SUCCESS (1.478s)
[612.639545] Starting dynamic subtest: vecs1
[614.073288] Dynamic subtest vecs1: SUCCESS (1.447s)
[614.089887] Starting dynamic subtest: ccs0
[615.555218] Dynamic subtest ccs0: SUCCESS (1.480s)
[615.556215] Subtest userptr: SUCCESS (10.445s)
[615.889401] [129/133] (468s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render)
[617.409108] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render
[617.410835] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[617.658079] [130/133] (466s left) i915_selftest (mock)
[618.814452] Starting subtest: mock
[618.815474] Starting dynamic subtest: sanitycheck
[619.652336] Dynamic subtest sanitycheck: SUCCESS (0.838s)
[619.668769] Starting dynamic subtest: shmem
[620.513782] Dynamic subtest shmem: SUCCESS (0.857s)
[620.550111] Starting dynamic subtest: fence
[628.843960] Dynamic subtest fence: SUCCESS (8.323s)
[628.861498] Starting dynamic subtest: scatterlist
[630.745523] Dynamic subtest scatterlist: SUCCESS (1.896s)
[630.757438] Starting dynamic subtest: syncmap
[633.671260] Dynamic subtest syncmap: SUCCESS (2.921s)
[633.687379] Starting dynamic subtest: uncore
[634.529368] Dynamic subtest uncore: SUCCESS (0.854s)
[634.567461] Starting dynamic subtest: ring
[635.398892] Dynamic subtest ring: SUCCESS (0.865s)
[635.435282] Starting dynamic subtest: engine
[636.248286] Dynamic subtest engine: SUCCESS (0.844s)
[636.285884] Starting dynamic subtest: timelines
[640.861714] Dynamic subtest timelines: SUCCESS (4.609s)
[640.877142] Starting dynamic subtest: requests
[643.646793] Dynamic subtest requests: SUCCESS (2.783s)
[643.656509] Starting dynamic subtest: objects
[644.638082] Dynamic subtest objects: SUCCESS (0.989s)
[644.660400] Starting dynamic subtest: phys
[645.630872] Dynamic subtest phys: SUCCESS (0.991s)
[645.641377] Starting dynamic subtest: dmabuf
[646.605745] Dynamic subtest dmabuf: SUCCESS (0.973s)
[646.621229] Starting dynamic subtest: vma
[654.790267] Dynamic subtest vma: SUCCESS (8.181s)
[654.817107] Starting dynamic subtest: evict
[656.688902] Dynamic subtest evict: SUCCESS (1.896s)
[656.705644] Starting dynamic subtest: gtt
[660.638914] Dynamic subtest gtt: SUCCESS (3.948s)
[660.655974] Starting dynamic subtest: hugepages
[661.812803] Dynamic subtest hugepages: SUCCESS (1.173s)
[661.823523] Starting dynamic subtest: memory_region
[665.364729] Dynamic subtest memory_region: SUCCESS (3.553s)
[665.365790] Subtest mock: SUCCESS (46.546s)
[665.402880] [FACT i915_selftest (mock)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[665.403802] [FACT i915_selftest (mock)] deleted: kernel.kmod_is_loaded.i915: true
[665.406437] [131/133] (418s left) gem_mmap_gtt (basic-write-read)
[668.836970] Subtest basic-write-read: SKIP (0.000s)
[668.906180] [FACT gem_mmap_gtt (basic-write-read)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[668.908545] [FACT gem_mmap_gtt (basic-write-read)] new: kernel.kmod_is_loaded.i915: true
[668.911482] [132/133] (415s left) perf (gen12-group-exclusive-stream-sample-oa)
[669.350245] Starting subtest: gen12-group-exclusive-stream-sample-oa
[669.373462] Subtest gen12-group-exclusive-stream-sample-oa: SUCCESS (0.023s)
[669.429145] [133/133] (414s left) perf_pmu (busy-double-start)
[669.501118] Starting subtest: busy-double-start
[669.502022] Starting dynamic subtest: rcs0
[673.130248] Dynamic subtest rcs0: SUCCESS (3.631s)
[673.145027] Starting dynamic subtest: bcs0
[676.725213] Dynamic subtest bcs0: SUCCESS (3.595s)
[676.739573] Starting dynamic subtest: vcs0
[680.328180] Dynamic subtest vcs0: FAIL (3.579s)
[680.340437] Starting dynamic subtest: vcs1
[683.895102] Dynamic subtest vcs1: FAIL (3.566s)
[683.907628] Starting dynamic subtest: vecs0
[687.462119] Dynamic subtest vecs0: FAIL (3.567s)
[687.474777] Starting dynamic subtest: vecs1
[691.027803] Dynamic subtest vecs1: FAIL (3.566s)
[691.040594] Starting dynamic subtest: ccs0
[694.605378] Dynamic subtest ccs0: SUCCESS (3.602s)
[694.610358] Subtest busy-double-start: FAIL (25.121s)
[694.802223] Closing watchdogs
results: parsing output: 0/ for test: gem_partial_pwrite_pread
results: parsing output: 1/ for test: kms_content_protection
results: parsing output: 2/ for test: kms_rotation_crc
results: parsing output: 3/ for test: kms_chamelium_color
results: parsing output: 4/ for test: syncobj_wait
results: parsing output: 5/ for test: kms_pipe_crc_basic
results: parsing output: 6/ for test: gem_set_tiling_vs_blt
results: parsing output: 7/ for test: syncobj_wait
results: parsing output: 8/ for test: syncobj_wait
results: parsing output: 9/ for test: gem_pxp
results: parsing output: 10/ for test: kms_cursor_legacy
results: parsing output: 11/ for test: kms_rotation_crc
results: parsing output: 12/ for test: syncobj_wait
results: parsing output: 13/ for test: kms_ccs
results: parsing output: 14/ for test: gem_softpin
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: gem_ctx_param
results: parsing output: 17/ for test: syncobj_wait
results: parsing output: 18/ for test: kms_big_fb
results: parsing output: 19/ for test: gem_mmap_gtt
results: parsing output: 20/ for test: kms_psr
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: kms_flip
results: parsing output: 23/ for test: kms_plane_cursor
results: parsing output: 24/ for test: kms_cdclk
results: parsing output: 25/ for test: gem_exec_balancer
results: parsing output: 26/ for test: kms_cursor_legacy
results: parsing output: 27/ for test: kms_flip_scaled_crc
results: parsing output: 28/ for test: kms_flip_scaled_crc
results: parsing output: 29/ for test: core_getstats
results: parsing output: 30/ for test: kms_rmfb
results: parsing output: 31/ for test: gem_exec_reloc
results: parsing output: 32/ for test: kms_properties
results: parsing output: 33/ for test: kms_invalid_mode
results: parsing output: 34/ for test: kms_plane_scaling
results: parsing output: 35/ for test: kms_pm_rpm
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: kms_dirtyfb
results: parsing output: 38/ for test: kms_cursor_legacy
results: parsing output: 39/ for test: syncobj_timeline
results: parsing output: 40/ for test: kms_prime
results: parsing output: 41/ for test: kms_pipe_b_c_ivb
results: parsing output: 42/ for test: i915_drm_fdinfo
results: parsing output: 43/ for test: gem_userptr_blits
results: parsing output: 44/ for test: kms_big_fb
results: parsing output: 45/ for test: kms_ccs
results: parsing output: 46/ for test: kms_scaling_modes
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: gem_ringfill
results: parsing output: 49/ for test: gem_exec_whisper
results: parsing output: 50/ for test: api_intel_bb
results: parsing output: 51/ for test: kms_cursor_crc
results: parsing output: 52/ for test: kms_ccs
results: parsing output: 53/ for test: gen9_exec_parse
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_big_fb
results: parsing output: 56/ for test: gem_exec_fence
results: parsing output: 57/ for test: kms_psr
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: gem_ctx_bad_destroy
results: parsing output: 60/ for test: syncobj_timeline
results: parsing output: 61/ for test: kms_chamelium_hpd
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: gem_cs_tlb
results: parsing output: 64/ for test: gem_mmap_gtt
results: parsing output: 65/ for test: kms_psr
results: parsing output: 66/ for test: kms_big_fb
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: gem_bad_reloc
results: parsing output: 69/ for test: gem_ctx_persistence
results: parsing output: 70/ for test: kms_plane_scaling
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: gem_exec_schedule
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: kms_big_fb
results: parsing output: 76/ for test: gem_exec_basic
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: gem_mmap
results: parsing output: 79/ for test: gem_exec_reloc
results: parsing output: 80/ for test: gem_ctx_shared
results: parsing output: 81/ for test: gem_exec_reloc
results: parsing output: 82/ for test: gem_eio
results: parsing output: 83/ for test: gem_ctx_persistence
results: parsing output: 84/ for test: perf_pmu
results: parsing output: 85/ for test: gem_exec_schedule
results: parsing output: 86/ for test: i915_hangman
results: parsing output: 87/ for test: syncobj_timeline
results: parsing output: 88/ for test: kms_color
results: parsing output: 89/ for test: prime_vgem
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: api_intel_allocator
results: parsing output: 92/ for test: i915_pm_rps
results: parsing output: 93/ for test: kms_vblank
results: parsing output: 94/ for test: kms_big_fb
results: parsing output: 95/ for test: kms_addfb_basic
results: parsing output: 96/ for test: kms_psr
results: parsing output: 97/ for test: kms_flip
results: parsing output: 98/ for test: kms_cursor_crc
results: parsing output: 99/ for test: kms_flip
results: parsing output: 100/ for test: kms_atomic_interruptible
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_plane_scaling
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: sw_sync
results: parsing output: 106/ for test: syncobj_timeline
results: parsing output: 107/ for test: kms_flip
results: parsing output: 108/ for test: kms_addfb_basic
results: parsing output: 109/ for test: kms_cursor_crc
results: parsing output: 110/ for test: gem_exec_whisper
results: parsing output: 111/ for test: kms_dsc
results: parsing output: 112/ for test: kms_flip_scaled_crc
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: gem_softpin
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: kms_addfb_basic
results: parsing output: 117/ for test: syncobj_timeline
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: gem_mmap_wc
results: parsing output: 121/ for test: kms_hdr
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: kms_psr2_sf
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_ccs
results: parsing output: 126/ for test: syncobj_timeline
results: parsing output: 127/ for test: gem_exec_parallel
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: i915_selftest
results: parsing output: 130/ for test: gem_mmap_gtt
results: parsing output: 131/ for test: perf
results: parsing output: 132/ for test: perf_pmu
Done.