[52.574347] Initializing watchdogs
[52.574390]   /dev/watchdog0
[52.588775] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[52.593379] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[52.595827] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[52.599236] [001/133] (960s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-gtt)
[52.741101] Starting subtest: fbc-rgb565-draw-mmap-gtt
[52.745193] Subtest fbc-rgb565-draw-mmap-gtt: SKIP (0.000s)
[52.849830] [002/133] (960s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[53.015421] Starting subtest: cursor-rapid-movement-32x10
[53.069630] Subtest cursor-rapid-movement-32x10: SKIP (0.049s)
[53.336939] [003/133] (959s left) gem_mmap (bad-object)
[53.404840] Subtest bad-object: SKIP (0.000s)
[53.456442] [004/133] (959s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area)
[53.545405] Starting subtest: fbc-pr-overlay-plane-update-sf-dmg-area
[53.548751] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[53.607442] [005/133] (959s left) kms_flip (dpms-off-confusion-interruptible)
[53.708046] Starting subtest: dpms-off-confusion-interruptible
[53.709992] Starting dynamic subtest: A-eDP1
[62.433753] Dynamic subtest A-eDP1: SUCCESS (8.723s)
[62.443390] Starting dynamic subtest: B-eDP1
[71.048639] Dynamic subtest B-eDP1: SUCCESS (8.614s)
[71.058590] Starting dynamic subtest: C-eDP1
[79.668585] Dynamic subtest C-eDP1: SUCCESS (8.619s)
[79.677694] Starting dynamic subtest: D-eDP1
[88.302337] Dynamic subtest D-eDP1: SUCCESS (8.631s)
[88.304931] Subtest dpms-off-confusion-interruptible: SUCCESS (34.594s)
[89.469728] [006/133] (923s left) i915_pm_rps (thresholds-idle)
[89.539418] Starting subtest: thresholds-idle
[89.543615] Subtest thresholds-idle: SKIP (0.001s)
[89.642688] [007/133] (923s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs)
[89.750285] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs
[89.752578] Starting dynamic subtest: pipe-A-eDP-1
[89.775404] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[89.782695] Starting dynamic subtest: pipe-B-eDP-1
[89.804378] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[89.811442] Starting dynamic subtest: pipe-C-eDP-1
[89.832780] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[89.839679] Starting dynamic subtest: pipe-D-eDP-1
[89.861345] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[89.865364] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs: SKIP (0.003s)
[92.037886] [008/133] (921s left) kms_getfb (getfb2-handle-protection)
[92.137757] Starting subtest: getfb2-handle-protection
[92.156099] Subtest getfb2-handle-protection: SUCCESS (0.019s)
[92.306077] [009/133] (921s left) kms_invalid_mode (int-max-clock)
[92.399744] Starting subtest: int-max-clock
[92.402106] Starting dynamic subtest: pipe-A-eDP-1
[92.692519] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.292s)
[92.700149] Starting dynamic subtest: pipe-B-eDP-1
[92.702390] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[92.709613] Starting dynamic subtest: pipe-C-eDP-1
[92.711980] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[92.719104] Starting dynamic subtest: pipe-D-eDP-1
[92.721439] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[92.723741] Subtest int-max-clock: SUCCESS (0.298s)
[93.582323] [010/133] (919s left) gem_exec_schedule (promotion)
[93.659098] Starting subtest: promotion
[93.661537] Starting dynamic subtest: rcs0
[93.770521] Dynamic subtest rcs0: SUCCESS (0.119s)
[93.780277] Starting dynamic subtest: vcs0
[93.858047] Dynamic subtest vcs0: SUCCESS (0.087s)
[93.871058] Starting dynamic subtest: vcs1
[93.941559] Dynamic subtest vcs1: SUCCESS (0.083s)
[93.951596] Starting dynamic subtest: vecs0
[94.024849] Dynamic subtest vecs0: SUCCESS (0.083s)
[94.033337] Starting dynamic subtest: ccs0
[94.115056] Dynamic subtest ccs0: SUCCESS (0.089s)
[94.117528] Subtest promotion: SUCCESS (0.464s)
[95.022607] [011/133] (918s left) core_getstats (basic)
[95.077044] Starting subtest: basic
[95.079082] Subtest basic: SUCCESS (0.000s)
[95.154673] [012/133] (918s left) gem_exec_fence (syncobj-timeline-chain-engines)
[95.712251] Starting subtest: syncobj-timeline-chain-engines
[95.800426] Subtest syncobj-timeline-chain-engines: SUCCESS (0.092s)
[97.012866] [FACT gem_exec_fence (syncobj-timeline-chain-engines)] new: kernel.kmod_is_loaded.vgem: true
[97.016079] [013/133] (916s left) kms_psr (psr2-sprite-render)
[97.117554] Starting subtest: psr2-sprite-render
[97.119797] Starting dynamic subtest: eDP-1
[98.869312] Dynamic subtest eDP-1: SUCCESS (1.751s)
[98.871488] Subtest psr2-sprite-render: SUCCESS (1.751s)
[99.741368] [014/133] (913s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-plflip-blt)
[99.845076] Starting subtest: psr-2p-primscrn-shrfb-plflip-blt
[99.849642] Subtest psr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[99.947861] [015/133] (913s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[100.003635] Starting subtest: framebuffer-vs-set-tiling
[100.007693] Subtest framebuffer-vs-set-tiling: SKIP (0.000s)
[100.148532] [016/133] (913s left) gem_ctx_engines (invalid-engines)
[100.201868] Starting subtest: invalid-engines
[100.210365] Subtest invalid-engines: SUCCESS (0.009s)
[100.428223] [017/133] (913s left) kms_flip (flip-vs-suspend)
[100.518472] Starting subtest: flip-vs-suspend
[100.520951] Starting dynamic subtest: A-eDP1
[133.466740] Dynamic subtest A-eDP1: SUCCESS (4.338s)
[133.475411] Starting dynamic subtest: B-eDP1
[182.480868] Dynamic subtest B-eDP1: SUCCESS (4.470s)
[182.489908] Starting dynamic subtest: C-eDP1
[231.471247] Dynamic subtest C-eDP1: SUCCESS (4.454s)
[231.485447] Starting dynamic subtest: D-eDP1
[280.484300] Dynamic subtest D-eDP1: SUCCESS (4.524s)
[280.489091] Subtest flip-vs-suspend: SUCCESS (17.794s)
[281.650802] [018/133] (732s left) syncobj_timeline (single-wait-all-for-submit-signaled)
[281.708933] Starting subtest: single-wait-all-for-submit-signaled
[281.711373] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[281.831712] [019/133] (731s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-blt)
[281.934109] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-blt
[281.938316] Subtest psr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s)
[282.068440] [020/133] (731s left) kms_feature_discovery (display-3x)
[282.161908] Starting subtest: display-3x
[282.166515] Subtest display-3x: SKIP (0.000s)
[282.234164] [021/133] (731s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[282.332007] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[289.487360] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (7.154s)
[289.627142] [022/133] (724s left) dumb_buffer (create-clear)
[289.699000] Starting subtest: create-clear
[324.072548] Subtest create-clear: SUCCESS (34.354s)
[324.212328] [023/133] (689s left) kms_content_protection (atomic)
[324.366741] Starting subtest: atomic
[324.371307] Subtest atomic: SKIP (0.000s)
[324.500655] [024/133] (689s left) gem_readwrite (read-bad-handle)
[324.564080] Subtest read-bad-handle: SKIP (0.000s)
[324.631168] [025/133] (689s left) gem_mmap_wc (close)
[324.686990] Subtest close: SKIP (0.000s)
[324.742542] [026/133] (689s left) kms_cursor_legacy (modeset-atomic-cursor-hotspot)
[324.849380] Starting subtest: modeset-atomic-cursor-hotspot
[324.853984] Subtest modeset-atomic-cursor-hotspot: SKIP (0.000s)
[324.995195] [027/133] (689s left) gem_ctx_persistence (many-contexts)
[325.063583] Starting subtest: many-contexts
[362.761205] Subtest many-contexts: SUCCESS (37.682s)
[362.840211] [028/133] (651s left) kms_addfb_basic (basic-y-tiled-legacy)
[362.898344] Starting subtest: basic-y-tiled-legacy
[362.902767] Subtest basic-y-tiled-legacy: SKIP (0.000s)
[363.050231] [029/133] (651s left) kms_psr (psr2-cursor-blt)
[363.143611] Starting subtest: psr2-cursor-blt
[363.145766] Starting dynamic subtest: eDP-1
[364.820571] Dynamic subtest eDP-1: SUCCESS (1.676s)
[364.822886] Subtest psr2-cursor-blt: SUCCESS (1.677s)
[365.695268] [030/133] (648s left) gem_mmap_gtt (basic)
[365.756818] Subtest basic: SKIP (0.000s)
[365.819483] [031/133] (648s left) gem_exec_reloc (basic-write-cpu-noreloc)
[365.879404] Subtest basic-write-cpu-noreloc: SKIP (0.000s)
[365.939296] [032/133] (648s left) gem_pxp (create-regular-context-1)
[366.063716] Starting subtest: create-regular-context-1
[366.066273] Subtest create-regular-context-1: SUCCESS (0.002s)
[366.187737] [033/133] (648s left) kms_color (invalid-degamma-lut-sizes)
[366.287113] Starting subtest: invalid-degamma-lut-sizes
[366.289399] Starting dynamic subtest: pipe-A
[366.576394] Dynamic subtest pipe-A: SUCCESS (0.289s)
[366.585985] Starting dynamic subtest: pipe-B
[366.588343] Dynamic subtest pipe-B: SUCCESS (0.000s)
[366.596868] Starting dynamic subtest: pipe-C
[366.599301] Dynamic subtest pipe-C: SUCCESS (0.000s)
[366.608580] Starting dynamic subtest: pipe-D
[366.610991] Dynamic subtest pipe-D: SUCCESS (0.000s)
[366.613467] Subtest invalid-degamma-lut-sizes: SUCCESS (0.292s)
[367.423600] [034/133] (646s left) kms_big_fb (y-tiled-addfb)
[367.536752] Starting subtest: y-tiled-addfb
[367.541109] Subtest y-tiled-addfb: SKIP (0.000s)
[367.630457] [035/133] (646s left) perf_pmu (render-node-busy)
[367.706758] Starting subtest: render-node-busy
[367.709263] Starting dynamic subtest: rcs0
[368.302883] Dynamic subtest rcs0: SUCCESS (0.595s)
[368.314977] Starting dynamic subtest: bcs0
[368.860707] Dynamic subtest bcs0: SUCCESS (0.556s)
[368.870985] Starting dynamic subtest: vcs0
[370.055886] Dynamic subtest vcs0: SUCCESS (1.193s)
[370.067694] Starting dynamic subtest: vcs1
[372.106332] Dynamic subtest vcs1: SUCCESS (2.046s)
[372.118981] Starting dynamic subtest: vecs0
[374.089981] Dynamic subtest vecs0: SUCCESS (1.980s)
[374.101962] Starting dynamic subtest: ccs0
[374.653497] Dynamic subtest ccs0: SUCCESS (0.562s)
[374.656055] Subtest render-node-busy: SUCCESS (6.944s)
[374.735343] [036/133] (639s left) kms_frontbuffer_tracking (fbcpsr-indfb-scaledprimary)
[374.836992] Starting subtest: fbcpsr-indfb-scaledprimary
[380.586878] Subtest fbcpsr-indfb-scaledprimary: SUCCESS (5.769s)
[380.744858] [037/133] (633s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-onoff)
[380.849457] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-onoff
[387.990824] Subtest fbcpsr-1p-primscrn-spr-indfb-onoff: SUCCESS (7.156s)
[388.116785] [038/133] (626s left) gem_mmap_gtt (basic-small-copy-odd)
[388.166441] Subtest basic-small-copy-odd: SKIP (0.000s)
[388.225639] [039/133] (626s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0)
[388.332111] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0
[389.356278] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.024s)
[389.479334] [040/133] (625s left) kms_ccs (random-ccs-data-yf-tiled-ccs)
[389.575284] Starting subtest: random-ccs-data-yf-tiled-ccs
[389.577605] Starting dynamic subtest: pipe-A-eDP-1
[389.602137] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[389.611401] Starting dynamic subtest: pipe-B-eDP-1
[389.630639] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[389.638979] Starting dynamic subtest: pipe-C-eDP-1
[389.659252] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[389.670253] Starting dynamic subtest: pipe-D-eDP-1
[389.690723] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[389.694055] Subtest random-ccs-data-yf-tiled-ccs: SKIP (0.005s)
[391.825349] [041/133] (622s left) kms_addfb_basic (size-max)
[391.936598] Starting subtest: size-max
[391.938542] Subtest size-max: SUCCESS (0.000s)
[392.026798] [042/133] (622s left) kms_pm_dc (dc3co-vpb-simulation)
[393.142873] Starting subtest: dc3co-vpb-simulation
[402.150511] Subtest dc3co-vpb-simulation: SKIP (9.007s)
[402.297075] [043/133] (612s left) gem_softpin (32b-excludes-last-page)
[402.361389] Starting subtest: 32b-excludes-last-page
[402.366608] Subtest 32b-excludes-last-page: SUCCESS (0.004s)
[402.490153] [044/133] (612s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc)
[402.585589] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc
[402.589909] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[402.698624] [045/133] (612s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-pgflip-blt)
[402.800527] Starting subtest: fbc-2p-scndscrn-indfb-pgflip-blt
[402.804580] Subtest fbc-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[402.901496] [046/133] (612s left) kms_plane (pixel-format-4-tiled-lnl-ccs-modifier-source-clamping)
[402.996088] Starting subtest: pixel-format-4-tiled-lnl-ccs-modifier-source-clamping
[403.000074] Subtest pixel-format-4-tiled-lnl-ccs-modifier-source-clamping: SKIP (0.000s)
[403.072300] [047/133] (611s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-blt)
[403.168983] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-blt
[410.455058] Subtest psr-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (7.291s)
[410.583317] [048/133] (604s left) gem_ctx_exec (basic)
[410.645972] Starting subtest: basic
[410.650892] Subtest basic: SUCCESS (0.006s)
[410.780673] [049/133] (604s left) gem_exec_flush (basic-wb-prw-default)
[410.838539] Starting subtest: basic-wb-prw-default
[416.299863] Subtest basic-wb-prw-default: SUCCESS (5.461s)
[416.493172] [050/133] (598s left) kms_frontbuffer_tracking (fbc-1p-indfb-fliptrack-mmap-gtt)
[416.591121] Starting subtest: fbc-1p-indfb-fliptrack-mmap-gtt
[416.595033] Subtest fbc-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[416.677030] [051/133] (598s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[416.778951] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[416.781182] Starting dynamic subtest: pipe-A-eDP-1
[416.800591] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.020s)
[416.813031] Starting dynamic subtest: pipe-B-eDP-1
[416.831979] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.020s)
[416.841625] Starting dynamic subtest: pipe-C-eDP-1
[416.860911] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.021s)
[416.871292] Starting dynamic subtest: pipe-D-eDP-1
[416.891550] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.021s)
[416.893796] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SUCCESS (0.088s)
[419.106094] [052/133] (596s left) prime_busy (hang-wait)
[419.179460] Starting subtest: hang-wait
[419.181695] Starting dynamic subtest: rcs0
[445.547185] Dynamic subtest rcs0: SUCCESS (26.363s)
[445.558102] Starting dynamic subtest: bcs0
[452.697594] Dynamic subtest bcs0: SUCCESS (7.147s)
[452.708263] Starting dynamic subtest: vcs0
[459.675513] Dynamic subtest vcs0: SUCCESS (6.977s)
[459.686505] Starting dynamic subtest: vcs1
[466.647762] Dynamic subtest vcs1: SUCCESS (6.973s)
[466.659644] Starting dynamic subtest: vecs0
[473.685896] Dynamic subtest vecs0: SUCCESS (7.035s)
[473.694802] Starting dynamic subtest: ccs0
[487.529680] Dynamic subtest ccs0: SUCCESS (13.840s)
[487.532019] Subtest hang-wait: SUCCESS (68.348s)
[487.644788] [053/133] (527s left) gem_exec_reloc (basic-write-read-active)
[487.709855] Subtest basic-write-read-active: SKIP (0.000s)
[487.799622] [054/133] (527s left) api_intel_bb (crc32)
[487.853951] Starting subtest: crc32
[487.856160] Starting dynamic subtest: rcs0-smem0
[488.158765] Dynamic subtest rcs0-smem0: SUCCESS (0.305s)
[488.169674] Starting dynamic subtest: bcs0-smem0
[488.487578] Dynamic subtest bcs0-smem0: SUCCESS (0.325s)
[488.498640] Starting dynamic subtest: vcs0-smem0
[488.824004] Dynamic subtest vcs0-smem0: SUCCESS (0.334s)
[488.836809] Starting dynamic subtest: vcs1-smem0
[489.181990] Dynamic subtest vcs1-smem0: SUCCESS (0.355s)
[489.195848] Starting dynamic subtest: vecs0-smem0
[489.509546] Dynamic subtest vecs0-smem0: SUCCESS (0.325s)
[489.521975] Starting dynamic subtest: ccs0-smem0
[489.851851] Dynamic subtest ccs0-smem0: SUCCESS (0.339s)
[489.854457] Subtest crc32: SUCCESS (2.000s)
[489.981836] [055/133] (525s left) kms_plane_multiple (2x-tiling-x)
[490.073866] Starting subtest: 2x-tiling-x
[490.078323] Subtest 2x-tiling-x: SKIP (0.000s)
[490.152951] [056/133] (525s left) sysfs_heartbeat_interval (precise)
[490.215425] Starting subtest: precise
[490.217784] Starting dynamic subtest: vecs0
[498.056102] Dynamic subtest vecs0: SUCCESS (7.840s)
[498.068020] Starting dynamic subtest: ccs0
[499.176592] Dynamic subtest ccs0: SUCCESS (1.118s)
[499.188211] Starting dynamic subtest: vcs0
[507.083088] Dynamic subtest vcs0: SUCCESS (7.904s)
[507.096994] Starting dynamic subtest: bcs0
[508.119669] Dynamic subtest bcs0: SUCCESS (1.032s)
[508.131073] Starting dynamic subtest: rcs0
[509.170988] Dynamic subtest rcs0: SUCCESS (1.051s)
[509.182596] Starting dynamic subtest: vcs1
[517.057000] Dynamic subtest vcs1: SUCCESS (7.884s)
[517.059418] Subtest precise: SUCCESS (26.840s)
[517.133458] [057/133] (498s left) gem_spin_batch (resubmit-all)
[517.207364] Starting subtest: resubmit-all
[517.209796] Starting dynamic subtest: rcs0
[517.227272] Dynamic subtest rcs0: SUCCESS (0.019s)
[517.237904] Starting dynamic subtest: bcs0
[517.240388] Dynamic subtest bcs0: SUCCESS (0.003s)
[517.249582] Starting dynamic subtest: vcs0
[517.251981] Dynamic subtest vcs0: SUCCESS (0.002s)
[517.261045] Starting dynamic subtest: vcs1
[517.263308] Dynamic subtest vcs1: SUCCESS (0.002s)
[517.272428] Starting dynamic subtest: vecs0
[517.274743] Dynamic subtest vecs0: SUCCESS (0.002s)
[517.283479] Starting dynamic subtest: ccs0
[517.285799] Dynamic subtest ccs0: SUCCESS (0.003s)
[517.288100] Subtest resubmit-all: SUCCESS (0.036s)
[519.094302] [058/133] (496s left) kms_pm_rpm (modeset-non-lpsp-stress)
[521.215350] Starting subtest: modeset-non-lpsp-stress
[522.383100] Subtest modeset-non-lpsp-stress: SKIP (1.165s)
[522.760581] [059/133] (492s left) perf (invalid-open-flags)
[522.885266] Starting subtest: invalid-open-flags
[522.887231] Subtest invalid-open-flags: SUCCESS (0.000s)
[522.933033] [060/133] (492s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs)
[523.023242] Starting subtest: crc-primary-suspend-4-tiled-mtl-rc-ccs
[523.025479] Starting dynamic subtest: pipe-A-eDP-1
[539.676120] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.428s)
[539.686298] Starting dynamic subtest: pipe-B-eDP-1
[556.646602] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.414s)
[556.663689] Starting dynamic subtest: pipe-C-eDP-1
[574.604406] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.556s)
[574.614205] Starting dynamic subtest: pipe-D-eDP-1
[591.665677] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.433s)
[591.667965] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs: SUCCESS (8.837s)
[592.878749] [061/133] (422s left) kms_flip (modeset-vs-vblank-race)
[592.977534] Starting subtest: modeset-vs-vblank-race
[592.979410] Starting dynamic subtest: A-eDP1
[597.702626] Dynamic subtest A-eDP1: SUCCESS (4.716s)
[597.715093] Starting dynamic subtest: B-eDP1
[602.437978] Dynamic subtest B-eDP1: SUCCESS (4.725s)
[602.450141] Starting dynamic subtest: C-eDP1
[607.059746] Dynamic subtest C-eDP1: SUCCESS (4.614s)
[607.069403] Starting dynamic subtest: D-eDP1
[611.678380] Dynamic subtest D-eDP1: SUCCESS (4.614s)
[611.683539] Subtest modeset-vs-vblank-race: SUCCESS (18.683s)
[612.845623] [062/133] (402s left) gem_mmap_offset (partial-mmap)
[612.903707] Starting subtest: partial-mmap
[612.906086] Starting dynamic subtest: smem0
[612.908483] Dynamic subtest smem0: SUCCESS (0.003s)
[612.910749] Subtest partial-mmap: SUCCESS (0.004s)
[613.038977] [063/133] (402s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[613.143621] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip
[613.147672] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[613.240597] [064/133] (402s left) perf_pmu (busy-check-all)
[613.287133] Starting subtest: busy-check-all
[613.289137] Starting dynamic subtest: rcs0
[613.836099] Dynamic subtest rcs0: SUCCESS (0.549s)
[613.849011] Starting dynamic subtest: bcs0
[614.386035] Dynamic subtest bcs0: SUCCESS (0.547s)
[614.398220] Starting dynamic subtest: vcs0
[615.828847] Dynamic subtest vcs0: SUCCESS (1.438s)
[615.839374] Starting dynamic subtest: vcs1
[617.875435] Dynamic subtest vcs1: SUCCESS (2.042s)
[617.888173] Starting dynamic subtest: vecs0
[619.858426] Dynamic subtest vecs0: SUCCESS (1.980s)
[619.869761] Starting dynamic subtest: ccs0
[620.415644] Dynamic subtest ccs0: SUCCESS (0.555s)
[620.418296] Subtest busy-check-all: SUCCESS (7.127s)
[620.517024] [065/133] (395s left) gem_exec_balancer (bonded-sync)
[620.581373] Starting subtest: bonded-sync
[620.585663] Subtest bonded-sync: SKIP (0.000s)
[620.908149] [066/133] (394s left) gem_exec_reloc (basic-gtt-cpu)
[620.971151] Subtest basic-gtt-cpu: SKIP (0.000s)
[621.040123] [067/133] (394s left) gem_ctx_persistence (engines-hostile)
[621.115270] Starting subtest: engines-hostile
[621.117575] Starting dynamic subtest: rcs0
[621.203653] Dynamic subtest rcs0: SUCCESS (0.090s)
[621.220045] Starting dynamic subtest: bcs0
[621.306048] Dynamic subtest bcs0: SUCCESS (0.100s)
[621.318158] Starting dynamic subtest: vcs0
[621.394909] Dynamic subtest vcs0: SUCCESS (0.086s)
[621.406705] Starting dynamic subtest: vcs1
[621.502245] Dynamic subtest vcs1: SUCCESS (0.105s)
[621.515065] Starting dynamic subtest: vecs0
[621.596932] Dynamic subtest vecs0: SUCCESS (0.093s)
[621.608967] Starting dynamic subtest: ccs0
[621.674784] Dynamic subtest ccs0: SUCCESS (0.076s)
[621.677425] Subtest engines-hostile: SUCCESS (0.564s)
[621.806988] [068/133] (394s left) kms_psr (fbc-psr2-sprite-plane-onoff)
[621.898314] Starting subtest: fbc-psr2-sprite-plane-onoff
[621.900155] Starting dynamic subtest: eDP-1
[621.903449] Dynamic subtest eDP-1: SKIP (0.000s)
[621.907036] Subtest fbc-psr2-sprite-plane-onoff: SKIP (0.001s)
[621.972015] [069/133] (393s left) gen9_exec_parse (cmd-crossing-page)
[622.042213] Subtest cmd-crossing-page: SKIP (0.000s)
[622.117825] [070/133] (393s left) kms_psr2_sf (pr-cursor-plane-move-continuous-sf)
[622.220193] Starting subtest: pr-cursor-plane-move-continuous-sf
[622.223581] Subtest pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[622.290862] [071/133] (393s left) sw_sync (alloc_fence_invalid_timeline)
[622.328223] Starting subtest: alloc_fence_invalid_timeline
[622.330226] Subtest alloc_fence_invalid_timeline: SUCCESS (0.000s)
[622.375765] [072/133] (393s left) gem_userptr_blits (unsync-unmap)
[622.440782] Subtest unsync-unmap: SKIP (0.000s)
[622.571795] [073/133] (393s left) kms_rotation_crc (primary-x-tiled-reflect-x-180)
[622.662136] Starting subtest: primary-x-tiled-reflect-x-180
[629.680778] Subtest primary-x-tiled-reflect-x-180: SUCCESS (7.025s)
[630.896974] [074/133] (385s left) kms_fbcon_fbt (fbc-suspend)
[630.957539] Starting subtest: fbc-suspend
[680.737326] Subtest fbc-suspend: SUCCESS (19.189s)
[682.068878] [075/133] (334s left) kms_getfb (getfb-handle-zero)
[682.171298] Starting subtest: getfb-handle-zero
[682.173909] Subtest getfb-handle-zero: SUCCESS (0.000s)
[682.264192] [076/133] (333s left) gem_mmap_gtt (cpuset-basic-small-copy)
[682.322156] Subtest cpuset-basic-small-copy: SKIP (0.000s)
[682.386698] [077/133] (333s left) kms_vblank (ts-continuation-suspend)
[682.477692] Starting subtest: ts-continuation-suspend
[682.480384] Starting dynamic subtest: pipe-A-eDP-1
[698.755451] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.528s)
[698.771929] Starting dynamic subtest: pipe-D-eDP-1
[715.748071] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.176s)
[715.751259] Subtest ts-continuation-suspend: SUCCESS (3.708s)
[716.557685] [078/133] (299s left) kms_rmfb (rmfb-ioctl)
[716.652073] Starting subtest: rmfb-ioctl
[716.655015] Starting dynamic subtest: pipe-A-eDP-1
[716.756130] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.106s)
[716.765694] Starting dynamic subtest: pipe-B-eDP-1
[717.911598] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.151s)
[717.923874] Starting dynamic subtest: pipe-C-eDP-1
[719.038176] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.123s)
[719.054876] Starting dynamic subtest: pipe-D-eDP-1
[720.166450] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.124s)
[720.169191] Subtest rmfb-ioctl: SUCCESS (3.509s)
[721.306394] [079/133] (295s left) kms_frontbuffer_tracking (psr-rgb101010-draw-mmap-gtt)
[721.410716] Starting subtest: psr-rgb101010-draw-mmap-gtt
[721.415841] Subtest psr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[721.528808] [080/133] (294s left) kms_plane_scaling (plane-scaler-unity-scaling-with-modifiers)
[721.616247] Starting subtest: plane-scaler-unity-scaling-with-modifiers
[721.618859] Starting dynamic subtest: pipe-A
[721.954676] Dynamic subtest pipe-A: SUCCESS (0.339s)
[721.964094] Starting dynamic subtest: pipe-B
[723.386229] Dynamic subtest pipe-B: SUCCESS (1.428s)
[723.396082] Starting dynamic subtest: pipe-C
[724.869013] Dynamic subtest pipe-C: SUCCESS (1.479s)
[724.884483] Starting dynamic subtest: pipe-D
[726.294093] Dynamic subtest pipe-D: SUCCESS (1.420s)
[726.296990] Subtest plane-scaler-unity-scaling-with-modifiers: SUCCESS (4.674s)
[727.436543] [081/133] (288s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-render)
[727.537062] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-render
[727.542096] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[727.642195] [082/133] (288s left) i915_pm_freq_api (freq-reset)
[727.713236] Starting subtest: freq-reset
[727.716203] Starting dynamic subtest: gt0
[727.912408] Dynamic subtest gt0: SUCCESS (0.200s)
[727.922280] Starting dynamic subtest: gt1
[728.081579] Dynamic subtest gt1: SUCCESS (0.169s)
[728.084809] Subtest freq-reset: SUCCESS (0.371s)
[728.158560] [083/133] (288s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-signaled)
[728.220213] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[728.223009] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[728.331371] [084/133] (288s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[728.429875] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[728.434816] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[728.519253] [085/133] (288s left) kms_cursor_legacy (cursor-vs-flip-legacy)
[728.634832] Starting subtest: cursor-vs-flip-legacy
[758.111008] Subtest cursor-vs-flip-legacy: SUCCESS (29.466s)
[758.979773] [086/133] (257s left) gem_mmap_wc (write-read)
[759.045057] Subtest write-read: SKIP (0.000s)
[759.111516] [087/133] (257s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-mc-ccs)
[759.208039] Starting subtest: ccs-on-another-bo-4-tiled-mtl-mc-ccs
[759.210358] Starting dynamic subtest: pipe-A-eDP-1
[759.232475] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.023s)
[759.242603] Starting dynamic subtest: pipe-B-eDP-1
[759.264989] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.022s)
[759.274991] Starting dynamic subtest: pipe-C-eDP-1
[759.297849] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.022s)
[759.307776] Starting dynamic subtest: pipe-D-eDP-1
[759.331068] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.022s)
[759.333816] Subtest ccs-on-another-bo-4-tiled-mtl-mc-ccs: SUCCESS (0.093s)
[761.532729] [088/133] (255s left) kms_lease (master-vs-lease)
[761.635054] Starting subtest: master-vs-lease
[761.637345] Subtest master-vs-lease: SUCCESS (0.002s)
[761.723485] [089/133] (255s left) kms_psr (psr-primary-blt)
[761.821139] Starting subtest: psr-primary-blt
[761.824059] Starting dynamic subtest: eDP-1
[763.541035] Dynamic subtest eDP-1: SUCCESS (1.719s)
[763.543877] Subtest psr-primary-blt: SUCCESS (1.720s)
[764.406640] [090/133] (252s left) kms_force_connector_basic (prune-stale-modes)
[764.479070] Starting subtest: prune-stale-modes
[764.924986] Subtest prune-stale-modes: SUCCESS (0.447s)
[765.070040] [091/133] (251s left) gem_mmap_gtt (medium-copy)
[765.133129] Subtest medium-copy: SKIP (0.000s)
[765.188156] [092/133] (251s left) kms_vblank (crtc-id)
[765.268444] Starting subtest: crtc-id
[765.270830] Starting dynamic subtest: pipe-A-eDP-1
[765.732335] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.466s)
[765.748862] Starting dynamic subtest: pipe-D-eDP-1
[766.827654] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.093s)
[766.830211] Subtest crtc-id: SUCCESS (1.563s)
[767.633828] [093/133] (249s left) kms_cursor_crc (cursor-offscreen-64x64)
[767.814924] Starting subtest: cursor-offscreen-64x64
[767.817653] Starting dynamic subtest: pipe-A-eDP-1
[769.854485] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.037s)
[769.884661] Starting dynamic subtest: pipe-D-eDP-1
[772.520226] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.645s)
[772.522849] Subtest cursor-offscreen-64x64: SUCCESS (4.707s)
[773.328659] [094/133] (243s left) gem_exec_schedule (preempt-other)
[773.402409] Starting subtest: preempt-other
[773.405017] Starting dynamic subtest: rcs0
[773.469190] Dynamic subtest rcs0: SUCCESS (0.078s)
[773.482671] Starting dynamic subtest: bcs0
[773.539394] Dynamic subtest bcs0: SUCCESS (0.070s)
[773.557252] Starting dynamic subtest: vcs0
[773.605372] Dynamic subtest vcs0: SUCCESS (0.065s)
[773.618511] Starting dynamic subtest: vcs1
[773.674736] Dynamic subtest vcs1: SUCCESS (0.069s)
[773.688925] Starting dynamic subtest: vecs0
[773.745361] Dynamic subtest vecs0: SUCCESS (0.069s)
[773.759440] Starting dynamic subtest: ccs0
[773.811361] Dynamic subtest ccs0: SUCCESS (0.065s)
[773.814156] Subtest preempt-other: SUCCESS (0.421s)
[775.046383] [095/133] (241s left) kms_chamelium_hpd (hdmi-hpd-after-suspend)
[775.445109] Subtest hdmi-hpd-after-suspend: SKIP (0.000s)
[776.223789] [096/133] (240s left) syncobj_timeline (invalid-query-bad-pad)
[776.290531] Starting subtest: invalid-query-bad-pad
[776.293196] Subtest invalid-query-bad-pad: SUCCESS (0.000s)
[776.392079] [097/133] (240s left) kms_plane_alpha_blend (alpha-7efc)
[776.480954] Starting subtest: alpha-7efc
[776.773996] Starting dynamic subtest: pipe-A-eDP-1
[777.392185] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.618s)
[777.422969] Starting dynamic subtest: pipe-D-eDP-1
[778.722848] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.306s)
[778.725621] Subtest alpha-7efc: SUCCESS (2.243s)
[779.535698] [098/133] (237s left) kms_cursor_legacy (cursora-vs-flipb-atomic)
[779.657817] Starting subtest: cursorA-vs-flipB-atomic
[779.663029] Subtest cursorA-vs-flipB-atomic: SKIP (0.001s)
[779.808910] [099/133] (237s left) gem_blits (basic)
[779.860181] Starting subtest: basic
[781.295005] Subtest basic: SUCCESS (1.434s)
[781.401952] [100/133] (235s left) syncobj_timeline (multi-wait-submitted-signaled)
[781.459200] Starting subtest: multi-wait-submitted-signaled
[781.461803] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[781.574245] [101/133] (235s left) gem_workarounds (reset)
[781.636871] Starting subtest: reset
[781.817184] Subtest reset: SUCCESS (0.180s)
[781.944510] [102/133] (235s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180)
[782.044884] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180
[783.089939] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.046s)
[783.213940] [103/133] (234s left) kms_big_fb (linear-64bpp-rotate-270)
[783.312870] Starting subtest: linear-64bpp-rotate-270
[783.333960] Subtest linear-64bpp-rotate-270: SKIP (0.020s)
[783.448963] [104/133] (233s left) kms_flip (blocking-absolute-wf_vblank-interruptible)
[783.542584] Starting subtest: blocking-absolute-wf_vblank-interruptible
[783.544753] Starting dynamic subtest: A-eDP1
[792.256260] Dynamic subtest A-eDP1: SUCCESS (8.710s)
[792.269657] Starting dynamic subtest: B-eDP1
[800.956401] Dynamic subtest B-eDP1: SUCCESS (8.695s)
[800.966526] Starting dynamic subtest: C-eDP1
[809.647981] Dynamic subtest C-eDP1: SUCCESS (8.687s)
[809.675671] Starting dynamic subtest: D-eDP1
[818.339124] Dynamic subtest D-eDP1: SUCCESS (8.691s)
[818.344169] Subtest blocking-absolute-wf_vblank-interruptible: SUCCESS (34.796s)
[819.531582] [105/133] (197s left) gen9_exec_parse (valid-registers)
[819.587971] Subtest valid-registers: SKIP (0.000s)
[819.655112] [106/133] (197s left) kms_psr (fbc-psr2-cursor-plane-onoff)
[819.747693] Starting subtest: fbc-psr2-cursor-plane-onoff
[819.750040] Starting dynamic subtest: eDP-1
[819.755003] Dynamic subtest eDP-1: SKIP (0.000s)
[819.760006] Subtest fbc-psr2-cursor-plane-onoff: SKIP (0.001s)
[819.821787] [107/133] (197s left) prime_mmap (test_reprime)
[819.874040] Starting subtest: test_reprime
[819.876483] Starting dynamic subtest: test_reprime-smem
[819.905946] Dynamic subtest test_reprime-smem: SUCCESS (0.034s)
[819.908844] Subtest test_reprime: SUCCESS (0.034s)
[820.016633] [108/133] (197s left) gem_exec_flush (basic-wb-rw-default)
[820.076798] Starting subtest: basic-wb-rw-default
[825.530883] Subtest basic-wb-rw-default: SUCCESS (5.454s)
[825.724891] [109/133] (191s left) kms_atomic_transition (plane-all-modeset-transition-fencing)
[825.826341] Starting subtest: plane-all-modeset-transition-fencing
[825.831016] Subtest plane-all-modeset-transition-fencing: SKIP (0.000s)
[825.903993] [110/133] (191s left) kms_selftest (drm_damage_helper)
[825.947485] Starting subtest: drm_damage_helper
[826.002873] Starting dynamic subtest: drm_test_damage_iter_no_damage
[826.084476] Dynamic subtest drm_test_damage_iter_no_damage: SUCCESS (0.083s)
[826.095985] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src
[826.181065] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src: SUCCESS (0.096s)
[826.191973] Starting dynamic subtest: drm_test_damage_iter_no_damage_src_moved
[826.264956] Dynamic subtest drm_test_damage_iter_no_damage_src_moved: SUCCESS (0.085s)
[826.274868] Starting dynamic subtest: drm_test_damage_iter_no_damage_fractional_src_moved
[826.348131] Dynamic subtest drm_test_damage_iter_no_damage_fractional_src_moved: SUCCESS (0.082s)
[826.358113] Starting dynamic subtest: drm_test_damage_iter_no_damage_not_visible
[826.448337] Dynamic subtest drm_test_damage_iter_no_damage_not_visible: SUCCESS (0.099s)
[826.458198] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_crtc
[826.528400] Dynamic subtest drm_test_damage_iter_no_damage_no_crtc: SUCCESS (0.079s)
[826.539999] Starting dynamic subtest: drm_test_damage_iter_no_damage_no_fb
[826.608046] Dynamic subtest drm_test_damage_iter_no_damage_no_fb: SUCCESS (0.079s)
[826.617921] Starting dynamic subtest: drm_test_damage_iter_simple_damage
[826.691739] Dynamic subtest drm_test_damage_iter_simple_damage: SUCCESS (0.083s)
[826.701916] Starting dynamic subtest: drm_test_damage_iter_single_damage
[826.783577] Dynamic subtest drm_test_damage_iter_single_damage: SUCCESS (0.089s)
[826.804157] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_src
[826.874598] Dynamic subtest drm_test_damage_iter_single_damage_intersect_src: SUCCESS (0.092s)
[826.884877] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_src
[826.962570] Dynamic subtest drm_test_damage_iter_single_damage_outside_src: SUCCESS (0.086s)
[826.973237] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src
[827.044490] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src: SUCCESS (0.081s)
[827.055570] Starting dynamic subtest: drm_test_damage_iter_single_damage_intersect_fractional_src
[827.130396] Dynamic subtest drm_test_damage_iter_single_damage_intersect_fractional_src: SUCCESS (0.086s)
[827.142138] Starting dynamic subtest: drm_test_damage_iter_single_damage_outside_fractional_src
[827.228574] Dynamic subtest drm_test_damage_iter_single_damage_outside_fractional_src: SUCCESS (0.097s)
[827.239480] Starting dynamic subtest: drm_test_damage_iter_single_damage_src_moved
[827.314409] Dynamic subtest drm_test_damage_iter_single_damage_src_moved: SUCCESS (0.084s)
[827.325061] Starting dynamic subtest: drm_test_damage_iter_single_damage_fractional_src_moved
[827.392098] Dynamic subtest drm_test_damage_iter_single_damage_fractional_src_moved: SUCCESS (0.078s)
[827.402231] Starting dynamic subtest: drm_test_damage_iter_damage
[827.476153] Dynamic subtest drm_test_damage_iter_damage: SUCCESS (0.083s)
[827.487118] Starting dynamic subtest: drm_test_damage_iter_damage_one_intersect
[827.554608] Dynamic subtest drm_test_damage_iter_damage_one_intersect: SUCCESS (0.077s)
[827.565904] Starting dynamic subtest: drm_test_damage_iter_damage_one_outside
[827.648615] Dynamic subtest drm_test_damage_iter_damage_one_outside: SUCCESS (0.094s)
[827.659627] Starting dynamic subtest: drm_test_damage_iter_damage_src_moved
[827.726472] Dynamic subtest drm_test_damage_iter_damage_src_moved: SUCCESS (0.074s)
[827.736991] Starting dynamic subtest: drm_test_damage_iter_damage_not_visible
[827.816721] Dynamic subtest drm_test_damage_iter_damage_not_visible: SUCCESS (0.089s)
[827.819053] Subtest drm_damage_helper: SUCCESS (1.869s)
[827.965859] [111/133] (189s left) kms_cursor_crc (cursor-sliding-64x21)
[828.183094] Starting subtest: cursor-sliding-64x21
[828.238782] Subtest cursor-sliding-64x21: SKIP (0.052s)
[828.529396] [112/133] (189s left) kms_atomic_transition (modeset-transition)
[828.625556] Starting subtest: modeset-transition
[828.627623] Starting dynamic subtest: 1x-outputs
[839.498877] Dynamic subtest 1x-outputs: SUCCESS (10.876s)
[839.501678] Subtest modeset-transition: SUCCESS (10.878s)
[840.326067] [113/133] (177s left) gem_exec_whisper (basic-queues)
[840.387140] Starting subtest: basic-queues
[846.720922] Subtest basic-queues: SUCCESS (6.332s)
[846.909100] [114/133] (170s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-upscaling)
[847.003376] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-upscaling
[847.007472] Subtest flip-32bpp-ytile-to-64bpp-ytile-upscaling: SKIP (0.000s)
[847.081006] [115/133] (170s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-75)
[847.182094] Starting subtest: planes-unity-scaling-downscale-factor-0-75
[847.184710] Starting dynamic subtest: pipe-A
[847.244496] Dynamic subtest pipe-A: SUCCESS (0.065s)
[847.255078] Starting dynamic subtest: pipe-B
[848.415480] Dynamic subtest pipe-B: SUCCESS (1.170s)
[848.426231] Starting dynamic subtest: pipe-C
[849.514507] Dynamic subtest pipe-C: SUCCESS (1.098s)
[849.524239] Starting dynamic subtest: pipe-D
[850.610200] Dynamic subtest pipe-D: SUCCESS (1.095s)
[850.613233] Subtest planes-unity-scaling-downscale-factor-0-75: SUCCESS (3.432s)
[851.738805] [116/133] (166s left) gem_exec_gttfill (engines)
[851.800558] Starting subtest: engines
[851.803407] Starting dynamic subtest: rcs0
[874.723404] Dynamic subtest rcs0: SUCCESS (22.920s)
[874.736779] Starting dynamic subtest: bcs0
[898.026391] Dynamic subtest bcs0: SUCCESS (23.296s)
[898.039864] Starting dynamic subtest: vcs0
[921.412654] Dynamic subtest vcs0: SUCCESS (23.378s)
[921.423957] Starting dynamic subtest: vcs1
[944.750486] Dynamic subtest vcs1: SUCCESS (23.332s)
[944.764001] Starting dynamic subtest: vecs0
[968.083196] Dynamic subtest vecs0: SUCCESS (23.333s)
[968.096612] Starting dynamic subtest: ccs0
[991.425146] Dynamic subtest ccs0: SUCCESS (23.340s)
[991.428239] Subtest engines: SUCCESS (139.614s)
[991.619452] [117/133] ( 26s left) syncobj_eventfd (invalid-illegal-eventfd)
[991.745065] Starting subtest: invalid-illegal-eventfd
[991.748112] Subtest invalid-illegal-eventfd: SUCCESS (0.000s)
[991.837357] [118/133] ( 26s left) gem_eio (create)
[992.072369] Starting subtest: create
[992.422210] Subtest create: SUCCESS (0.350s)
[992.560593] [119/133] ( 25s left) gem_render_copy_redux (interruptible)
[992.625690] Starting subtest: interruptible
[993.028799] Subtest interruptible: SUCCESS (0.406s)
[993.140635] [120/133] ( 25s left) gem_pxp (protected-encrypted-src-copy-not-readible)
[993.243972] Starting subtest: protected-encrypted-src-copy-not-readible
[993.355825] Subtest protected-encrypted-src-copy-not-readible: SUCCESS (0.113s)
[993.480705] [121/133] ( 24s left) kms_big_fb (x-tiled-64bpp-rotate-0)
[993.586848] Starting subtest: x-tiled-64bpp-rotate-0
[995.267438] Subtest x-tiled-64bpp-rotate-0: SUCCESS (1.681s)
[995.423888] [122/133] ( 22s left) gem_lmem_swapping (heavy-random)
[995.469982] Subtest heavy-random: SKIP (0.000s)
[995.513461] [123/133] ( 22s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-blt)
[995.609865] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-blt
[995.613996] Subtest fbc-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[995.698238] [124/133] ( 22s left) perf (rc6-disable)
[995.802576] Starting subtest: rc6-disable
[996.005645] Subtest rc6-disable: SUCCESS (0.203s)
[996.058739] [125/133] ( 22s left) gem_userptr_blits (vma-merge)
[996.133211] Starting subtest: vma-merge
[996.171855] Subtest vma-merge: SUCCESS (0.039s)
[996.303303] [126/133] ( 22s left) gem_exec_big (single)
[996.354093] Starting subtest: single
[998.577994] Subtest single: FAIL (2.153s)
[998.620698] [127/133] ( 19s left) kms_frontbuffer_tracking (pipe-fbc-rte)
[998.761064] Starting subtest: pipe-fbc-rte
[998.768197] Starting dynamic subtest: pipe-B-eDP-1
[1004.217262] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.459s)
[1004.225931] Subtest pipe-fbc-rte: SUCCESS (5.461s)
[1006.564107] [128/133] ( 11s left) i915_pm_rps (min-max-config-loaded)
[1006.625667] Starting subtest: min-max-config-loaded
[1006.631976] Subtest min-max-config-loaded: SKIP (0.001s)
[1006.731442] [129/133] ( 11s left) kms_psr (fbc-pr-no-drrs)
[1006.828983] Starting subtest: fbc-pr-no-drrs
[1006.834042] Subtest fbc-pr-no-drrs: SKIP (0.000s)
[1006.904602] [130/133] ( 11s left) kms_chamelium_frames (hdmi-frame-dump)
[1007.293959] Subtest hdmi-frame-dump: SKIP (0.000s)
[1008.096261] [131/133] ( 10s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-render)
[1008.195534] Starting subtest: psr-1p-primscrn-spr-indfb-draw-render
[1014.901567] Subtest psr-1p-primscrn-spr-indfb-draw-render: SUCCESS (6.712s)
[1015.031270] [132/133] (  3s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[1015.090613] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[1015.093189] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[1015.212526] [133/133] (  3s left) gem_exec_create (basic)
[1015.288156] Starting subtest: basic
[1015.290797] Starting dynamic subtest: smem
[1017.379381] Dynamic subtest smem: SUCCESS (2.090s)
[1017.382251] Subtest basic: SUCCESS (2.092s)
[1017.578908] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_cursor_crc
results: parsing output: 2/ for test: gem_mmap
results: parsing output: 3/ for test: kms_psr2_sf
results: parsing output: 4/ for test: kms_flip
results: parsing output: 5/ for test: i915_pm_rps
results: parsing output: 6/ for test: kms_ccs
results: parsing output: 7/ for test: kms_getfb
results: parsing output: 8/ for test: kms_invalid_mode
results: parsing output: 9/ for test: gem_exec_schedule
results: parsing output: 10/ for test: core_getstats
results: parsing output: 11/ for test: gem_exec_fence
results: parsing output: 12/ for test: kms_psr
results: parsing output: 13/ for test: kms_frontbuffer_tracking
results: parsing output: 14/ for test: kms_addfb_basic
results: parsing output: 15/ for test: gem_ctx_engines
results: parsing output: 16/ for test: kms_flip
results: parsing output: 17/ for test: syncobj_timeline
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: kms_feature_discovery
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: dumb_buffer
results: parsing output: 22/ for test: kms_content_protection
results: parsing output: 23/ for test: gem_readwrite
results: parsing output: 24/ for test: gem_mmap_wc
results: parsing output: 25/ for test: kms_cursor_legacy
results: parsing output: 26/ for test: gem_ctx_persistence
results: parsing output: 27/ for test: kms_addfb_basic
results: parsing output: 28/ for test: kms_psr
results: parsing output: 29/ for test: gem_mmap_gtt
results: parsing output: 30/ for test: gem_exec_reloc
results: parsing output: 31/ for test: gem_pxp
results: parsing output: 32/ for test: kms_color
results: parsing output: 33/ for test: kms_big_fb
results: parsing output: 34/ for test: perf_pmu
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: gem_mmap_gtt
results: parsing output: 38/ for test: kms_big_fb
results: parsing output: 39/ for test: kms_ccs
results: parsing output: 40/ for test: kms_addfb_basic
results: parsing output: 41/ for test: kms_pm_dc
results: parsing output: 42/ for test: gem_softpin
results: parsing output: 43/ for test: kms_frontbuffer_tracking
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: kms_plane
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: gem_ctx_exec
results: parsing output: 48/ for test: gem_exec_flush
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: kms_ccs
results: parsing output: 51/ for test: prime_busy
results: parsing output: 52/ for test: gem_exec_reloc
results: parsing output: 53/ for test: api_intel_bb
results: parsing output: 54/ for test: kms_plane_multiple
results: parsing output: 55/ for test: sysfs_heartbeat_interval
results: parsing output: 56/ for test: gem_spin_batch
results: parsing output: 57/ for test: kms_pm_rpm
results: parsing output: 58/ for test: perf
results: parsing output: 59/ for test: kms_ccs
results: parsing output: 60/ for test: kms_flip
results: parsing output: 61/ for test: gem_mmap_offset
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: perf_pmu
results: parsing output: 64/ for test: gem_exec_balancer
results: parsing output: 65/ for test: gem_exec_reloc
results: parsing output: 66/ for test: gem_ctx_persistence
results: parsing output: 67/ for test: kms_psr
results: parsing output: 68/ for test: gen9_exec_parse
results: parsing output: 69/ for test: kms_psr2_sf
results: parsing output: 70/ for test: sw_sync
results: parsing output: 71/ for test: gem_userptr_blits
results: parsing output: 72/ for test: kms_rotation_crc
results: parsing output: 73/ for test: kms_fbcon_fbt
results: parsing output: 74/ for test: kms_getfb
results: parsing output: 75/ for test: gem_mmap_gtt
results: parsing output: 76/ for test: kms_vblank
results: parsing output: 77/ for test: kms_rmfb
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_plane_scaling
results: parsing output: 80/ for test: kms_frontbuffer_tracking
results: parsing output: 81/ for test: i915_pm_freq_api
results: parsing output: 82/ for test: syncobj_timeline
results: parsing output: 83/ for test: kms_big_fb
results: parsing output: 84/ for test: kms_cursor_legacy
results: parsing output: 85/ for test: gem_mmap_wc
results: parsing output: 86/ for test: kms_ccs
results: parsing output: 87/ for test: kms_lease
results: parsing output: 88/ for test: kms_psr
results: parsing output: 89/ for test: kms_force_connector_basic
results: parsing output: 90/ for test: gem_mmap_gtt
results: parsing output: 91/ for test: kms_vblank
results: parsing output: 92/ for test: kms_cursor_crc
results: parsing output: 93/ for test: gem_exec_schedule
results: parsing output: 94/ for test: kms_chamelium_hpd
results: parsing output: 95/ for test: syncobj_timeline
results: parsing output: 96/ for test: kms_plane_alpha_blend
results: parsing output: 97/ for test: kms_cursor_legacy
results: parsing output: 98/ for test: gem_blits
results: parsing output: 99/ for test: syncobj_timeline
results: parsing output: 100/ for test: gem_workarounds
results: parsing output: 101/ for test: kms_big_fb
results: parsing output: 102/ for test: kms_big_fb
results: parsing output: 103/ for test: kms_flip
results: parsing output: 104/ for test: gen9_exec_parse
results: parsing output: 105/ for test: kms_psr
results: parsing output: 106/ for test: prime_mmap
results: parsing output: 107/ for test: gem_exec_flush
results: parsing output: 108/ for test: kms_atomic_transition
results: parsing output: 109/ for test: kms_selftest
results: parsing output: 110/ for test: kms_cursor_crc
results: parsing output: 111/ for test: kms_atomic_transition
results: parsing output: 112/ for test: gem_exec_whisper
results: parsing output: 113/ for test: kms_flip_scaled_crc
results: parsing output: 114/ for test: kms_plane_scaling
results: parsing output: 115/ for test: gem_exec_gttfill
results: parsing output: 116/ for test: syncobj_eventfd
results: parsing output: 117/ for test: gem_eio
results: parsing output: 118/ for test: gem_render_copy_redux
results: parsing output: 119/ for test: gem_pxp
results: parsing output: 120/ for test: kms_big_fb
results: parsing output: 121/ for test: gem_lmem_swapping
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: perf
results: parsing output: 124/ for test: gem_userptr_blits
results: parsing output: 125/ for test: gem_exec_big
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: i915_pm_rps
results: parsing output: 128/ for test: kms_psr
results: parsing output: 129/ for test: kms_chamelium_frames
results: parsing output: 130/ for test: kms_frontbuffer_tracking
results: parsing output: 131/ for test: syncobj_wait
results: parsing output: 132/ for test: gem_exec_create
Done.