[59.957146] Initializing watchdogs
[59.957211]   /dev/watchdog0
[59.972404] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[59.976961] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.979218] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.982873] [001/133] (960s left) i915_drm_fdinfo (virtual-idle)
[60.056799] Starting subtest: virtual-idle
[63.143745] Subtest virtual-idle: SUCCESS (3.059s)
[63.216231] [002/133] (957s left) kms_dp_link_training (uhbr-sst)
[63.316155] Starting subtest: uhbr-sst
[63.324266] Subtest uhbr-sst: SKIP (0.000s)
[63.398640] [003/133] (957s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[63.502313] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip
[63.506388] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[63.600841] [004/133] (957s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-upscaling)
[63.696104] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-upscaling
[63.698468] Starting dynamic subtest: pipe-A-default-mode
[66.416993] Dynamic subtest pipe-A-default-mode: SUCCESS (2.707s)
[66.419433] Subtest flip-32bpp-4tile-to-64bpp-4tile-upscaling: SUCCESS (2.708s)
[67.248065] [005/133] (953s left) gem_exec_whisper (basic-queues-priority)
[67.316134] Starting subtest: basic-queues-priority
[90.461683] Subtest basic-queues-priority: SUCCESS (23.118s)
[90.654254] [006/133] (930s left) gen9_exec_parse (bb-start-far)
[90.715302] Subtest bb-start-far: SKIP (0.000s)
[90.794778] [007/133] (929s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180)
[90.898843] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180
[91.978055] Subtest x-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.080s)
[92.089247] [008/133] (928s left) perf (non-sampling-read-error)
[92.228668] Starting subtest: non-sampling-read-error
[92.240906] Subtest non-sampling-read-error: SUCCESS (0.011s)
[92.283651] [009/133] (928s left) kms_big_fb (x-tiled-32bpp-rotate-0)
[92.383299] Starting subtest: x-tiled-32bpp-rotate-0
[93.873802] Subtest x-tiled-32bpp-rotate-0: SUCCESS (1.491s)
[93.996806] [010/133] (926s left) perf_pmu (busy-double-start)
[94.041280] Starting subtest: busy-double-start
[94.042954] Starting dynamic subtest: rcs0
[97.679712] Dynamic subtest rcs0: FAIL (3.580s)
[97.689754] Starting dynamic subtest: bcs0
[101.189244] Dynamic subtest bcs0: SUCCESS (3.566s)
[101.202318] Starting dynamic subtest: vcs0
[104.865755] Dynamic subtest vcs0: SUCCESS (3.676s)
[104.875544] Starting dynamic subtest: vcs1
[108.854753] Dynamic subtest vcs1: SUCCESS (3.988s)
[108.865909] Starting dynamic subtest: vecs0
[112.885998] Dynamic subtest vecs0: SUCCESS (4.030s)
[112.896813] Starting dynamic subtest: ccs0
[116.521193] Dynamic subtest ccs0: FAIL (3.566s)
[116.523116] Subtest busy-double-start: FAIL (22.409s)
[116.562352] [011/133] (904s left) syncobj_wait (multi-wait-all-for-submit-submitted)
[116.631435] Starting subtest: multi-wait-all-for-submit-submitted
[116.735974] Subtest multi-wait-all-for-submit-submitted: SUCCESS (0.103s)
[116.809079] [012/133] (904s left) kms_frontbuffer_tracking (psr-indfb-scaledprimary)
[116.908627] Starting subtest: psr-indfb-scaledprimary
[122.664421] Subtest psr-indfb-scaledprimary: SUCCESS (5.759s)
[122.781907] [013/133] (898s left) kms_atomic (plane-invalid-params)
[122.873210] Starting subtest: plane-invalid-params
[122.875528] Starting dynamic subtest: pipe-A-eDP-1
[123.275651] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.401s)
[123.277647] Subtest plane-invalid-params: SUCCESS (0.402s)
[124.136849] [014/133] (896s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen)
[124.234358] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen
[124.238395] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[124.318403] [015/133] (896s left) kms_content_protection (lic-type-0-hdcp14)
[124.458866] Starting subtest: lic-type-0-hdcp14
[124.463369] Subtest lic-type-0-hdcp14: SKIP (0.000s)
[124.567226] [016/133] (896s left) kms_frontbuffer_tracking (fbc-rgb565-draw-blt)
[124.671464] Starting subtest: fbc-rgb565-draw-blt
[128.809312] Subtest fbc-rgb565-draw-blt: SUCCESS (4.140s)
[129.977979] [017/133] (891s left) kms_psr (psr2-cursor-mmap-gtt)
[130.092230] Starting subtest: psr2-cursor-mmap-gtt
[130.094543] Starting dynamic subtest: eDP-1
[131.826386] Dynamic subtest eDP-1: SUCCESS (1.733s)
[131.828323] Subtest psr2-cursor-mmap-gtt: SUCCESS (1.734s)
[132.628373] [018/133] (888s left) kms_setmode (basic)
[132.682096] Starting subtest: basic
[133.022390] Starting dynamic subtest: pipe-A-eDP-1
[135.149251] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.122s)
[135.490844] Starting dynamic subtest: pipe-B-eDP-1
[137.584324] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.097s)
[137.905902] Subtest basic: SUCCESS (5.223s)
[138.740919] [019/133] (882s left) kms_pm_rpm (modeset-lpsp-stress)
[140.471302] Starting subtest: modeset-lpsp-stress
[156.945734] Subtest modeset-lpsp-stress: SUCCESS (16.475s)
[157.055133] [020/133] (864s left) kms_cursor_crc (cursor-offscreen-256x85)
[157.299040] Starting subtest: cursor-offscreen-256x85
[157.358038] Subtest cursor-offscreen-256x85: SKIP (0.053s)
[157.529780] [021/133] (863s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs)
[157.620755] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-mc-ccs
[157.622933] Starting dynamic subtest: pipe-A-eDP-1
[157.905724] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.252s)
[157.916527] Starting dynamic subtest: pipe-B-eDP-1
[159.192195] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.284s)
[159.203288] Starting dynamic subtest: pipe-C-eDP-1
[160.470942] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.278s)
[160.481618] Starting dynamic subtest: pipe-D-eDP-1
[161.718658] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.246s)
[161.720719] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SUCCESS (4.065s)
[162.847140] [022/133] (858s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[162.951051] Starting subtest: plane-downscale-factor-0-75-with-rotation
[162.953322] Starting dynamic subtest: pipe-A
[163.201708] Dynamic subtest pipe-A: SUCCESS (0.253s)
[163.210489] Starting dynamic subtest: pipe-B
[164.530067] Dynamic subtest pipe-B: SUCCESS (1.328s)
[164.539819] Starting dynamic subtest: pipe-C
[165.876373] Dynamic subtest pipe-C: SUCCESS (1.345s)
[165.886714] Starting dynamic subtest: pipe-D
[167.217410] Dynamic subtest pipe-D: SUCCESS (1.340s)
[167.219737] Subtest plane-downscale-factor-0-75-with-rotation: SUCCESS (4.269s)
[168.389451] [023/133] (852s left) gem_mmap_offset (clear)
[168.440209] Starting subtest: clear
[168.442704] Starting dynamic subtest: smem0
[193.949861] Dynamic subtest smem0: SUCCESS (25.502s)
[193.952238] Subtest clear: SUCCESS (25.505s)
[194.082603] [024/133] (827s left) gem_exec_flush (basic-uc-set-default)
[194.186935] Starting subtest: basic-uc-set-default
[199.674676] Subtest basic-uc-set-default: SUCCESS (5.463s)
[199.835529] [025/133] (821s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-pwrite)
[199.940359] Starting subtest: psr-1p-primscrn-pri-indfb-draw-pwrite
[207.676523] Subtest psr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (7.740s)
[207.777523] [026/133] (813s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode)
[208.165552] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s)
[208.988940] [027/133] (812s left) sw_sync (sync_merge_same)
[209.038860] Starting subtest: sync_merge_same
[209.041175] Subtest sync_merge_same: SUCCESS (0.000s)
[209.095183] [028/133] (812s left) gem_sync (basic-store-each)
[209.170447] Starting subtest: basic-store-each
[211.564381] Subtest basic-store-each: SUCCESS (2.403s)
[211.761268] [029/133] (809s left) kms_atomic_transition (plane-all-transition-fencing)
[211.856896] Starting subtest: plane-all-transition-fencing
[211.859161] Starting dynamic subtest: pipe-A-eDP-1
[214.356063] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.499s)
[214.682582] Starting dynamic subtest: pipe-B-eDP-1
[217.955551] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.283s)
[218.256088] Subtest plane-all-transition-fencing: SUCCESS (6.398s)
[219.092889] [030/133] (802s left) kms_rotation_crc (sprite-rotation-270)
[219.179222] Starting subtest: sprite-rotation-270
[219.183644] Subtest sprite-rotation-270: SKIP (0.001s)
[219.256565] [031/133] (802s left) prime_vgem (busy)
[219.369405] Starting subtest: busy
[219.371712] Starting dynamic subtest: rcs0
[219.413601] Dynamic subtest rcs0: SUCCESS (0.044s)
[219.422924] Starting dynamic subtest: bcs0
[219.475628] Dynamic subtest bcs0: SUCCESS (0.061s)
[219.485253] Starting dynamic subtest: vcs0
[219.523918] Dynamic subtest vcs0: SUCCESS (0.048s)
[219.533113] Starting dynamic subtest: vcs1
[219.569820] Dynamic subtest vcs1: SUCCESS (0.045s)
[219.578843] Starting dynamic subtest: vecs0
[219.615253] Dynamic subtest vecs0: SUCCESS (0.045s)
[219.624247] Starting dynamic subtest: ccs0
[219.660582] Dynamic subtest ccs0: SUCCESS (0.044s)
[219.662851] Subtest busy: SUCCESS (0.291s)
[219.810059] [FACT prime_vgem (busy)] new: kernel.kmod_is_loaded.vgem: true
[219.813695] [032/133] (801s left) api_intel_bb (reset-bb)
[219.881873] Starting subtest: reset-bb
[219.884302] Subtest reset-bb: SUCCESS (0.003s)
[220.012061] [033/133] (801s left) gem_exec_reloc (basic-gtt-noreloc)
[220.068163] Subtest basic-gtt-noreloc: SKIP (0.000s)
[220.138103] [034/133] (801s left) gem_close (basic)
[220.201158] Starting subtest: basic
[220.203149] Subtest basic: SUCCESS (0.000s)
[220.347616] [035/133] (801s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[220.446394] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[220.449881] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[220.536373] [036/133] (801s left) kms_scaling_modes (scaling-mode-full-aspect)
[220.623713] Starting subtest: scaling-mode-full-aspect
[220.625647] Starting dynamic subtest: pipe-A-eDP-1
[220.718774] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.097s)
[220.729954] Starting dynamic subtest: pipe-B-eDP-1
[221.908619] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.186s)
[221.922462] Starting dynamic subtest: pipe-C-eDP-1
[223.024484] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.112s)
[223.034070] Starting dynamic subtest: pipe-D-eDP-1
[224.157275] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.131s)
[224.159667] Subtest scaling-mode-full-aspect: SUCCESS (3.536s)
[225.318978] [037/133] (796s left) kms_psr2_sf (pr-overlay-plane-update-sf-dmg-area)
[225.422719] Starting subtest: pr-overlay-plane-update-sf-dmg-area
[225.426918] Subtest pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[225.490257] [038/133] (796s left) gem_watchdog (default-physical)
[225.562462] Starting subtest: default-physical
[227.318324] Subtest default-physical: SUCCESS (1.767s)
[227.420403] [039/133] (794s left) gem_eio (unwedge-stress)
[227.607576] Starting subtest: unwedge-stress
[227.609675] Starting dynamic subtest: render
[231.883251] Dynamic subtest render: SUCCESS (4.274s)
[231.899085] Starting dynamic subtest: bsd1
[249.718400] Dynamic subtest bsd1: SUCCESS (17.833s)
[249.733840] Starting dynamic subtest: bsd2
[267.770458] Dynamic subtest bsd2: SUCCESS (18.050s)
[267.785297] Starting dynamic subtest: blt
[267.789449] Dynamic subtest blt: SKIP (0.000s)
[267.798653] Starting dynamic subtest: vebox
[285.775633] Dynamic subtest vebox: SUCCESS (18.002s)
[285.778092] Subtest unwedge-stress: SUCCESS (58.165s)
[287.365011] [040/133] (734s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-upscaling)
[287.470118] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-upscaling
[287.472190] Starting dynamic subtest: pipe-A-default-mode
[290.209904] Dynamic subtest pipe-A-default-mode: SUCCESS (2.739s)
[290.212157] Subtest flip-64bpp-4tile-to-32bpp-4tile-upscaling: SUCCESS (2.740s)
[291.052354] [041/133] (731s left) kms_plane (pixel-format-4-tiled-dg2-mc-ccs-modifier-source-clamping)
[291.150204] Starting subtest: pixel-format-4-tiled-dg2-mc-ccs-modifier-source-clamping
[291.154804] Subtest pixel-format-4-tiled-dg2-mc-ccs-modifier-source-clamping: SKIP (0.000s)
[291.226291] [042/133] (730s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-render)
[291.309336] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-render
[291.313260] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[291.413293] [043/133] (730s left) i915_query (engine-info)
[291.464661] Starting subtest: engine-info
[291.467074] Subtest engine-info: SUCCESS (0.005s)
[291.583408] [044/133] (730s left) gem_ctx_shared (disjoint-timelines)
[291.645494] Starting subtest: disjoint-timelines
[291.664894] Subtest disjoint-timelines: SUCCESS (0.018s)
[291.898375] [045/133] (730s left) kms_flip (2x-wf_vblank-ts-check-interruptible)
[291.980097] Starting subtest: 2x-wf_vblank-ts-check-interruptible
[291.991457] Subtest 2x-wf_vblank-ts-check-interruptible: SKIP (0.011s)
[292.069700] [046/133] (730s left) sw_sync (sync_busy_fork)
[292.103687] Starting subtest: sync_busy_fork
[293.115971] Subtest sync_busy_fork: SUCCESS (1.012s)
[293.180321] [047/133] (729s left) kms_vblank (ts-continuation-dpms-suspend)
[293.277162] Starting subtest: ts-continuation-dpms-suspend
[293.279300] Starting dynamic subtest: pipe-A-eDP-1
[310.770944] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.475s)
[310.786155] Starting dynamic subtest: pipe-D-eDP-1
[328.752454] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.878s)
[328.754810] Subtest ts-continuation-dpms-suspend: SUCCESS (5.357s)
[338.636281] [048/133] (692s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[338.717024] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[338.721480] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[338.912021] [049/133] (692s left) kms_cursor_crc (cursor-random-32x10)
[339.075876] Starting subtest: cursor-random-32x10
[339.124141] Subtest cursor-random-32x10: SKIP (0.041s)
[339.445762] [050/133] (692s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0)
[339.557586] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0
[340.660321] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.079s)
[340.825966] [051/133] (690s left) gem_spin_batch (resubmit-all)
[340.893156] Starting subtest: resubmit-all
[340.895230] Starting dynamic subtest: rcs0
[340.907186] Dynamic subtest rcs0: SUCCESS (0.014s)
[340.918309] Starting dynamic subtest: bcs0
[340.920195] Dynamic subtest bcs0: SUCCESS (0.003s)
[340.930576] Starting dynamic subtest: vcs0
[340.932417] Dynamic subtest vcs0: SUCCESS (0.002s)
[340.942448] Starting dynamic subtest: vcs1
[340.944318] Dynamic subtest vcs1: SUCCESS (0.002s)
[340.954968] Starting dynamic subtest: vecs0
[340.956937] Dynamic subtest vecs0: SUCCESS (0.002s)
[340.966960] Starting dynamic subtest: ccs0
[340.968831] Dynamic subtest ccs0: SUCCESS (0.002s)
[340.970735] Subtest resubmit-all: SUCCESS (0.030s)
[342.517829] [052/133] (689s left) gem_exec_fence (basic-wait-all)
[342.575330] Starting subtest: basic-wait-all
[342.657560] Subtest basic-wait-all: SUCCESS (0.081s)
[344.530013] [053/133] (687s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[344.631735] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt
[344.636066] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[344.730726] [054/133] (687s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[344.790986] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[344.793319] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[344.885294] [055/133] (686s left) gem_ctx_isolation (dirty-switch)
[344.943187] Starting subtest: dirty-switch
[344.945657] Starting dynamic subtest: rcs0
[345.219317] Dynamic subtest rcs0: SUCCESS (0.272s)
[345.234532] Starting dynamic subtest: bcs0
[345.551798] Dynamic subtest bcs0: SUCCESS (0.328s)
[345.564424] Starting dynamic subtest: vcs0
[345.820553] Dynamic subtest vcs0: SUCCESS (0.265s)
[345.833300] Starting dynamic subtest: vcs1
[347.669129] Dynamic subtest vcs1: SUCCESS (1.831s)
[347.679347] Starting dynamic subtest: vecs0
[349.640118] Dynamic subtest vecs0: SUCCESS (1.956s)
[349.653045] Starting dynamic subtest: ccs0
[351.660903] Dynamic subtest ccs0: SUCCESS (2.009s)
[351.663528] Subtest dirty-switch: SUCCESS (6.668s)
[351.904715] [056/133] (679s left) perf (invalid-oa-metric-set-id)
[352.008605] Starting subtest: invalid-oa-metric-set-id
[352.016164] Subtest invalid-oa-metric-set-id: SUCCESS (0.009s)
[352.058120] [057/133] (679s left) gem_mmap_wc (write-read-distinct)
[352.123212] Subtest write-read-distinct: SKIP (0.000s)
[352.187710] [058/133] (679s left) gem_exec_reloc (basic-gtt-read)
[352.253922] Subtest basic-gtt-read: SKIP (0.000s)
[352.322246] [059/133] (679s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc)
[352.418844] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc
[352.421160] Starting dynamic subtest: pipe-A-eDP-1
[352.443125] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[352.455470] Starting dynamic subtest: pipe-B-eDP-1
[352.475981] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[352.485903] Starting dynamic subtest: pipe-C-eDP-1
[352.506589] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[352.519031] Starting dynamic subtest: pipe-D-eDP-1
[352.541356] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[352.545888] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs-cc: SKIP (0.006s)
[354.699577] [060/133] (677s left) kms_color (ctm-0-50)
[354.802044] Starting subtest: ctm-0-50
[354.804391] Starting dynamic subtest: pipe-A-eDP-1
[358.330521] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.518s)
[358.343438] Starting dynamic subtest: pipe-B-eDP-1
[362.596479] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.260s)
[362.607580] Starting dynamic subtest: pipe-C-eDP-1
[366.563416] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.964s)
[366.574444] Starting dynamic subtest: pipe-D-eDP-1
[370.558599] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.995s)
[370.560895] Subtest ctm-0-50: SUCCESS (15.740s)
[371.421872] [061/133] (660s left) kms_vblank (invalid)
[371.529268] Starting subtest: invalid
[371.531472] Starting dynamic subtest: pipe-A-eDP-1
[371.937778] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.409s)
[371.939982] Subtest invalid: SUCCESS (0.411s)
[372.735880] [062/133] (659s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-plflip-blt)
[372.848892] Starting subtest: fbc-2p-scndscrn-shrfb-plflip-blt
[372.852919] Subtest fbc-2p-scndscrn-shrfb-plflip-blt: SKIP (0.000s)
[372.951866] [063/133] (659s left) gem_exec_balancer (bonded-pair)
[373.009505] Starting subtest: bonded-pair
[373.013919] Subtest bonded-pair: SKIP (0.000s)
[373.310731] [064/133] (658s left) gem_exec_reloc (basic-concurrent0)
[373.378034] Subtest basic-concurrent0: SKIP (0.000s)
[373.448242] [065/133] (658s left) kms_psr (fbc-psr2-cursor-mmap-gtt)
[373.537031] Starting subtest: fbc-psr2-cursor-mmap-gtt
[373.539165] Starting dynamic subtest: eDP-1
[373.543458] Dynamic subtest eDP-1: SKIP (0.000s)
[373.547573] Subtest fbc-psr2-cursor-mmap-gtt: SKIP (0.001s)
[373.619955] [066/133] (658s left) gem_exec_whisper (basic-fds-priority)
[373.684832] Starting subtest: basic-fds-priority
[398.854096] Subtest basic-fds-priority: SUCCESS (25.101s)
[399.001617] [067/133] (633s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-msflip-blt)
[399.111321] Starting subtest: fbc-2p-scndscrn-indfb-msflip-blt
[399.115658] Subtest fbc-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[399.213356] [068/133] (633s left) kms_pipe_crc_basic (suspend-read-crc)
[399.303980] Starting subtest: suspend-read-crc
[399.306095] Starting dynamic subtest: pipe-A-eDP-1
[417.093951] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.947s)
[417.107057] Starting dynamic subtest: pipe-B-eDP-1
[436.099292] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.515s)
[436.113554] Starting dynamic subtest: pipe-C-eDP-1
[455.054635] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.510s)
[455.065914] Starting dynamic subtest: pipe-D-eDP-1
[474.060179] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.477s)
[474.062776] Subtest suspend-read-crc: SUCCESS (13.455s)
[483.950944] [069/133] (557s left) gem_ctx_persistence (legacy-engines-hang)
[484.022717] Starting subtest: legacy-engines-hang
[484.025251] Starting dynamic subtest: render
[484.160330] Dynamic subtest render: SUCCESS (0.140s)
[484.177057] Starting dynamic subtest: bsd1
[484.267339] Dynamic subtest bsd1: SUCCESS (0.102s)
[484.283148] Starting dynamic subtest: bsd2
[484.360554] Dynamic subtest bsd2: SUCCESS (0.088s)
[484.374250] Starting dynamic subtest: blt
[484.457092] Dynamic subtest blt: SUCCESS (0.092s)
[484.470895] Starting dynamic subtest: vebox
[484.552311] Dynamic subtest vebox: SUCCESS (0.090s)
[484.555205] Subtest legacy-engines-hang: SUCCESS (0.527s)
[484.642303] [070/133] (556s left) kms_chamelium_color (ctm-red-to-blue)
[484.745714] Subtest ctm-red-to-blue: SKIP (0.000s)
[484.797542] [071/133] (556s left) gem_pxp (protected-raw-src-copy-not-readible)
[484.922536] Starting subtest: protected-raw-src-copy-not-readible
[484.983674] Subtest protected-raw-src-copy-not-readible: SUCCESS (0.062s)
[485.111401] [072/133] (556s left) kms_psr (pr-primary-blt)
[485.211325] Starting subtest: pr-primary-blt
[485.215527] Subtest pr-primary-blt: SKIP (0.000s)
[485.286492] [073/133] (556s left) kms_psr2_sf (psr2-cursor-plane-update-sf)
[485.376645] Starting subtest: psr2-cursor-plane-update-sf
[485.378802] Starting dynamic subtest: pipe-A-eDP-1
[485.955618] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.570s)
[485.967799] Starting dynamic subtest: pipe-B-eDP-1
[487.237679] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.261s)
[487.240646] Subtest psr2-cursor-plane-update-sf: SUCCESS (1.833s)
[488.119472] [074/133] (553s left) kms_plane (pixel-format-yf-tiled-ccs-modifier-source-clamping)
[488.211605] Starting subtest: pixel-format-yf-tiled-ccs-modifier-source-clamping
[488.216675] Subtest pixel-format-yf-tiled-ccs-modifier-source-clamping: SKIP (0.000s)
[488.302268] [075/133] (553s left) kms_display_modes (extended-mode-basic)
[488.400711] Starting subtest: extended-mode-basic
[488.405610] Subtest extended-mode-basic: SKIP (0.000s)
[488.452039] [076/133] (553s left) kms_frontbuffer_tracking (fbc-1p-shrfb-fliptrack-mmap-gtt)
[488.538676] Starting subtest: fbc-1p-shrfb-fliptrack-mmap-gtt
[488.544034] Subtest fbc-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[488.631507] [077/133] (553s left) kms_big_fb (linear-8bpp-rotate-270)
[488.728766] Starting subtest: linear-8bpp-rotate-270
[488.755773] Subtest linear-8bpp-rotate-270: SKIP (0.023s)
[488.872839] [078/133] (553s left) kms_chamelium_color (ctm-0-25)
[488.972451] Subtest ctm-0-25: SKIP (0.000s)
[489.019012] [079/133] (552s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area)
[489.119452] Starting subtest: fbc-pr-overlay-plane-update-sf-dmg-area
[489.123885] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[489.189852] [080/133] (552s left) kms_cursor_legacy (short-flip-before-cursor-atomic-transitions-varying-size)
[489.314361] Starting subtest: short-flip-before-cursor-atomic-transitions-varying-size
[490.295760] Subtest short-flip-before-cursor-atomic-transitions-varying-size: SUCCESS (0.970s)
[491.182719] [081/133] (550s left) gem_caching (reads)
[491.252529] Subtest reads: SKIP (0.000s)
[491.322695] [082/133] (550s left) kms_busy (extended-modeset-hang-oldfb)
[491.415573] Starting subtest: extended-modeset-hang-oldfb
[491.418196] Starting dynamic subtest: pipe-A
[503.179794] Dynamic subtest pipe-A: SUCCESS (11.709s)
[503.191597] Starting dynamic subtest: pipe-D
[515.663463] Dynamic subtest pipe-D: SUCCESS (12.464s)
[515.666489] Subtest extended-modeset-hang-oldfb: SUCCESS (24.179s)
[516.461748] [083/133] (525s left) kms_ccs (ccs-on-another-bo-y-tiled-ccs)
[516.556912] Starting subtest: ccs-on-another-bo-y-tiled-ccs
[516.559743] Starting dynamic subtest: pipe-A-eDP-1
[516.587366] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[516.598472] Starting dynamic subtest: pipe-B-eDP-1
[516.625716] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[516.636626] Starting dynamic subtest: pipe-C-eDP-1
[516.665044] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[516.676845] Starting dynamic subtest: pipe-D-eDP-1
[516.703258] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[516.707866] Subtest ccs-on-another-bo-y-tiled-ccs: SKIP (0.016s)
[518.854061] [084/133] (523s left) kms_big_fb (y-tiled-32bpp-rotate-0)
[518.951330] Starting subtest: y-tiled-32bpp-rotate-0
[518.956402] Subtest y-tiled-32bpp-rotate-0: SKIP (0.000s)
[519.054199] [085/133] (523s left) kms_psr (fbc-psr-primary-render)
[519.140056] Starting subtest: fbc-psr-primary-render
[519.142467] Starting dynamic subtest: eDP-1
[519.146695] Dynamic subtest eDP-1: SKIP (0.000s)
[519.151058] Subtest fbc-psr-primary-render: SKIP (0.001s)
[519.216669] [086/133] (523s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-blt)
[519.313015] Starting subtest: psr-1p-offscreen-pri-indfb-draw-blt
[526.194331] Subtest psr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.884s)
[526.335374] [087/133] (516s left) gem_exec_fence (syncobj-timeline-repeat)
[526.903522] Starting subtest: syncobj-timeline-repeat
[527.143870] Subtest syncobj-timeline-repeat: SUCCESS (0.241s)
[528.794284] [088/133] (513s left) gem_eio (in-flight-internal-1us)
[529.013303] Starting subtest: in-flight-internal-1us
[530.834533] Subtest in-flight-internal-1us: SUCCESS (1.818s)
[530.975056] [089/133] (511s left) kms_invalid_mode (overflow-vrefresh)
[531.071232] Starting subtest: overflow-vrefresh
[531.073764] Starting dynamic subtest: pipe-A-eDP-1
[531.354723] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s)
[531.367148] Starting dynamic subtest: pipe-B-eDP-1
[531.369748] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[531.380704] Starting dynamic subtest: pipe-C-eDP-1
[531.383207] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[531.393546] Starting dynamic subtest: pipe-D-eDP-1
[531.395892] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[531.398343] Subtest overflow-vrefresh: SUCCESS (0.290s)
[532.230714] [090/133] (510s left) syncobj_wait (multi-wait-for-submit-unsubmitted-signaled)
[532.290781] Starting subtest: multi-wait-for-submit-unsubmitted-signaled
[532.293328] Subtest multi-wait-for-submit-unsubmitted-signaled: SUCCESS (0.000s)
[532.400365] [091/133] (510s left) kms_pm_rpm (cursor)
[533.925120] Starting subtest: cursor
[533.930621] Subtest cursor: SKIP (0.000s)
[534.668637] [092/133] (507s left) gem_exec_schedule (timeslicing)
[534.744717] Starting subtest: timeslicing
[534.747832] Starting dynamic subtest: rcs0
[534.750628] Dynamic subtest rcs0: SUCCESS (0.022s)
[534.764170] Starting dynamic subtest: bcs0
[534.773621] Dynamic subtest bcs0: SUCCESS (0.022s)
[534.784683] Starting dynamic subtest: vcs0
[534.794599] Dynamic subtest vcs0: SUCCESS (0.020s)
[534.805354] Starting dynamic subtest: vcs1
[534.815101] Dynamic subtest vcs1: SUCCESS (0.020s)
[534.825792] Starting dynamic subtest: vecs0
[534.835861] Dynamic subtest vecs0: SUCCESS (0.020s)
[534.846719] Starting dynamic subtest: ccs0
[534.856842] Dynamic subtest ccs0: SUCCESS (0.020s)
[534.859882] Subtest timeslicing: SUCCESS (0.128s)
[536.819604] [093/133] (505s left) kms_cursor_edge_walk (128x128-top-edge)
[536.906332] Starting subtest: 128x128-top-edge
[536.908946] Starting dynamic subtest: pipe-A-eDP-1
[540.348644] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.442s)
[540.360637] Starting dynamic subtest: pipe-D-eDP-1
[543.477977] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.125s)
[543.481178] Subtest 128x128-top-edge: SUCCESS (6.571s)
[544.286544] [094/133] (498s left) gem_exec_reloc (basic-cpu-read-noreloc)
[544.357865] Subtest basic-cpu-read-noreloc: SKIP (0.000s)
[544.439661] [095/133] (498s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-blt)
[544.540653] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-blt
[544.545786] Subtest psr-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s)
[544.630683] [096/133] (498s left) syncobj_wait (multi-wait-for-submit-submitted)
[544.684678] Starting subtest: multi-wait-for-submit-submitted
[544.790837] Subtest multi-wait-for-submit-submitted: SUCCESS (0.106s)
[544.875690] [097/133] (497s left) syncobj_timeline (invalid-wait-illegal-handle)
[544.925383] Starting subtest: invalid-wait-illegal-handle
[544.928096] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s)
[545.029859] [098/133] (497s left) syncobj_timeline (etime-single-wait-available-unsubmitted)
[545.087308] Starting subtest: etime-single-wait-available-unsubmitted
[545.190826] Subtest etime-single-wait-available-unsubmitted: SUCCESS (0.103s)
[545.269639] [099/133] (497s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[545.371741] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[552.452481] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (7.081s)
[552.570179] [100/133] (490s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[552.669738] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu
[559.274121] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (6.606s)
[559.398666] [101/133] (483s left) api_intel_bb (blit-reloc-purge-cache)
[559.450147] Starting subtest: blit-reloc-purge-cache
[559.455298] Subtest blit-reloc-purge-cache: SKIP (0.001s)
[559.556543] [102/133] (483s left) dumb_buffer (invalid-bpp)
[559.613620] Starting subtest: invalid-bpp
[559.616383] Subtest invalid-bpp: SUCCESS (0.000s)
[559.711478] [103/133] (483s left) gem_exec_schedule (implicit-read-write)
[559.779821] Starting subtest: implicit-read-write
[559.781976] Starting dynamic subtest: rcs0
[559.877570] Dynamic subtest rcs0: SUCCESS (0.108s)
[559.891192] Starting dynamic subtest: vcs0
[559.968228] Dynamic subtest vcs0: SUCCESS (0.088s)
[559.980500] Starting dynamic subtest: vcs1
[560.051858] Dynamic subtest vcs1: SUCCESS (0.083s)
[560.063840] Starting dynamic subtest: vecs0
[560.132834] Dynamic subtest vecs0: SUCCESS (0.080s)
[560.144078] Starting dynamic subtest: ccs0
[560.226175] Dynamic subtest ccs0: SUCCESS (0.092s)
[560.228603] Subtest implicit-read-write: SUCCESS (0.458s)
[561.814763] [104/133] (481s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-blt)
[561.913208] Starting subtest: fbcpsr-rgb101010-draw-blt
[568.669503] Subtest fbcpsr-rgb101010-draw-blt: SUCCESS (6.757s)
[568.788167] [105/133] (474s left) i915_drm_fdinfo (busy)
[568.831464] Starting subtest: busy
[568.834222] Starting dynamic subtest: rcs0
[568.854527] Dynamic subtest rcs0: SKIP (0.024s)
[568.867883] Starting dynamic subtest: bcs0
[568.872410] Dynamic subtest bcs0: SKIP (0.000s)
[568.882683] Starting dynamic subtest: vcs0
[568.886990] Dynamic subtest vcs0: SKIP (0.000s)
[568.897234] Starting dynamic subtest: vcs1
[568.901737] Dynamic subtest vcs1: SKIP (0.000s)
[568.911739] Starting dynamic subtest: vecs0
[568.916552] Dynamic subtest vecs0: SKIP (0.000s)
[568.926806] Starting dynamic subtest: ccs0
[568.931515] Dynamic subtest ccs0: SKIP (0.000s)
[568.936040] Subtest busy: SKIP (0.031s)
[568.976785] [106/133] (474s left) gem_exec_balancer (smoke)
[569.037888] Starting subtest: smoke
[591.689126] Subtest smoke: SUCCESS (22.597s)
[592.700328] [107/133] (450s left) kms_flip (2x-absolute-wf_vblank-interruptible)
[592.823160] Starting subtest: 2x-absolute-wf_vblank-interruptible
[592.836199] Subtest 2x-absolute-wf_vblank-interruptible: SKIP (0.011s)
[592.912789] [108/133] (450s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted)
[592.964863] Starting subtest: etime-multi-wait-all-available-unsubmitted
[593.070766] Subtest etime-multi-wait-all-available-unsubmitted: SUCCESS (0.105s)
[593.149210] [109/133] (450s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[593.251685] Starting subtest: addfb25-yf-tiled-legacy
[593.254171] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[593.355555] [110/133] (450s left) gem_busy (extended)
[593.541836] Starting subtest: extended
[593.544421] Starting dynamic subtest: rcs0
[593.621555] Dynamic subtest rcs0: SUCCESS (0.078s)
[593.635673] Starting dynamic subtest: bcs0
[593.663040] Dynamic subtest bcs0: SUCCESS (0.041s)
[593.677327] Starting dynamic subtest: vcs0
[594.746420] Dynamic subtest vcs0: SUCCESS (1.080s)
[594.760041] Starting dynamic subtest: vcs1
[596.731524] Dynamic subtest vcs1: SUCCESS (1.982s)
[596.745029] Starting dynamic subtest: vecs0
[598.767773] Dynamic subtest vecs0: SUCCESS (1.981s)
[598.780856] Starting dynamic subtest: ccs0
[598.783644] Dynamic subtest ccs0: SUCCESS (0.044s)
[598.786478] Subtest extended: SUCCESS (5.222s)
[599.001160] [111/133] (444s left) gem_mmap_gtt (fault-concurrent-x)
[599.068637] Subtest fault-concurrent-X: SKIP (0.000s)
[599.146538] [112/133] (444s left) kms_getfb (getfb2-handle-protection)
[599.259087] Starting subtest: getfb2-handle-protection
[599.274859] Subtest getfb2-handle-protection: SUCCESS (0.017s)
[599.382643] [113/133] (444s left) gem_flink_race (flink_close)
[599.425659] Starting subtest: flink_close
[604.518642] Subtest flink_close: SUCCESS (5.086s)
[604.605570] [114/133] (438s left) i915_pm_rpm (sysfs-read)
[606.840677] Starting subtest: sysfs-read
[607.987087] Subtest sysfs-read: SUCCESS (1.147s)
[608.363836] [115/133] (435s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[608.456881] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-gtt
[608.461843] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[608.558418] [116/133] (435s left) gem_mmap_gtt (basic-write-read)
[608.610740] Subtest basic-write-read: SKIP (0.000s)
[608.671195] [117/133] (435s left) gem_exec_suspend (basic-s3-devices)
[608.728043] Starting subtest: basic-S3-devices
[608.730377] Starting dynamic subtest: smem
[620.731380] Dynamic subtest smem: SUCCESS (12.001s)
[620.734511] Subtest basic-S3-devices: SUCCESS (12.003s)
[626.934315] [118/133] (422s left) perf_pmu (most-busy-check-all)
[626.988323] Starting subtest: most-busy-check-all
[626.990738] Starting dynamic subtest: rcs0
[628.731601] Dynamic subtest rcs0: SUCCESS (1.744s)
[628.746022] Starting dynamic subtest: bcs0
[630.715062] Dynamic subtest bcs0: SUCCESS (1.980s)
[630.729639] Starting dynamic subtest: vcs0
[632.763097] Dynamic subtest vcs0: SUCCESS (2.045s)
[632.776888] Starting dynamic subtest: vcs1
[634.747011] Dynamic subtest vcs1: SUCCESS (1.981s)
[634.761048] Starting dynamic subtest: vecs0
[636.731503] Dynamic subtest vecs0: SUCCESS (1.981s)
[636.746019] Starting dynamic subtest: ccs0
[638.715137] Dynamic subtest ccs0: SUCCESS (1.981s)
[638.717999] Subtest most-busy-check-all: SUCCESS (11.730s)
[638.829875] [119/133] (411s left) kms_lease (master-vs-lease)
[638.918785] Starting subtest: master-vs-lease
[638.921835] Subtest master-vs-lease: SUCCESS (0.002s)
[639.017676] [120/133] (410s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-wc)
[639.107851] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-wc
[639.113347] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[639.197222] [121/133] (410s left) gem_exec_reloc (basic-cpu-gtt)
[639.255390] Subtest basic-cpu-gtt: SKIP (0.000s)
[639.324548] [122/133] (410s left) syncobj_wait (wait-all-for-submit-complex)
[639.372652] Starting subtest: wait-all-for-submit-complex
[639.588424] Subtest wait-all-for-submit-complex: SUCCESS (0.216s)
[639.677689] [123/133] (410s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs)
[639.760696] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs
[639.763505] Starting dynamic subtest: pipe-A-eDP-1
[639.789722] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[639.802082] Starting dynamic subtest: pipe-B-eDP-1
[639.827842] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[639.838716] Starting dynamic subtest: pipe-C-eDP-1
[639.863664] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[639.874793] Starting dynamic subtest: pipe-D-eDP-1
[639.900581] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[639.905494] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs: SKIP (0.004s)
[642.030110] [124/133] (408s left) kms_rotation_crc (primary-x-tiled-reflect-x-180)
[642.108424] Starting subtest: primary-x-tiled-reflect-x-180
[649.173867] Subtest primary-x-tiled-reflect-x-180: SUCCESS (7.065s)
[650.376108] [125/133] (399s left) perf (rc6-disable)
[650.488416] Starting subtest: rc6-disable
[650.661338] Subtest rc6-disable: SUCCESS (0.173s)
[650.712298] [126/133] (399s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled)
[650.758392] Starting subtest: multi-wait-for-submit-submitted-signaled
[650.761019] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.001s)
[650.858888] [127/133] (399s left) gem_ctx_engines (independent)
[650.922539] Starting subtest: independent
[650.924753] Starting dynamic subtest: rcs0
[651.048812] Dynamic subtest rcs0: SUCCESS (0.128s)
[651.061594] Starting dynamic subtest: bcs0
[651.179170] Dynamic subtest bcs0: SUCCESS (0.129s)
[651.190530] Starting dynamic subtest: vcs0
[651.297989] Dynamic subtest vcs0: SUCCESS (0.116s)
[651.310592] Starting dynamic subtest: vcs1
[651.430143] Dynamic subtest vcs1: SUCCESS (0.131s)
[651.444425] Starting dynamic subtest: vecs0
[651.551179] Dynamic subtest vecs0: SUCCESS (0.120s)
[651.562829] Starting dynamic subtest: ccs0
[651.673478] Dynamic subtest ccs0: SUCCESS (0.121s)
[651.688569] Starting dynamic subtest: all-engines
[652.152703] Dynamic subtest all-engines: SUCCESS (0.478s)
[652.155854] Subtest independent: SUCCESS (1.232s)
[652.799074] [128/133] (397s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-move)
[652.896696] Starting subtest: fbc-2p-scndscrn-spr-indfb-move
[652.901565] Subtest fbc-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[653.009411] [129/133] (397s left) gem_partial_pwrite_pread (write-display)
[653.075505] Subtest write-display: SKIP (0.000s)
[653.155030] [130/133] (397s left) vgem_basic (bad-handle)
[653.203780] Starting subtest: bad-handle
[653.206608] Subtest bad-handle: SUCCESS (0.000s)
[653.264728] [131/133] (397s left) gem_pxp (create-regular-context-2)
[653.368866] Starting subtest: create-regular-context-2
[653.371434] Subtest create-regular-context-2: SUCCESS (0.001s)
[653.480685] [132/133] (396s left) syncobj_timeline (wait-any-complex)
[653.539207] Starting subtest: wait-any-complex
[653.602305] Subtest wait-any-complex: SUCCESS (0.063s)
[653.685045] [133/133] (396s left) kms_plane_scaling (planes-downscale-factor-0-75-upscale-20x20)
[653.785159] Starting subtest: planes-downscale-factor-0-75-upscale-20x20
[653.787310] Starting dynamic subtest: pipe-A
[653.848250] Dynamic subtest pipe-A: SUCCESS (0.065s)
[653.862091] Starting dynamic subtest: pipe-B
[654.993643] Dynamic subtest pipe-B: SUCCESS (1.144s)
[655.006220] Starting dynamic subtest: pipe-C
[656.110819] Dynamic subtest pipe-C: SUCCESS (1.116s)
[656.122433] Starting dynamic subtest: pipe-D
[657.240899] Dynamic subtest pipe-D: SUCCESS (1.129s)
[657.243857] Subtest planes-downscale-factor-0-75-upscale-20x20: SUCCESS (3.458s)
[658.405085] Closing watchdogs
results: parsing output: 0/ for test: i915_drm_fdinfo
results: parsing output: 1/ for test: kms_dp_link_training
results: parsing output: 2/ for test: kms_big_fb
results: parsing output: 3/ for test: kms_flip_scaled_crc
results: parsing output: 4/ for test: gem_exec_whisper
results: parsing output: 5/ for test: gen9_exec_parse
results: parsing output: 6/ for test: kms_big_fb
results: parsing output: 7/ for test: perf
results: parsing output: 8/ for test: kms_big_fb
results: parsing output: 9/ for test: perf_pmu
results: parsing output: 10/ for test: syncobj_wait
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: kms_atomic
results: parsing output: 13/ for test: kms_frontbuffer_tracking
results: parsing output: 14/ for test: kms_content_protection
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: kms_psr
results: parsing output: 17/ for test: kms_setmode
results: parsing output: 18/ for test: kms_pm_rpm
results: parsing output: 19/ for test: kms_cursor_crc
results: parsing output: 20/ for test: kms_ccs
results: parsing output: 21/ for test: kms_plane_scaling
results: parsing output: 22/ for test: gem_mmap_offset
results: parsing output: 23/ for test: gem_exec_flush
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: kms_chamelium_hpd
results: parsing output: 26/ for test: sw_sync
results: parsing output: 27/ for test: gem_sync
results: parsing output: 28/ for test: kms_atomic_transition
results: parsing output: 29/ for test: kms_rotation_crc
results: parsing output: 30/ for test: prime_vgem
results: parsing output: 31/ for test: api_intel_bb
results: parsing output: 32/ for test: gem_exec_reloc
results: parsing output: 33/ for test: gem_close
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: kms_scaling_modes
results: parsing output: 36/ for test: kms_psr2_sf
results: parsing output: 37/ for test: gem_watchdog
results: parsing output: 38/ for test: gem_eio
results: parsing output: 39/ for test: kms_flip_scaled_crc
results: parsing output: 40/ for test: kms_plane
results: parsing output: 41/ for test: kms_frontbuffer_tracking
results: parsing output: 42/ for test: i915_query
results: parsing output: 43/ for test: gem_ctx_shared
results: parsing output: 44/ for test: kms_flip
results: parsing output: 45/ for test: sw_sync
results: parsing output: 46/ for test: kms_vblank
results: parsing output: 47/ for test: gem_render_copy
results: parsing output: 48/ for test: kms_cursor_crc
results: parsing output: 49/ for test: kms_big_fb
results: parsing output: 50/ for test: gem_spin_batch
results: parsing output: 51/ for test: gem_exec_fence
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: syncobj_wait
results: parsing output: 54/ for test: gem_ctx_isolation
results: parsing output: 55/ for test: perf
results: parsing output: 56/ for test: gem_mmap_wc
results: parsing output: 57/ for test: gem_exec_reloc
results: parsing output: 58/ for test: kms_ccs
results: parsing output: 59/ for test: kms_color
results: parsing output: 60/ for test: kms_vblank
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: gem_exec_balancer
results: parsing output: 63/ for test: gem_exec_reloc
results: parsing output: 64/ for test: kms_psr
results: parsing output: 65/ for test: gem_exec_whisper
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: kms_pipe_crc_basic
results: parsing output: 68/ for test: gem_ctx_persistence
results: parsing output: 69/ for test: kms_chamelium_color
results: parsing output: 70/ for test: gem_pxp
results: parsing output: 71/ for test: kms_psr
results: parsing output: 72/ for test: kms_psr2_sf
results: parsing output: 73/ for test: kms_plane
results: parsing output: 74/ for test: kms_display_modes
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_big_fb
results: parsing output: 77/ for test: kms_chamelium_color
results: parsing output: 78/ for test: kms_psr2_sf
results: parsing output: 79/ for test: kms_cursor_legacy
results: parsing output: 80/ for test: gem_caching
results: parsing output: 81/ for test: kms_busy
results: parsing output: 82/ for test: kms_ccs
results: parsing output: 83/ for test: kms_big_fb
results: parsing output: 84/ for test: kms_psr
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: gem_exec_fence
results: parsing output: 87/ for test: gem_eio
results: parsing output: 88/ for test: kms_invalid_mode
results: parsing output: 89/ for test: syncobj_wait
results: parsing output: 90/ for test: kms_pm_rpm
results: parsing output: 91/ for test: gem_exec_schedule
results: parsing output: 92/ for test: kms_cursor_edge_walk
results: parsing output: 93/ for test: gem_exec_reloc
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: syncobj_wait
results: parsing output: 96/ for test: syncobj_timeline
results: parsing output: 97/ for test: syncobj_timeline
results: parsing output: 98/ for test: kms_frontbuffer_tracking
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: api_intel_bb
results: parsing output: 101/ for test: dumb_buffer
results: parsing output: 102/ for test: gem_exec_schedule
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: i915_drm_fdinfo
results: parsing output: 105/ for test: gem_exec_balancer
results: parsing output: 106/ for test: kms_flip
results: parsing output: 107/ for test: syncobj_timeline
results: parsing output: 108/ for test: kms_addfb_basic
results: parsing output: 109/ for test: gem_busy
results: parsing output: 110/ for test: gem_mmap_gtt
results: parsing output: 111/ for test: kms_getfb
results: parsing output: 112/ for test: gem_flink_race
results: parsing output: 113/ for test: i915_pm_rpm
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: gem_mmap_gtt
results: parsing output: 116/ for test: gem_exec_suspend
results: parsing output: 117/ for test: perf_pmu
results: parsing output: 118/ for test: kms_lease
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: gem_exec_reloc
results: parsing output: 121/ for test: syncobj_wait
results: parsing output: 122/ for test: kms_ccs
results: parsing output: 123/ for test: kms_rotation_crc
results: parsing output: 124/ for test: perf
results: parsing output: 125/ for test: syncobj_timeline
results: parsing output: 126/ for test: gem_ctx_engines
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: gem_partial_pwrite_pread
results: parsing output: 129/ for test: vgem_basic
results: parsing output: 130/ for test: gem_pxp
results: parsing output: 131/ for test: syncobj_timeline
results: parsing output: 132/ for test: kms_plane_scaling
Done.