[58.510449] Initializing watchdogs
[58.510496]   /dev/watchdog0
[58.524962] [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]
[58.529249] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.532048] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.535293] [001/133] (960s left) gem_exec_schedule (reorder-wide)
[58.743527] Subtest reorder-wide: SKIP (0.000s)
[58.949967] [002/133] (960s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-render)
[59.056697] Starting subtest: psr-2p-primscrn-cur-indfb-draw-render
[59.060912] Subtest psr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[59.171272] [003/133] (959s left) kms_frontbuffer_tracking (fbcpsr-argb161616f-draw-mmap-gtt)
[59.273246] Starting subtest: fbcpsr-argb161616f-draw-mmap-gtt
[59.277331] Subtest fbcpsr-argb161616f-draw-mmap-gtt: SKIP (0.000s)
[59.398705] [004/133] (959s left) gem_mmap_offset (isolation)
[59.454679] Starting subtest: isolation
[59.471533] Subtest isolation: SUCCESS (0.006s)
[59.580314] [005/133] (959s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-pwrite)
[59.683295] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-pwrite
[59.687569] Subtest fbc-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[59.804743] [006/133] (959s left) gen7_exec_parse (basic-rejected)
[59.874580] Subtest basic-rejected: SKIP (0.000s)
[59.946368] [007/133] (959s left) kms_cursor_edge_walk (128x128-right-edge)
[60.045655] Starting subtest: 128x128-right-edge
[60.047575] Starting dynamic subtest: pipe-A-eDP-1
[63.547095] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.510s)
[63.555545] Starting dynamic subtest: pipe-D-eDP-1
[66.729731] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.189s)
[66.731972] Subtest 128x128-right-edge: SUCCESS (6.701s)
[67.570210] [008/133] (951s left) api_intel_bb (reset-bb)
[67.674340] Starting subtest: reset-bb
[67.679421] Subtest reset-bb: SUCCESS (0.006s)
[67.955988] [009/133] (951s left) gem_exec_reloc (basic-gtt-read-active)
[68.025482] Subtest basic-gtt-read-active: SKIP (0.000s)
[68.112182] [010/133] (951s left) kms_psr (psr-no-drrs)
[68.209863] Starting subtest: psr-no-drrs
[68.212142] Starting dynamic subtest: eDP-1
[69.810250] Dynamic subtest eDP-1: SUCCESS (1.602s)
[69.812170] Subtest psr-no-drrs: SUCCESS (1.602s)
[70.694915] [011/133] (948s left) kms_chamelium_color (ctm-max)
[70.794137] Subtest ctm-max: SKIP (0.000s)
[70.834221] [012/133] (948s left) drm_mm (drm_mm)
[70.870658] Starting subtest: drm_mm
[70.881602] Starting dynamic subtest: drm_test_mm_init
[71.047279] Dynamic subtest drm_test_mm_init: SUCCESS (0.166s)
[71.056300] Starting dynamic subtest: drm_test_mm_debug
[71.205266] Dynamic subtest drm_test_mm_debug: SUCCESS (0.156s)
[71.212049] Starting dynamic subtest: drm_test_mm_align32
[71.355348] Dynamic subtest drm_test_mm_align32: SUCCESS (0.149s)
[71.364174] Starting dynamic subtest: drm_test_mm_align64
[71.495305] Dynamic subtest drm_test_mm_align64: SUCCESS (0.140s)
[71.503652] Starting dynamic subtest: drm_test_mm_lowest
[71.639073] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.143s)
[71.645861] Starting dynamic subtest: drm_test_mm_highest
[71.756994] Dynamic subtest drm_test_mm_highest: SUCCESS (0.117s)
[71.759271] Subtest drm_mm: SUCCESS (0.885s)
[71.991525] [013/133] (947s left) i915_query (query-topology-garbage-items)
[72.049905] Starting subtest: query-topology-garbage-items
[72.051861] Subtest query-topology-garbage-items: SUCCESS (0.000s)
[72.191370] [014/133] (947s left) kms_hdr (bpc-switch)
[72.278576] Starting subtest: bpc-switch
[73.343560] Starting dynamic subtest: pipe-A-eDP-1
[76.829817] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.491s)
[76.832139] Subtest bpc-switch: SUCCESS (4.554s)
[76.984678] [015/133] (942s left) kms_frontbuffer_tracking (psr-argb161616f-draw-pwrite)
[77.113664] Starting subtest: psr-argb161616f-draw-pwrite
[77.118084] Subtest psr-argb161616f-draw-pwrite: SKIP (0.000s)
[77.220912] [016/133] (942s left) kms_psr2_sf (fbc-pr-cursor-plane-update-sf)
[82.285111] Starting subtest: fbc-pr-cursor-plane-update-sf
[82.290035] Subtest fbc-pr-cursor-plane-update-sf: SKIP (0.002s)
[83.147600] [017/133] (936s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[83.248233] Starting subtest: plane-upscale-20x20-with-rotation
[83.250496] Starting dynamic subtest: pipe-A
[83.472644] Dynamic subtest pipe-A: SUCCESS (0.227s)
[83.481286] Starting dynamic subtest: pipe-B
[84.805230] Dynamic subtest pipe-B: SUCCESS (1.332s)
[84.812398] Starting dynamic subtest: pipe-C
[86.142121] Dynamic subtest pipe-C: SUCCESS (1.336s)
[86.151185] Starting dynamic subtest: pipe-D
[87.481047] Dynamic subtest pipe-D: SUCCESS (1.338s)
[87.483860] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.235s)
[88.682972] [018/133] (931s left) gem_ccs (ctrl-surf-copy-new-ctx)
[88.756182] Starting subtest: ctrl-surf-copy-new-ctx
[88.760821] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s)
[88.894149] [019/133] (930s left) gem_exec_alignment (single)
[88.966064] Starting subtest: single
[88.970663] Subtest single: SUCCESS (0.004s)
[89.136900] [020/133] (930s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-downscaling)
[89.232670] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-downscaling
[89.234925] Starting dynamic subtest: pipe-A-default-mode
[90.425352] Dynamic subtest pipe-A-default-mode: SKIP (1.190s)
[90.429529] Subtest flip-64bpp-4tile-to-16bpp-4tile-downscaling: SKIP (1.191s)
[90.589866] [021/133] (929s left) kms_lease (simple-lease)
[90.696162] Starting subtest: simple-lease
[90.698543] Starting dynamic subtest: pipe-A-eDP-1
[91.191688] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.495s)
[91.200457] Starting dynamic subtest: pipe-B-eDP-1
[92.633083] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.439s)
[92.642363] Starting dynamic subtest: pipe-C-eDP-1
[94.015247] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.382s)
[94.023913] Starting dynamic subtest: pipe-D-eDP-1
[95.419620] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.404s)
[95.421944] Subtest simple-lease: SUCCESS (4.726s)
[96.250746] [022/133] (923s left) perf (polling-parameterized)
[96.399586] Starting subtest: polling-parameterized
[116.419686] Subtest polling-parameterized: SUCCESS (20.020s)
[116.464590] [023/133] (903s left) perf_pmu (module-unload)
[116.544090] Starting subtest: module-unload
[123.288609] Subtest module-unload: FAIL (6.634s)
[123.318053] [FACT perf_pmu (module-unload)] deleted: kernel.kmod_is_loaded.i915: true
[123.321023] [024/133] (896s left) gem_exec_flush (basic-batch-kernel-default-cmd)
[124.880782] Starting subtest: basic-batch-kernel-default-cmd
[124.885202] Subtest basic-batch-kernel-default-cmd: SKIP (0.000s)
[125.034880] [FACT gem_exec_flush (basic-batch-kernel-default-cmd)] new: kernel.kmod_is_loaded.i915: true
[125.038258] [025/133] (894s left) kms_ccs (crc-primary-suspend-4-tiled-lnl-ccs)
[125.142027] Starting subtest: crc-primary-suspend-4-tiled-lnl-ccs
[125.146926] Subtest crc-primary-suspend-4-tiled-lnl-ccs: SKIP (0.000s)
[126.242894] [026/133] (893s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[126.344503] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc
[126.348597] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[126.481863] [027/133] (893s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-render)
[126.581620] Starting subtest: fbc-rgb101010-draw-render
[131.165771] Subtest fbc-rgb101010-draw-render: SUCCESS (4.587s)
[132.349236] [028/133] (887s left) gem_exec_reloc (basic-gtt)
[132.417771] Subtest basic-gtt: SKIP (0.000s)
[132.498588] [029/133] (887s left) kms_big_fb (4-tiled-32bpp-rotate-270)
[132.597093] Starting subtest: 4-tiled-32bpp-rotate-270
[132.616257] Subtest 4-tiled-32bpp-rotate-270: SKIP (0.019s)
[132.783960] [030/133] (887s left) kms_plane_scaling (plane-downscale-factor-0-75-with-pixel-format)
[132.902468] Starting subtest: plane-downscale-factor-0-75-with-pixel-format
[132.904865] Starting dynamic subtest: pipe-A
[134.131270] Dynamic subtest pipe-A: SUCCESS (1.232s)
[134.139569] Starting dynamic subtest: pipe-B
[136.368038] Dynamic subtest pipe-B: SUCCESS (2.236s)
[136.375234] Starting dynamic subtest: pipe-C
[137.523041] Dynamic subtest pipe-C: SUCCESS (1.154s)
[137.530952] Starting dynamic subtest: pipe-D
[138.773491] Dynamic subtest pipe-D: SUCCESS (1.250s)
[138.775906] Subtest plane-downscale-factor-0-75-with-pixel-format: SUCCESS (5.874s)
[139.979497] [031/133] (880s left) gem_ctx_shared (disjoint-timelines)
[140.054056] Starting subtest: disjoint-timelines
[140.092096] Subtest disjoint-timelines: SUCCESS (0.038s)
[140.361359] [FACT gem_ctx_shared (disjoint-timelines)] new: kernel.kmod_is_loaded.vgem: true
[140.367370] [032/133] (879s left) kms_flip (wf_vblank-ts-check-interruptible)
[140.469418] Starting subtest: wf_vblank-ts-check-interruptible
[140.471671] Starting dynamic subtest: A-eDP1
[149.410829] Dynamic subtest A-eDP1: SUCCESS (8.938s)
[149.421920] Starting dynamic subtest: B-eDP1
[158.341707] Dynamic subtest B-eDP1: SUCCESS (8.928s)
[158.349880] Starting dynamic subtest: C-eDP1
[167.266842] Dynamic subtest C-eDP1: SUCCESS (8.923s)
[167.276905] Starting dynamic subtest: D-eDP1
[176.204918] Dynamic subtest D-eDP1: SUCCESS (8.936s)
[176.210772] Subtest wf_vblank-ts-check-interruptible: SUCCESS (35.735s)
[177.454954] [033/133] (842s left) kms_addfb_basic (bad-pitch-32)
[177.518243] Starting subtest: bad-pitch-32
[177.520414] Subtest bad-pitch-32: SUCCESS (0.000s)
[177.702285] [034/133] (842s left) gem_exec_fence (basic-busy)
[177.890535] Starting subtest: basic-busy
[177.892945] Starting dynamic subtest: rcs0
[177.997715] Dynamic subtest rcs0: SUCCESS (0.107s)
[178.008539] Starting dynamic subtest: bcs0
[178.061264] Dynamic subtest bcs0: SUCCESS (0.062s)
[178.071745] Starting dynamic subtest: vcs0
[178.126107] Dynamic subtest vcs0: SUCCESS (0.063s)
[178.134734] Starting dynamic subtest: vcs1
[178.187988] Dynamic subtest vcs1: SUCCESS (0.060s)
[178.196350] Starting dynamic subtest: vecs0
[178.255364] Dynamic subtest vecs0: SUCCESS (0.065s)
[178.265662] Starting dynamic subtest: ccs0
[178.322043] Dynamic subtest ccs0: SUCCESS (0.066s)
[178.324404] Subtest basic-busy: SUCCESS (0.433s)
[180.046862] [035/133] (840s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0)
[180.147413] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0
[181.214691] Subtest x-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.069s)
[181.373362] [036/133] (839s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[181.478985] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu
[181.482266] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[181.621385] [037/133] (838s left) kms_pm_rpm (modeset-stress-extra-wait)
[183.153740] Starting subtest: modeset-stress-extra-wait
[237.441963] Subtest modeset-stress-extra-wait: SUCCESS (54.286s)
[237.562670] [038/133] (782s left) prime_vgem (basic-fence-mmap)
[237.660384] Starting subtest: basic-fence-mmap
[237.664987] Subtest basic-fence-mmap: SKIP (0.000s)
[237.803645] [039/133] (782s left) gem_userptr_blits (set-cache-level)
[237.868795] Starting subtest: set-cache-level
[237.873301] Subtest set-cache-level: SKIP (0.000s)
[238.024471] [040/133] (782s left) syncobj_timeline (single-wait-for-submit-available-signaled)
[238.081256] Starting subtest: single-wait-for-submit-available-signaled
[238.083525] Subtest single-wait-for-submit-available-signaled: SUCCESS (0.000s)
[238.220816] [041/133] (782s left) gem_mmap_gtt (basic-small-copy-xy)
[238.285525] Subtest basic-small-copy-XY: SKIP (0.000s)
[238.358008] [042/133] (782s left) kms_flip (basic-flip-vs-wf_vblank)
[238.450990] Starting subtest: basic-flip-vs-wf_vblank
[238.456212] Starting dynamic subtest: A-eDP1
[240.373284] Dynamic subtest A-eDP1: SUCCESS (1.919s)
[240.385429] Starting dynamic subtest: B-eDP1
[242.309442] Dynamic subtest B-eDP1: SUCCESS (1.933s)
[242.319240] Starting dynamic subtest: C-eDP1
[244.221877] Dynamic subtest C-eDP1: SUCCESS (1.912s)
[244.232823] Starting dynamic subtest: D-eDP1
[246.151534] Dynamic subtest D-eDP1: SUCCESS (1.926s)
[246.154065] Subtest basic-flip-vs-wf_vblank: SUCCESS (7.702s)
[247.400640] [043/133] (773s left) kms_getfb (getfb-handle-valid)
[247.500666] Starting subtest: getfb-handle-valid
[247.503076] Subtest getfb-handle-valid: SUCCESS (0.000s)
[247.636527] [044/133] (773s left) gen3_render_mixed_blits
[247.770290] [045/133] (772s left) kms_chamelium_hpd (vga-hpd-with-enabled-mode)
[248.158682] Subtest vga-hpd-with-enabled-mode: SKIP (0.000s)
[248.989295] [046/133] (771s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs)
[249.093568] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-mc-ccs
[249.095927] Starting dynamic subtest: pipe-A-eDP-1
[249.350460] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.226s)
[249.361080] Starting dynamic subtest: pipe-B-eDP-1
[250.585936] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.232s)
[250.594992] Starting dynamic subtest: pipe-C-eDP-1
[251.787104] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.203s)
[251.797334] Starting dynamic subtest: pipe-D-eDP-1
[253.040218] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.252s)
[253.042208] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SUCCESS (3.918s)
[254.263597] [047/133] (766s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs)
[254.327270] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs
[254.332115] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s)
[254.533061] [048/133] (766s left) kms_cursor_crc (cursor-offscreen-32x32)
[254.686936] Starting subtest: cursor-offscreen-32x32
[254.736607] Subtest cursor-offscreen-32x32: SKIP (0.044s)
[255.063804] [049/133] (765s left) kms_psr (fbc-psr-basic)
[255.156268] Starting subtest: fbc-psr-basic
[255.158655] Starting dynamic subtest: eDP-1
[255.162797] Dynamic subtest eDP-1: SKIP (0.000s)
[255.166868] Subtest fbc-psr-basic: SKIP (0.001s)
[255.253355] [050/133] (765s left) kms_psr (fbc-psr2-cursor-blt)
[255.350137] Starting subtest: fbc-psr2-cursor-blt
[255.352387] Starting dynamic subtest: eDP-1
[255.356772] Dynamic subtest eDP-1: SKIP (0.000s)
[255.361120] Subtest fbc-psr2-cursor-blt: SKIP (0.001s)
[255.442058] [051/133] (765s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-factor-0-25)
[255.549356] Starting subtest: planes-downscale-factor-0-5-upscale-factor-0-25
[255.551166] Starting dynamic subtest: pipe-A
[255.569264] Dynamic subtest pipe-A: SKIP (0.018s)
[255.578876] Starting dynamic subtest: pipe-B
[255.603113] Dynamic subtest pipe-B: SKIP (0.030s)
[255.611742] Starting dynamic subtest: pipe-C
[255.631759] Dynamic subtest pipe-C: SKIP (0.030s)
[255.639449] Starting dynamic subtest: pipe-D
[255.661352] Dynamic subtest pipe-D: SKIP (0.030s)
[255.664530] Subtest planes-downscale-factor-0-5-upscale-factor-0-25: SKIP (0.110s)
[255.789079] [052/133] (765s left) gem_exec_reloc (basic-write-gtt)
[255.856593] Subtest basic-write-gtt: SKIP (0.000s)
[255.934059] [053/133] (765s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-blt)
[256.035228] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-blt
[256.038808] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[256.166015] [054/133] (764s left) kms_psr2_sf (fbc-psr2-overlay-plane-update-continuous-sf)
[261.223622] Starting subtest: fbc-psr2-overlay-plane-update-continuous-sf
[261.225634] Starting dynamic subtest: pipe-A-eDP-1
[262.033074] Dynamic subtest pipe-A-eDP-1: SKIP (0.807s)
[262.042511] Starting dynamic subtest: pipe-B-eDP-1
[263.161255] Dynamic subtest pipe-B-eDP-1: SKIP (1.126s)
[263.165618] Subtest fbc-psr2-overlay-plane-update-continuous-sf: SKIP (1.937s)
[264.367475] [055/133] (756s left) kms_ccs (bad-rotation-90-4-tiled-bmg-ccs)
[264.474943] Starting subtest: bad-rotation-90-4-tiled-bmg-ccs
[264.479243] Subtest bad-rotation-90-4-tiled-bmg-ccs: SKIP (0.000s)
[265.595734] [056/133] (755s left) gem_pxp (protected-encrypted-src-copy-not-readible)
[265.724991] Starting subtest: protected-encrypted-src-copy-not-readible
[265.835271] Subtest protected-encrypted-src-copy-not-readible: SUCCESS (0.112s)
[265.994304] [057/133] (755s left) syncobj_timeline (host-signal-points)
[266.056027] Starting subtest: host-signal-points
[266.058387] Subtest host-signal-points: SUCCESS (0.004s)
[266.189553] [058/133] (755s left) kms_flip (2x-flip-vs-expired-vblank)
[266.270369] Starting subtest: 2x-flip-vs-expired-vblank
[266.281215] Subtest 2x-flip-vs-expired-vblank: SKIP (0.010s)
[266.445956] [059/133] (754s left) kms_pipe_stress (stress-xrgb8888-untiled)
[266.578310] Starting subtest: stress-xrgb8888-untiled
[272.439950] Subtest stress-xrgb8888-untiled: SUCCESS (5.875s)
[272.501640] [060/133] (748s left) kms_psr (psr2-primary-mmap-gtt)
[272.603708] Starting subtest: psr2-primary-mmap-gtt
[272.605552] Starting dynamic subtest: eDP-1
[274.066022] Dynamic subtest eDP-1: SKIP (1.459s)
[274.071049] Subtest psr2-primary-mmap-gtt: SKIP (1.461s)
[274.219208] [061/133] (747s left) gem_exec_reloc (basic-gtt-wc-noreloc)
[274.271601] Subtest basic-gtt-wc-noreloc: SKIP (0.000s)
[274.361949] [062/133] (747s left) gem_fenced_exec_thrash (no-spare-fences-interruptible)
[274.416203] Subtest no-spare-fences-interruptible: SKIP (0.000s)
[274.499818] [063/133] (747s left) gem_exec_reloc (basic-cpu-wc)
[274.564498] Subtest basic-cpu-wc: SKIP (0.000s)
[274.641193] [064/133] (746s left) gem_ctx_isolation (clean)
[274.710549] Starting subtest: clean
[274.712541] Starting dynamic subtest: rcs0
[274.772574] Dynamic subtest rcs0: SUCCESS (0.065s)
[274.785069] Starting dynamic subtest: bcs0
[274.875254] Dynamic subtest bcs0: SUCCESS (0.102s)
[274.886497] Starting dynamic subtest: vcs0
[274.973517] Dynamic subtest vcs0: SUCCESS (0.098s)
[274.982403] Starting dynamic subtest: vcs1
[276.943484] Dynamic subtest vcs1: SUCCESS (1.969s)
[276.952972] Starting dynamic subtest: vecs0
[278.917276] Dynamic subtest vecs0: SUCCESS (1.973s)
[278.926054] Starting dynamic subtest: ccs0
[280.924938] Dynamic subtest ccs0: SUCCESS (2.007s)
[280.927447] Subtest clean: SUCCESS (6.218s)
[281.199971] [065/133] (740s left) api_intel_allocator (simple-allocator)
[281.257286] Starting subtest: simple-allocator
[281.259277] Starting dynamic subtest: basic
[281.261683] Dynamic subtest basic: SUCCESS (0.005s)
[281.276948] Starting dynamic subtest: parallel-one
[281.453478] Dynamic subtest parallel-one: SUCCESS (0.190s)
[281.465041] Starting dynamic subtest: print
[281.467556] Dynamic subtest print: SUCCESS (0.000s)
[281.476022] Starting dynamic subtest: reuse
[281.478308] Dynamic subtest reuse: SUCCESS (0.000s)
[281.486608] Starting dynamic subtest: reserve
[281.488845] Dynamic subtest reserve: SUCCESS (0.000s)
[281.497338] Starting dynamic subtest: fork-reopen-allocator
[281.499186] Dynamic subtest fork-reopen-allocator: SUCCESS (0.013s)
[281.501065] Subtest simple-allocator: SUCCESS (0.215s)
[281.636998] [066/133] (740s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0)
[281.748970] Starting subtest: linear-max-hw-stride-32bpp-rotate-0
[282.771099] Subtest linear-max-hw-stride-32bpp-rotate-0: SUCCESS (1.021s)
[282.938968] [067/133] (738s left) gem_exec_balancer (bonded-sync)
[283.007087] Starting subtest: bonded-sync
[283.011063] Subtest bonded-sync: SKIP (0.000s)
[283.329110] [068/133] (738s left) kms_content_protection (lic-type-0)
[283.478822] Starting subtest: lic-type-0
[283.483527] Subtest lic-type-0: SKIP (0.000s)
[283.642118] [069/133] (738s left) i915_drm_fdinfo (all-busy-idle-check-all)
[283.681515] Starting subtest: all-busy-idle-check-all
[283.686070] Subtest all-busy-idle-check-all: SKIP (0.003s)
[283.775723] [070/133] (738s left) kms_flip (2x-wf_vblank-ts-check)
[283.924094] Starting subtest: 2x-wf_vblank-ts-check
[283.935072] Subtest 2x-wf_vblank-ts-check: SKIP (0.010s)
[284.034191] [071/133] (737s left) kms_lease (lease-get)
[284.123354] Starting subtest: lease-get
[284.125641] Starting dynamic subtest: pipe-A-eDP-1
[284.128024] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[284.136685] Starting dynamic subtest: pipe-B-eDP-1
[284.138695] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[284.146704] Starting dynamic subtest: pipe-C-eDP-1
[284.148581] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[284.156525] Starting dynamic subtest: pipe-D-eDP-1
[284.158407] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[284.160250] Subtest lease-get: SUCCESS (0.008s)
[284.257257] [072/133] (737s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[284.355178] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[284.358752] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[284.497090] [073/133] (737s left) sw_sync (alloc_fence)
[284.531526] Starting subtest: alloc_fence
[284.533292] Subtest alloc_fence: SUCCESS (0.000s)
[284.611991] [074/133] (737s left) kms_force_connector_basic (force-edid)
[284.684583] Starting subtest: force-edid
[285.067288] Subtest force-edid: SUCCESS (0.382s)
[285.227606] [075/133] (736s left) kms_flip_scaled_crc (flip-32bpp-linear-to-32bpp-linear-reflect-x)
[285.328182] Starting subtest: flip-32bpp-linear-to-32bpp-linear-reflect-x
[285.330035] Starting dynamic subtest: pipe-A-default-mode
[286.457738] Dynamic subtest pipe-A-default-mode: SKIP (1.126s)
[286.461722] Subtest flip-32bpp-linear-to-32bpp-linear-reflect-x: SKIP (1.127s)
[286.661966] [076/133] (735s left) gem_ppgtt (blt-vs-render-ctx0)
[286.718483] Starting subtest: blt-vs-render-ctx0
[319.761303] Subtest blt-vs-render-ctx0: SUCCESS (33.041s)
[319.932952] [077/133] (702s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-downscaling)
[320.066566] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-downscaling
[320.069310] Starting dynamic subtest: pipe-A-default-mode
[320.351923] Dynamic subtest pipe-A-default-mode: SKIP (0.285s)
[320.356690] Subtest flip-64bpp-ytile-to-32bpp-ytile-downscaling: SKIP (0.288s)
[321.243857] [078/133] (700s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted)
[321.309149] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted
[321.311499] Subtest multi-wait-for-submit-available-unsubmitted-submitted: SUCCESS (0.000s)
[321.424315] [079/133] (700s left) syncobj_timeline (wait-all-snapshot)
[321.489238] Starting subtest: wait-all-snapshot
[321.568611] Subtest wait-all-snapshot: SUCCESS (0.081s)
[321.671936] [080/133] (700s left) syncobj_timeline (etime-single-wait-all-for-submit-available-unsubmitted)
[321.719451] Starting subtest: etime-single-wait-all-for-submit-available-unsubmitted
[321.827715] Subtest etime-single-wait-all-for-submit-available-unsubmitted: SUCCESS (0.108s)
[321.923251] [081/133] (700s left) kms_psr (fbc-psr-sprite-mmap-cpu)
[322.013696] Starting subtest: fbc-psr-sprite-mmap-cpu
[322.015987] Starting dynamic subtest: eDP-1
[322.020415] Dynamic subtest eDP-1: SKIP (0.000s)
[322.025122] Subtest fbc-psr-sprite-mmap-cpu: SKIP (0.001s)
[322.110633] [082/133] (700s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[322.220876] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[323.012577] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SUCCESS (0.793s)
[323.208483] [083/133] (699s left) kms_async_flips (invalid-async-flip-atomic)
[323.305490] Starting subtest: invalid-async-flip-atomic
[323.677638] Starting dynamic subtest: pipe-A-eDP-1
[324.512401] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.835s)
[324.870767] Starting dynamic subtest: pipe-B-eDP-1
[325.715208] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.852s)
[326.071533] Starting dynamic subtest: pipe-C-eDP-1
[326.885355] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.820s)
[327.237633] Starting dynamic subtest: pipe-D-eDP-1
[328.013042] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.784s)
[328.015229] Subtest invalid-async-flip-atomic: SUCCESS (4.710s)
[329.236264] [084/133] (693s left) gem_exec_params (dr1-dirt)
[329.292894] Starting subtest: DR1-dirt
[329.295260] Subtest DR1-dirt: SUCCESS (0.000s)
[329.443258] [085/133] (692s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[329.545575] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[329.549885] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[329.679551] [086/133] (692s left) kms_cursor_legacy (forked-bo)
[329.808811] Starting subtest: forked-bo
[329.811047] Starting dynamic subtest: pipe-A
[335.276901] Dynamic subtest pipe-A: SUCCESS (5.466s)
[335.289080] Starting dynamic subtest: pipe-B
[340.747195] Dynamic subtest pipe-B: SUCCESS (5.466s)
[340.758326] Starting dynamic subtest: pipe-C
[346.212711] Dynamic subtest pipe-C: SUCCESS (5.465s)
[346.227518] Starting dynamic subtest: pipe-D
[351.677186] Dynamic subtest pipe-D: SUCCESS (5.461s)
[351.691834] Starting dynamic subtest: all-pipes
[357.172859] Dynamic subtest all-pipes: SUCCESS (5.495s)
[357.175256] Subtest forked-bo: SUCCESS (27.363s)
[357.346556] [087/133] (665s left) kms_vblank (wait-forked-hang)
[357.455149] Starting subtest: wait-forked-hang
[357.457355] Starting dynamic subtest: pipe-A-eDP-1
[384.677257] Dynamic subtest pipe-A-eDP-1: SUCCESS (27.222s)
[384.692288] Starting dynamic subtest: pipe-D-eDP-1
[399.641445] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.959s)
[399.643344] Subtest wait-forked-hang: SUCCESS (42.185s)
[400.539490] [088/133] (622s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-blt)
[400.633603] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-blt
[400.638106] Subtest fbc-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[400.761837] [089/133] (621s left) gem_set_tiling_vs_blt (untiled-to-tiled)
[400.822071] Subtest untiled-to-tiled: SKIP (0.000s)
[400.881475] [090/133] (621s left) kms_frontbuffer_tracking (fbc-argb161616f-draw-mmap-gtt)
[400.978595] Starting subtest: fbc-argb161616f-draw-mmap-gtt
[400.982652] Subtest fbc-argb161616f-draw-mmap-gtt: SKIP (0.000s)
[401.111235] [091/133] (621s left) kms_frontbuffer_tracking (psr-rgb101010-draw-render)
[401.206247] Starting subtest: psr-rgb101010-draw-render
[408.429478] Subtest psr-rgb101010-draw-render: SUCCESS (7.224s)
[408.584134] [092/133] (614s left) fbdev (info)
[408.627923] Starting subtest: info
[408.630088] Subtest info: SUCCESS (0.000s)
[408.716484] [093/133] (614s left) kms_flip (plain-flip-interruptible)
[408.809528] Starting subtest: plain-flip-interruptible
[408.811873] Starting dynamic subtest: A-eDP1
[410.477827] Dynamic subtest A-eDP1: SUCCESS (1.667s)
[410.491739] Starting dynamic subtest: B-eDP1
[412.087935] Dynamic subtest B-eDP1: SUCCESS (1.609s)
[412.100817] Starting dynamic subtest: C-eDP1
[413.770458] Dynamic subtest C-eDP1: SUCCESS (1.680s)
[413.782132] Starting dynamic subtest: D-eDP1
[415.377018] Dynamic subtest D-eDP1: SUCCESS (1.606s)
[415.379537] Subtest plain-flip-interruptible: SUCCESS (6.571s)
[416.632006] [094/133] (606s left) gem_tiled_wc
[416.760971] [095/133] (606s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area)
[421.784329] Starting subtest: pr-primary-plane-update-sf-dmg-area
[421.788840] Subtest pr-primary-plane-update-sf-dmg-area: SKIP (0.002s)
[422.621826] [096/133] (600s left) kms_flip (2x-flip-vs-wf_vblank)
[422.711165] Starting subtest: 2x-flip-vs-wf_vblank
[422.721889] Subtest 2x-flip-vs-wf_vblank: SKIP (0.010s)
[422.826446] [097/133] (600s left) kms_async_flips (async-flip-suspend-resume)
[422.924190] Starting subtest: async-flip-suspend-resume
[423.295637] Starting dynamic subtest: pipe-A-eDP-1
[441.219564] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.167s)
[441.607829] Starting dynamic subtest: pipe-B-eDP-1
[459.083913] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.929s)
[459.454415] Starting dynamic subtest: pipe-C-eDP-1
[477.106633] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.956s)
[477.468152] Starting dynamic subtest: pipe-D-eDP-1
[495.096453] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.972s)
[495.098772] Subtest async-flip-suspend-resume: SUCCESS (13.524s)
[496.295611] [098/133] (526s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc)
[496.402566] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc
[496.406875] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[496.546379] [099/133] (526s left) gem_exec_whisper (basic-contexts-priority)
[496.613293] Starting subtest: basic-contexts-priority
[520.296051] Subtest basic-contexts-priority: SUCCESS (23.854s)
[520.509018] [100/133] (502s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[520.614996] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[520.619264] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[520.757479] [101/133] (502s left) gem_exec_schedule (noreorder)
[520.939847] Starting subtest: noreorder
[520.942681] Starting dynamic subtest: rcs0
[521.033691] Dynamic subtest rcs0: SUCCESS (0.095s)
[521.045862] Starting dynamic subtest: vcs0
[522.745921] Dynamic subtest vcs0: SUCCESS (1.710s)
[522.758897] Starting dynamic subtest: vcs1
[524.722194] Dynamic subtest vcs1: SUCCESS (1.976s)
[524.734581] Starting dynamic subtest: vecs0
[526.810366] Dynamic subtest vecs0: SUCCESS (2.086s)
[526.823371] Starting dynamic subtest: ccs0
[526.912173] Dynamic subtest ccs0: SUCCESS (0.101s)
[526.915105] Subtest noreorder: SUCCESS (5.981s)
[527.127515] [102/133] (496s left) kms_addfb_basic (tile-pitch-mismatch)
[527.192006] Starting subtest: tile-pitch-mismatch
[527.196971] Subtest tile-pitch-mismatch: SKIP (0.000s)
[527.363865] [103/133] (495s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-msflip-blt)
[527.467046] Starting subtest: fbc-2p-primscrn-indfb-msflip-blt
[527.471352] Subtest fbc-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[527.585529] [104/133] (495s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[527.686048] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[527.690873] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[527.807977] [105/133] (495s left) gem_ctx_persistence (saturated-hostile-nopreempt)
[527.873974] Starting subtest: saturated-hostile-nopreempt
[527.876284] Starting dynamic subtest: rcs0
[527.948178] Dynamic subtest rcs0: SKIP (0.071s)
[527.959250] Starting dynamic subtest: bcs0
[527.966624] Dynamic subtest bcs0: SKIP (0.016s)
[527.976708] Starting dynamic subtest: vcs0
[527.990834] Dynamic subtest vcs0: SKIP (0.022s)
[528.000347] Starting dynamic subtest: vcs1
[528.013763] Dynamic subtest vcs1: SKIP (0.021s)
[528.024195] Starting dynamic subtest: vecs0
[528.037500] Dynamic subtest vecs0: SKIP (0.022s)
[528.057667] Starting dynamic subtest: ccs0
[528.062222] Dynamic subtest ccs0: SKIP (0.022s)
[528.066236] Subtest saturated-hostile-nopreempt: SKIP (0.187s)
[528.215647] [106/133] (495s left) kms_hdmi_inject (inject-4k)
[528.569402] Starting subtest: inject-4k
[528.883560] Subtest inject-4k: SUCCESS (0.316s)
[529.443477] [107/133] (493s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt)
[529.542709] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt
[529.546775] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[529.675483] [108/133] (493s left) syncobj_basic (illegal-fd-to-handle)
[529.737889] Starting subtest: illegal-fd-to-handle
[529.740299] Subtest illegal-fd-to-handle: SUCCESS (0.000s)
[529.870185] [109/133] (493s left) gem_exec_reloc (basic-active)
[529.937293] Subtest basic-active: SKIP (0.000s)
[530.034001] [110/133] (493s left) kms_color (invalid-ctm-matrix-sizes)
[530.125453] Starting subtest: invalid-ctm-matrix-sizes
[530.127819] Starting dynamic subtest: pipe-A
[530.130106] Dynamic subtest pipe-A: SUCCESS (0.002s)
[530.141089] Starting dynamic subtest: pipe-B
[530.143292] Dynamic subtest pipe-B: SUCCESS (0.003s)
[530.153199] Starting dynamic subtest: pipe-C
[530.155079] Dynamic subtest pipe-C: SUCCESS (0.003s)
[530.164849] Starting dynamic subtest: pipe-D
[530.167129] Dynamic subtest pipe-D: SUCCESS (0.004s)
[530.169510] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.014s)
[530.238356] [111/133] (493s left) gem_mmap_gtt (cpuset-big-copy-odd)
[530.284595] Subtest cpuset-big-copy-odd: SKIP (0.000s)
[530.360354] [112/133] (493s left) kms_vblank (query-forked-hang)
[530.453851] Starting subtest: query-forked-hang
[530.455760] Starting dynamic subtest: pipe-A-eDP-1
[556.557172] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.099s)
[556.574235] Starting dynamic subtest: pipe-D-eDP-1
[571.544053] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.988s)
[571.546621] Subtest query-forked-hang: SUCCESS (41.091s)
[572.410473] [113/133] (451s left) gem_softpin (reverse)
[572.471916] Starting subtest: reverse
[572.476779] Subtest reverse: SUCCESS (0.004s)
[572.628973] [114/133] (451s left) i915_pm_rps (engine-order)
[572.701727] Starting subtest: engine-order
[577.747499] Subtest engine-order: SUCCESS (5.050s)
[577.918575] [115/133] (445s left) gem_mmap_gtt (basic-read-write)
[577.979201] Subtest basic-read-write: SKIP (0.000s)
[578.040352] [116/133] (445s left) gem_ppgtt (shrink-vs-evict-any)
[578.094981] Starting subtest: shrink-vs-evict-any
[583.787502] Subtest shrink-vs-evict-any: SUCCESS (5.692s)
[583.898431] [117/133] (439s left) gem_exec_fence (submit3)
[584.083367] Starting subtest: submit3
[584.088290] Subtest submit3: SKIP (0.000s)
[585.892047] [118/133] (437s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[586.067316] Starting subtest: cursor-rapid-movement-32x10
[586.114803] Subtest cursor-rapid-movement-32x10: SKIP (0.042s)
[586.406357] [119/133] (437s left) kms_ccs (bad-rotation-90-y-tiled-ccs)
[586.507325] Starting subtest: bad-rotation-90-y-tiled-ccs
[586.509581] Starting dynamic subtest: pipe-A-eDP-1
[586.532052] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[586.544659] Starting dynamic subtest: pipe-B-eDP-1
[586.566005] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[586.575904] Starting dynamic subtest: pipe-C-eDP-1
[586.596953] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[586.606800] Starting dynamic subtest: pipe-D-eDP-1
[586.632760] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[586.641132] Subtest bad-rotation-90-y-tiled-ccs: SKIP (0.004s)
[588.797771] [120/133] (435s left) gem_exec_whisper (basic-queues-priority-all)
[588.870935] Starting subtest: basic-queues-priority-all
[610.934134] Subtest basic-queues-priority-all: SUCCESS (22.052s)
[611.142604] [121/133] (412s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-move)
[611.248062] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-move
[611.252343] Subtest fbcpsr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[611.396254] [122/133] (412s left) syncobj_eventfd (timeline-wait-signaled)
[611.459767] Starting subtest: timeline-wait-signaled
[611.462162] Subtest timeline-wait-signaled: SUCCESS (0.001s)
[611.596235] [123/133] (412s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt)
[611.708199] Starting subtest: psr-1p-primscrn-indfb-plflip-blt
[619.170642] Subtest psr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.464s)
[619.350232] [124/133] (404s left) gem_exec_params (invalid-ring2)
[619.420763] Starting subtest: invalid-ring2
[619.422981] Subtest invalid-ring2: SUCCESS (0.000s)
[619.562289] [125/133] (404s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[619.654637] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt
[619.658689] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[619.777175] [126/133] (404s left) kms_feature_discovery (chamelium)
[619.861455] Starting subtest: chamelium
[619.865807] Subtest chamelium: SKIP (0.000s)
[619.958812] [127/133] (404s left) kms_rotation_crc (primary-y-tiled-reflect-x-90)
[620.060048] Starting subtest: primary-y-tiled-reflect-x-90
[620.064210] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s)
[620.158295] [128/133] (404s left) i915_pm_freq_api (freq-reset)
[620.237344] Starting subtest: freq-reset
[620.238953] Starting dynamic subtest: gt0
[620.432383] Dynamic subtest gt0: SUCCESS (0.194s)
[620.443762] Starting dynamic subtest: gt1
[620.598955] Dynamic subtest gt1: SUCCESS (0.167s)
[620.602328] Subtest freq-reset: SUCCESS (0.363s)
[620.695376] [129/133] (403s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-pgflip-blt)
[620.801939] Starting subtest: fbc-2p-primscrn-indfb-pgflip-blt
[620.806187] Subtest fbc-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[620.939938] [130/133] (403s left) kms_chamelium_edid (dp-edid-read)
[621.320925] Subtest dp-edid-read: SKIP (0.000s)
[622.157308] [131/133] (402s left) kms_universal_plane (cursor-fb-leak)
[622.249748] Starting subtest: cursor-fb-leak
[622.251988] Starting dynamic subtest: pipe-A-eDP-1
[622.550730] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.303s)
[622.563437] Starting dynamic subtest: pipe-B-eDP-1
[623.933843] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.382s)
[623.946605] Starting dynamic subtest: pipe-C-eDP-1
[625.234006] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.299s)
[625.247041] Starting dynamic subtest: pipe-D-eDP-1
[626.528193] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.292s)
[626.530519] Subtest cursor-fb-leak: SUCCESS (4.280s)
[627.797345] [132/133] (396s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt)
[627.901491] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt
[627.905427] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[628.043893] [133/133] (396s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-render)
[628.144359] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-render
[628.148551] Subtest psr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[628.273781] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_schedule
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: gem_mmap_offset
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: gen7_exec_parse
results: parsing output: 6/ for test: kms_cursor_edge_walk
results: parsing output: 7/ for test: api_intel_bb
results: parsing output: 8/ for test: gem_exec_reloc
results: parsing output: 9/ for test: kms_psr
results: parsing output: 10/ for test: kms_chamelium_color
results: parsing output: 11/ for test: drm_mm
results: parsing output: 12/ for test: i915_query
results: parsing output: 13/ for test: kms_hdr
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_psr2_sf
results: parsing output: 16/ for test: kms_plane_scaling
results: parsing output: 17/ for test: gem_ccs
results: parsing output: 18/ for test: gem_exec_alignment
results: parsing output: 19/ for test: kms_flip_scaled_crc
results: parsing output: 20/ for test: kms_lease
results: parsing output: 21/ for test: perf
results: parsing output: 22/ for test: perf_pmu
results: parsing output: 23/ for test: gem_exec_flush
results: parsing output: 24/ for test: kms_ccs
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: gem_exec_reloc
results: parsing output: 28/ for test: kms_big_fb
results: parsing output: 29/ for test: kms_plane_scaling
results: parsing output: 30/ for test: gem_ctx_shared
results: parsing output: 31/ for test: kms_flip
results: parsing output: 32/ for test: kms_addfb_basic
results: parsing output: 33/ for test: gem_exec_fence
results: parsing output: 34/ for test: kms_big_fb
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: kms_pm_rpm
results: parsing output: 37/ for test: prime_vgem
results: parsing output: 38/ for test: gem_userptr_blits
results: parsing output: 39/ for test: syncobj_timeline
results: parsing output: 40/ for test: gem_mmap_gtt
results: parsing output: 41/ for test: kms_flip
results: parsing output: 42/ for test: kms_getfb
results: parsing output: 43/ for test: gen3_render_mixed_blits
results: parsing output: 44/ for test: kms_chamelium_hpd
results: parsing output: 45/ for test: kms_ccs
results: parsing output: 46/ for test: gem_render_copy
results: parsing output: 47/ for test: kms_cursor_crc
results: parsing output: 48/ for test: kms_psr
results: parsing output: 49/ for test: kms_psr
results: parsing output: 50/ for test: kms_plane_scaling
results: parsing output: 51/ for test: gem_exec_reloc
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: kms_psr2_sf
results: parsing output: 54/ for test: kms_ccs
results: parsing output: 55/ for test: gem_pxp
results: parsing output: 56/ for test: syncobj_timeline
results: parsing output: 57/ for test: kms_flip
results: parsing output: 58/ for test: kms_pipe_stress
results: parsing output: 59/ for test: kms_psr
results: parsing output: 60/ for test: gem_exec_reloc
results: parsing output: 61/ for test: gem_fenced_exec_thrash
results: parsing output: 62/ for test: gem_exec_reloc
results: parsing output: 63/ for test: gem_ctx_isolation
results: parsing output: 64/ for test: api_intel_allocator
results: parsing output: 65/ for test: kms_big_fb
results: parsing output: 66/ for test: gem_exec_balancer
results: parsing output: 67/ for test: kms_content_protection
results: parsing output: 68/ for test: i915_drm_fdinfo
results: parsing output: 69/ for test: kms_flip
results: parsing output: 70/ for test: kms_lease
results: parsing output: 71/ for test: kms_big_fb
results: parsing output: 72/ for test: sw_sync
results: parsing output: 73/ for test: kms_force_connector_basic
results: parsing output: 74/ for test: kms_flip_scaled_crc
results: parsing output: 75/ for test: gem_ppgtt
results: parsing output: 76/ for test: kms_flip_scaled_crc
results: parsing output: 77/ for test: syncobj_timeline
results: parsing output: 78/ for test: syncobj_timeline
results: parsing output: 79/ for test: syncobj_timeline
results: parsing output: 80/ for test: kms_psr
results: parsing output: 81/ for test: kms_big_fb
results: parsing output: 82/ for test: kms_async_flips
results: parsing output: 83/ for test: gem_exec_params
results: parsing output: 84/ for test: kms_frontbuffer_tracking
results: parsing output: 85/ for test: kms_cursor_legacy
results: parsing output: 86/ for test: kms_vblank
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: gem_set_tiling_vs_blt
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: fbdev
results: parsing output: 92/ for test: kms_flip
results: parsing output: 93/ for test: gem_tiled_wc
results: parsing output: 94/ for test: kms_psr2_sf
results: parsing output: 95/ for test: kms_flip
results: parsing output: 96/ for test: kms_async_flips
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: gem_exec_whisper
results: parsing output: 99/ for test: kms_big_fb
results: parsing output: 100/ for test: gem_exec_schedule
results: parsing output: 101/ for test: kms_addfb_basic
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_big_fb
results: parsing output: 104/ for test: gem_ctx_persistence
results: parsing output: 105/ for test: kms_hdmi_inject
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: syncobj_basic
results: parsing output: 108/ for test: gem_exec_reloc
results: parsing output: 109/ for test: kms_color
results: parsing output: 110/ for test: gem_mmap_gtt
results: parsing output: 111/ for test: kms_vblank
results: parsing output: 112/ for test: gem_softpin
results: parsing output: 113/ for test: i915_pm_rps
results: parsing output: 114/ for test: gem_mmap_gtt
results: parsing output: 115/ for test: gem_ppgtt
results: parsing output: 116/ for test: gem_exec_fence
results: parsing output: 117/ for test: kms_cursor_crc
results: parsing output: 118/ for test: kms_ccs
results: parsing output: 119/ for test: gem_exec_whisper
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: syncobj_eventfd
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: gem_exec_params
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_feature_discovery
results: parsing output: 126/ for test: kms_rotation_crc
results: parsing output: 127/ for test: i915_pm_freq_api
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: kms_chamelium_edid
results: parsing output: 130/ for test: kms_universal_plane
results: parsing output: 131/ for test: kms_frontbuffer_tracking
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.