[59.177790] Initializing watchdogs
[59.177835]   /dev/watchdog0
[59.193094] [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.197759] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.200096] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.203637] [001/156] (960s left) kms_psr2_sf (fbc-psr2-overlay-plane-update-sf-dmg-area)
[59.342301] Starting subtest: fbc-psr2-overlay-plane-update-sf-dmg-area
[59.344570] Starting dynamic subtest: pipe-A-eDP-1
[59.464454] Dynamic subtest pipe-A-eDP-1: SKIP (0.126s)
[59.475125] Starting dynamic subtest: pipe-B-eDP-1
[60.607105] Dynamic subtest pipe-B-eDP-1: SKIP (1.141s)
[60.611971] Subtest fbc-psr2-overlay-plane-update-sf-dmg-area: SKIP (1.269s)
[61.804756] [002/156] (957s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs)
[61.910084] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs
[61.912326] Starting dynamic subtest: pipe-A-eDP-1
[61.934746] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[61.942844] Starting dynamic subtest: pipe-B-eDP-1
[61.964061] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[61.971603] Starting dynamic subtest: pipe-C-eDP-1
[61.992181] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[61.999910] Starting dynamic subtest: pipe-D-eDP-1
[62.021606] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[62.025694] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs: SKIP (0.004s)
[64.177994] [003/156] (955s left) kms_cursor_legacy (cursorb-vs-flipb-atomic-transitions-varying-size)
[64.301293] Starting subtest: cursorB-vs-flipB-atomic-transitions-varying-size
[64.305994] Subtest cursorB-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s)
[64.441824] [004/156] (955s left) kms_ccs (bad-rotation-90-4-tiled-bmg-ccs)
[64.538464] Starting subtest: bad-rotation-90-4-tiled-bmg-ccs
[64.545799] Subtest bad-rotation-90-4-tiled-bmg-ccs: SKIP (0.000s)
[65.718057] [005/156] (954s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-blt)
[65.823300] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-blt
[65.827658] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s)
[65.922893] [006/156] (953s left) gem_exec_reloc (basic-cpu-wc-active)
[65.988859] Subtest basic-cpu-wc-active: SKIP (0.000s)
[66.066788] [007/156] (953s left) kms_frontbuffer_tracking (fbcpsrhdr-tiling-y)
[66.162521] Starting subtest: fbcpsrhdr-tiling-y
[66.166736] Subtest fbcpsrhdr-tiling-y: SKIP (0.000s)
[66.276083] [008/156] (953s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier)
[66.369928] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier
[66.373950] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier: SKIP (0.000s)
[66.448377] [009/156] (953s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[66.537740] Starting subtest: compare-crc-sanitycheck-nv12
[66.540108] Starting dynamic subtest: pipe-A-eDP-1
[67.245708] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.709s)
[67.256275] Starting dynamic subtest: pipe-B-eDP-1
[68.546881] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.300s)
[68.557298] Starting dynamic subtest: pipe-C-eDP-1
[69.813137] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.264s)
[69.822073] Starting dynamic subtest: pipe-D-eDP-1
[71.049043] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.235s)
[71.051474] Subtest compare-crc-sanitycheck-nv12: SUCCESS (4.512s)
[71.881210] [010/156] (948s left) tools_test (sysfs_l3_parity)
[71.935133] Starting subtest: sysfs_l3_parity
[72.000102] Subtest sysfs_l3_parity: SKIP (0.079s)
[72.053415] [011/156] (948s left) kms_feature_discovery (display-4x)
[72.151312] Starting subtest: display-4x
[72.156504] Subtest display-4x: SKIP (0.000s)
[72.227807] [012/156] (947s left) gem_exec_fence (syncobj-timeline-export)
[72.930351] Starting subtest: syncobj-timeline-export
[72.938936] Subtest syncobj-timeline-export: SUCCESS (0.013s)
[74.320187] [FACT gem_exec_fence (syncobj-timeline-export)] new: kernel.kmod_is_loaded.vgem: true
[74.323224] [013/156] (945s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-pwrite)
[74.430851] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-pwrite
[74.435205] Subtest fbc-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[74.527936] [014/156] (945s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-5)
[74.611451] Starting subtest: planes-unity-scaling-downscale-factor-0-5
[74.613891] Starting dynamic subtest: pipe-A
[74.635221] Dynamic subtest pipe-A: SKIP (0.017s)
[74.644783] Starting dynamic subtest: pipe-B
[74.666954] Dynamic subtest pipe-B: SKIP (0.032s)
[74.675598] Starting dynamic subtest: pipe-C
[74.701439] Dynamic subtest pipe-C: SKIP (0.035s)
[74.709624] Starting dynamic subtest: pipe-D
[74.734168] Dynamic subtest pipe-D: SKIP (0.033s)
[74.737859] Subtest planes-unity-scaling-downscale-factor-0-5: SKIP (0.118s)
[74.838442] [015/156] (945s left) gem_busy (extended)
[75.013754] Starting subtest: extended
[75.016249] Starting dynamic subtest: rcs0
[75.090720] Dynamic subtest rcs0: SUCCESS (0.077s)
[75.101769] Starting dynamic subtest: bcs0
[75.132631] Dynamic subtest bcs0: SUCCESS (0.041s)
[75.145289] Starting dynamic subtest: vcs0
[76.288634] Dynamic subtest vcs0: SUCCESS (1.154s)
[76.301890] Starting dynamic subtest: vcs1
[78.272082] Dynamic subtest vcs1: SUCCESS (1.981s)
[78.283779] Starting dynamic subtest: vecs0
[80.371896] Dynamic subtest vecs0: SUCCESS (2.047s)
[80.380358] Starting dynamic subtest: ccs0
[80.382657] Dynamic subtest ccs0: SUCCESS (0.044s)
[80.384924] Subtest extended: SUCCESS (5.350s)
[80.598676] [016/156] (939s left) kms_big_fb (y-tiled-64bpp-rotate-0)
[80.724524] Starting subtest: y-tiled-64bpp-rotate-0
[80.728714] Subtest y-tiled-64bpp-rotate-0: SKIP (0.000s)
[80.825435] [017/156] (939s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-mc-ccs)
[80.917138] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-mc-ccs
[80.919519] Starting dynamic subtest: pipe-A-eDP-1
[83.161423] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.246s)
[83.171047] Starting dynamic subtest: pipe-B-eDP-1
[85.548535] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.386s)
[85.557205] Starting dynamic subtest: pipe-C-eDP-1
[87.748172] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.198s)
[87.757386] Starting dynamic subtest: pipe-D-eDP-1
[89.980221] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.230s)
[89.982334] Subtest crc-primary-rotation-180-4-tiled-mtl-mc-ccs: SUCCESS (9.065s)
[91.188273] [018/156] (929s left) kms_chamelium_color (ctm-0-50)
[91.285966] Subtest ctm-0-50: SKIP (0.000s)
[91.332059] [019/156] (929s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[91.435330] Starting subtest: fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt
[91.439497] Subtest fbcpsrhdr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[91.531362] [020/156] (928s left) syncobj_timeline (reset-during-wait-for-submit)
[91.581531] Starting subtest: reset-during-wait-for-submit
[91.687221] Subtest reset-during-wait-for-submit: SUCCESS (0.105s)
[91.786497] [021/156] (928s left) kms_frontbuffer_tracking (fbchdr-modesetfrombusy)
[91.895441] Starting subtest: fbchdr-modesetfrombusy
[91.899787] Subtest fbchdr-modesetfrombusy: SKIP (0.000s)
[92.004219] [022/156] (928s left) gem_create (create-size-update)
[92.061087] Starting subtest: create-size-update
[92.063446] Subtest create-size-update: SUCCESS (0.000s)
[92.270009] [023/156] (928s left) kms_chamelium_hpd (vga-hpd-fast)
[92.655289] Subtest vga-hpd-fast: SKIP (0.000s)
[93.511593] [024/156] (927s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-onoff)
[93.629669] Starting subtest: psr-2p-scndscrn-cur-indfb-onoff
[93.633694] Subtest psr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[93.723737] [025/156] (926s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-cur-indfb-move)
[93.824386] Starting subtest: psrhdr-1p-primscrn-cur-indfb-move
[93.828412] Subtest psrhdr-1p-primscrn-cur-indfb-move: SKIP (0.000s)
[93.920632] [026/156] (926s left) gem_pxp (fail-invalid-protected-context)
[94.036367] Starting subtest: fail-invalid-protected-context
[94.039270] Subtest fail-invalid-protected-context: SUCCESS (0.000s)
[94.149782] [027/156] (926s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-pri-shrfb-draw-pwrite)
[94.249230] Starting subtest: psrhdr-1p-primscrn-pri-shrfb-draw-pwrite
[94.253378] Subtest psrhdr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[94.355374] [028/156] (926s left) kms_psr2_su (page_flip-xrgb8888)
[94.415222] Subtest page_flip-XRGB8888: SKIP (0.000s)
[94.474371] [029/156] (926s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[94.594033] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[94.597606] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.001s)
[94.744970] [030/156] (926s left) kms_psr (fbc-pr-suspend)
[94.835353] Starting subtest: fbc-pr-suspend
[94.838653] Subtest fbc-pr-suspend: SKIP (0.000s)
[94.919315] [031/156] (926s left) syncobj_timeline (etime-single-wait-all-for-submit-submitted)
[94.983691] Starting subtest: etime-single-wait-all-for-submit-submitted
[95.092618] Subtest etime-single-wait-all-for-submit-submitted: SUCCESS (0.107s)
[95.170556] [032/156] (925s left) kms_psr (fbc-psr2-suspend)
[95.253714] Starting subtest: fbc-psr2-suspend
[95.256215] Starting dynamic subtest: eDP-1
[95.260927] Dynamic subtest eDP-1: SKIP (0.000s)
[95.265704] Subtest fbc-psr2-suspend: SKIP (0.001s)
[95.328683] [033/156] (925s left) gem_render_copy (y-tiled-ccs-to-y-tiled-mc-ccs)
[95.387871] Starting subtest: y-tiled-ccs-to-y-tiled-mc-ccs
[95.392256] Subtest y-tiled-ccs-to-y-tiled-mc-ccs: SKIP (0.000s)
[95.569544] [034/156] (925s left) gem_exec_capture (pi)
[95.628743] Starting subtest: pi
[95.630900] Starting dynamic subtest: rcs0
[100.010576] Dynamic subtest rcs0: SUCCESS (4.384s)
[100.022624] Starting dynamic subtest: bcs0
[104.149101] Dynamic subtest bcs0: SUCCESS (4.137s)
[104.160122] Starting dynamic subtest: vcs0
[108.273970] Dynamic subtest vcs0: SUCCESS (4.123s)
[108.283881] Starting dynamic subtest: vcs1
[112.381307] Dynamic subtest vcs1: SUCCESS (4.105s)
[112.394971] Starting dynamic subtest: vecs0
[116.512691] Dynamic subtest vecs0: SUCCESS (4.130s)
[116.521904] Starting dynamic subtest: ccs0
[120.712760] Dynamic subtest ccs0: SUCCESS (4.199s)
[120.715187] Subtest pi: SUCCESS (25.086s)
[120.795601] [035/156] (900s left) gem_exec_balancer (indices)
[120.916491] Starting subtest: indices
[123.232763] Subtest indices: SUCCESS (2.314s)
[123.540057] [036/156] (897s left) i915_query (query-regions-sanity-check)
[123.600345] Starting subtest: query-regions-sanity-check
[123.615764] Subtest query-regions-sanity-check: SUCCESS (0.017s)
[123.740197] [037/156] (897s left) syncobj_wait (wait-all-delayed-signal)
[123.807623] Starting subtest: wait-all-delayed-signal
[123.908830] Subtest wait-all-delayed-signal: SUCCESS (0.103s)
[123.989413] [038/156] (897s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-spr-indfb-onoff)
[124.101912] Starting subtest: fbchdr-2p-scndscrn-spr-indfb-onoff
[124.106127] Subtest fbchdr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[124.212184] [039/156] (897s left) kms_plane_scaling (plane-downscale-factor-0-5-with-pixel-format)
[124.301354] Starting subtest: plane-downscale-factor-0-5-with-pixel-format
[124.303653] Starting dynamic subtest: pipe-A
[124.321677] Dynamic subtest pipe-A: SKIP (0.017s)
[124.331267] Starting dynamic subtest: pipe-B
[124.353450] Dynamic subtest pipe-B: SKIP (0.031s)
[124.362612] Starting dynamic subtest: pipe-C
[124.386750] Dynamic subtest pipe-C: SKIP (0.032s)
[124.401852] Starting dynamic subtest: pipe-D
[124.420054] Dynamic subtest pipe-D: SKIP (0.033s)
[124.424966] Subtest plane-downscale-factor-0-5-with-pixel-format: SKIP (0.116s)
[124.521047] [040/156] (896s left) gem_render_copy (yf-tiled-ccs-to-linear)
[124.580650] Starting subtest: yf-tiled-ccs-to-linear
[124.584969] Subtest yf-tiled-ccs-to-linear: SKIP (0.000s)
[124.765264] [041/156] (896s left) gem_exec_schedule (preempt-self)
[124.844252] Starting subtest: preempt-self
[124.846482] Starting dynamic subtest: rcs0
[124.865714] Dynamic subtest rcs0: SUCCESS (0.026s)
[124.876456] Starting dynamic subtest: bcs0
[124.885323] Dynamic subtest bcs0: SUCCESS (0.019s)
[124.895154] Starting dynamic subtest: vcs0
[124.905214] Dynamic subtest vcs0: SUCCESS (0.019s)
[124.914296] Starting dynamic subtest: vcs1
[124.926868] Dynamic subtest vcs1: SUCCESS (0.021s)
[124.936609] Starting dynamic subtest: vecs0
[124.947028] Dynamic subtest vecs0: SUCCESS (0.019s)
[124.956354] Starting dynamic subtest: ccs0
[124.962164] Dynamic subtest ccs0: SUCCESS (0.015s)
[124.964427] Subtest preempt-self: SUCCESS (0.123s)
[126.357321] [042/156] (895s left) core_setmaster (master-drop-set-root)
[126.427458] Starting subtest: master-drop-set-root
[126.448855] Subtest master-drop-set-root: SUCCESS (0.024s)
[126.502583] [043/156] (894s left) kms_big_fb (linear-16bpp-rotate-90)
[126.599426] Starting subtest: linear-16bpp-rotate-90
[126.622189] Subtest linear-16bpp-rotate-90: SKIP (0.020s)
[126.731850] [044/156] (894s left) syncobj_timeline (wait-for-submit-delayed-submit)
[126.781506] Starting subtest: wait-for-submit-delayed-submit
[126.882719] Subtest wait-for-submit-delayed-submit: SUCCESS (0.102s)
[126.962253] [045/156] (894s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-render)
[127.058266] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-render
[127.062896] Subtest fbc-2p-scndscrn-pri-shrfb-draw-render: SKIP (0.000s)
[127.153103] [046/156] (894s left) kms_cursor_crc (cursor-onscreen-32x10)
[127.320247] Starting subtest: cursor-onscreen-32x10
[127.367252] Subtest cursor-onscreen-32x10: SKIP (0.044s)
[127.630482] [047/156] (893s left) api_intel_bb (misplaced-blitter)
[127.685753] Starting subtest: misplaced-blitter
[127.691705] Subtest misplaced-blitter: SUCCESS (0.007s)
[127.832544] [048/156] (893s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-sf)
[127.925046] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-sf
[127.927045] Starting dynamic subtest: pipe-A-eDP-1
[128.023671] Dynamic subtest pipe-A-eDP-1: SKIP (0.100s)
[128.034519] Starting dynamic subtest: pipe-B-eDP-1
[129.186342] Dynamic subtest pipe-B-eDP-1: SKIP (1.159s)
[129.191129] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-sf: SKIP (1.262s)
[130.378350] [049/156] (891s left) kms_flip (2x-flip-vs-panning-vs-hang)
[130.477243] Starting subtest: 2x-flip-vs-panning-vs-hang
[130.482548] Subtest 2x-flip-vs-panning-vs-hang: SKIP (0.002s)
[130.585583] [050/156] (891s left) kms_flip (2x-blocking-absolute-wf_vblank)
[130.671832] Starting subtest: 2x-blocking-absolute-wf_vblank
[130.683096] Subtest 2x-blocking-absolute-wf_vblank: SKIP (0.011s)
[130.763922] [051/156] (890s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[130.869825] Starting subtest: fbchdr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[130.873972] Subtest fbchdr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[130.969346] [052/156] (890s left) gem_mmap_gtt (cpuset-basic-small-copy)
[131.026040] Subtest cpuset-basic-small-copy: SKIP (0.000s)
[131.088070] [053/156] (890s left) kms_invalid_mode (clock-too-high)
[131.183820] Starting subtest: clock-too-high
[131.186112] Starting dynamic subtest: pipe-A-eDP-1
[131.471173] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.290s)
[131.481246] Starting dynamic subtest: pipe-B-eDP-1
[131.485413] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[131.495140] Starting dynamic subtest: pipe-C-eDP-1
[131.499629] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[131.509740] Starting dynamic subtest: pipe-D-eDP-1
[131.514368] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[131.516727] Subtest clock-too-high: SUCCESS (0.295s)
[132.313686] [054/156] (889s left) gem_exec_reloc (basic-cpu-read-noreloc)
[132.372449] Subtest basic-cpu-read-noreloc: SKIP (0.000s)
[132.453349] [055/156] (889s left) gen9_exec_parse (allowed-all)
[132.527470] Subtest allowed-all: SKIP (0.000s)
[132.593576] [056/156] (889s left) gem_exec_params (invalid-bsd-ring)
[132.655286] Starting subtest: invalid-bsd-ring
[132.657556] Subtest invalid-bsd-ring: SUCCESS (0.000s)
[132.759293] [057/156] (889s left) gem_vm_create (create-ext)
[132.819501] Starting subtest: create-ext
[132.825142] Subtest create-ext: SUCCESS (0.005s)
[132.957343] [058/156] (889s left) perf (polling-small-buf)
[133.096046] Starting subtest: polling-small-buf
[133.185077] Subtest polling-small-buf: SUCCESS (0.089s)
[133.233318] [059/156] (888s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-render)
[133.339103] Starting subtest: psr-1p-primscrn-pri-indfb-draw-render
[140.677789] Subtest psr-1p-primscrn-pri-indfb-draw-render: SUCCESS (7.343s)
[140.793105] [060/156] (881s left) api_intel_allocator (alloc-simple)
[140.857255] Starting subtest: alloc-simple
[140.859672] Subtest alloc-simple: SUCCESS (0.003s)
[140.989510] [061/156] (881s left) kms_flip (plain-flip-ts-check)
[141.082488] Starting subtest: plain-flip-ts-check
[141.084443] Starting dynamic subtest: A-eDP1
[149.988467] Dynamic subtest A-eDP1: SUCCESS (8.875s)
[149.999207] Starting dynamic subtest: B-eDP1
[158.825236] Dynamic subtest B-eDP1: SUCCESS (8.835s)
[158.839484] Starting dynamic subtest: C-eDP1
[167.656214] Dynamic subtest C-eDP1: SUCCESS (8.818s)
[167.669134] Starting dynamic subtest: D-eDP1
[176.493055] Dynamic subtest D-eDP1: SUCCESS (8.833s)
[176.495398] Subtest plain-flip-ts-check: SUCCESS (35.372s)
[177.642068] [062/156] (844s left) syncobj_basic (bad-handle-to-fd)
[177.699883] Starting subtest: bad-handle-to-fd
[177.701837] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[177.819924] [063/156] (844s left) gem_exec_reloc (basic-wc-gtt-noreloc)
[177.876482] Subtest basic-wc-gtt-noreloc: SKIP (0.000s)
[177.964895] [064/156] (844s left) gem_mmap_wc (write-read)
[178.026941] Subtest write-read: SKIP (0.000s)
[178.093118] [065/156] (844s left) kms_big_fb (4-tiled-16bpp-rotate-180)
[178.200578] Starting subtest: 4-tiled-16bpp-rotate-180
[179.469382] Subtest 4-tiled-16bpp-rotate-180: SUCCESS (1.268s)
[179.581243] [066/156] (842s left) gem_softpin (invalid)
[179.633299] Starting subtest: invalid
[179.640362] Subtest invalid: SUCCESS (0.006s)
[179.750698] [067/156] (842s left) gem_render_copy (y-tiled-ccs-to-x-tiled)
[179.813122] Starting subtest: y-tiled-ccs-to-x-tiled
[179.817072] Subtest y-tiled-ccs-to-x-tiled: SKIP (0.000s)
[179.999583] [068/156] (842s left) gem_ctx_persistence (engines-queued)
[180.060494] Starting subtest: engines-queued
[180.063200] Starting dynamic subtest: rcs0
[180.103447] Dynamic subtest rcs0: SUCCESS (0.042s)
[180.114702] Starting dynamic subtest: bcs0
[180.172227] Dynamic subtest bcs0: SUCCESS (0.068s)
[180.183701] Starting dynamic subtest: vcs0
[181.278229] Dynamic subtest vcs0: SUCCESS (1.103s)
[181.290706] Starting dynamic subtest: vcs1
[183.262315] Dynamic subtest vcs1: SUCCESS (1.981s)
[183.274263] Starting dynamic subtest: vecs0
[185.299884] Dynamic subtest vecs0: SUCCESS (1.981s)
[185.312220] Starting dynamic subtest: ccs0
[185.433271] Dynamic subtest ccs0: SUCCESS (0.185s)
[185.435788] Subtest engines-queued: SUCCESS (5.373s)
[185.566443] [069/156] (836s left) kms_frontbuffer_tracking (hdr-1p-primscrn-shrfb-msflip-blt)
[185.671384] Starting subtest: hdr-1p-primscrn-shrfb-msflip-blt
[185.676026] Subtest hdr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[185.759517] [070/156] (836s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-downscaling)
[185.860172] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-downscaling
[185.862384] Starting dynamic subtest: pipe-A-default-mode
[187.005459] Dynamic subtest pipe-A-default-mode: SKIP (1.144s)
[187.009595] Subtest flip-32bpp-xtile-to-64bpp-xtile-downscaling: SKIP (1.145s)
[187.152349] [071/156] (835s left) kms_color (ctm-signed)
[187.253174] Starting subtest: ctm-signed
[187.255495] Starting dynamic subtest: pipe-A-eDP-1
[189.367360] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.115s)
[189.377728] Starting dynamic subtest: pipe-B-eDP-1
[192.228724] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.856s)
[192.238431] Starting dynamic subtest: pipe-C-eDP-1
[194.972122] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.745s)
[194.982872] Starting dynamic subtest: pipe-D-eDP-1
[197.616713] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.643s)
[197.618899] Subtest ctm-signed: SUCCESS (10.364s)
[198.424110] [072/156] (824s left) kms_cursor_crc (cursor-sliding-128x128)
[198.637686] Starting subtest: cursor-sliding-128x128
[198.640086] Starting dynamic subtest: pipe-A-eDP-1
[201.861924] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.221s)
[201.892221] Starting dynamic subtest: pipe-D-eDP-1
[205.752785] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.868s)
[205.755225] Subtest cursor-sliding-128x128: SUCCESS (7.116s)
[206.602220] [073/156] (816s left) kms_getfb (getfb-handle-protection)
[206.696414] Starting subtest: getfb-handle-protection
[206.721404] Subtest getfb-handle-protection: SUCCESS (0.026s)
[206.830637] [074/156] (815s left) kms_flip (bo-too-big)
[206.922288] Starting subtest: bo-too-big
[206.924576] Starting dynamic subtest: A-eDP1
[208.264787] Dynamic subtest A-eDP1: SUCCESS (1.341s)
[208.274917] Starting dynamic subtest: B-eDP1
[209.599281] Dynamic subtest B-eDP1: SUCCESS (1.334s)
[209.612832] Starting dynamic subtest: C-eDP1
[210.935118] Dynamic subtest C-eDP1: SUCCESS (1.332s)
[210.947556] Starting dynamic subtest: D-eDP1
[212.253077] Dynamic subtest D-eDP1: SUCCESS (1.316s)
[212.258151] Subtest bo-too-big: SUCCESS (5.336s)
[213.469608] [075/156] (809s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-wc)
[213.570875] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-wc
[213.575407] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[213.665256] [076/156] (809s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[213.758503] Starting subtest: psrhdr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[213.762580] Subtest psrhdr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[213.857975] [077/156] (809s left) syncobj_eventfd (timeline-wait-before-signal)
[213.920793] Starting subtest: timeline-wait-before-signal
[213.951223] Subtest timeline-wait-before-signal: SUCCESS (0.031s)
[214.042528] [078/156] (808s left) syncobj_wait (invalid-wait-bad-flags)
[214.099640] Starting subtest: invalid-wait-bad-flags
[214.101978] Subtest invalid-wait-bad-flags: SUCCESS (0.000s)
[214.208532] [079/156] (808s left) kms_content_protection (lic-type-1)
[214.353074] Starting subtest: lic-type-1
[214.357731] Subtest lic-type-1: SKIP (0.000s)
[214.475077] [080/156] (808s left) kms_pm_rpm (fences)
[216.506994] Starting subtest: fences
[216.512624] Subtest fences: SKIP (0.000s)
[216.893561] [081/156] (806s left) kms_plane_alpha_blend (alpha-7efc)
[216.996909] Starting subtest: alpha-7efc
[217.290085] Starting dynamic subtest: pipe-A-eDP-1
[217.890264] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.598s)
[217.918085] Starting dynamic subtest: pipe-D-eDP-1
[219.208279] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.295s)
[219.210672] Subtest alpha-7efc: SUCCESS (2.211s)
[220.049010] [082/156] (803s left) gem_spin_batch (legacy-resubmit-new)
[220.117055] Starting subtest: legacy-resubmit-new
[220.119487] Starting dynamic subtest: default
[220.125988] Dynamic subtest default: SUCCESS (0.008s)
[220.136207] Starting dynamic subtest: render
[220.138589] Dynamic subtest render: SUCCESS (0.003s)
[220.148084] Starting dynamic subtest: bsd
[220.150445] Dynamic subtest bsd: SUCCESS (0.004s)
[220.159779] Starting dynamic subtest: bsd1
[220.161632] Dynamic subtest bsd1: SUCCESS (0.005s)
[220.170502] Starting dynamic subtest: bsd2
[220.172406] Dynamic subtest bsd2: SUCCESS (0.003s)
[220.181244] Starting dynamic subtest: blt
[220.183108] Dynamic subtest blt: SUCCESS (0.004s)
[220.192059] Starting dynamic subtest: vebox
[220.194051] Dynamic subtest vebox: SUCCESS (0.004s)
[220.195935] Subtest legacy-resubmit-new: SUCCESS (0.038s)
[221.353844] [083/156] (801s left) i915_hangman (hangcheck-unterminated)
[221.411511] Starting subtest: hangcheck-unterminated
[233.247708] Subtest hangcheck-unterminated: SUCCESS (11.836s)
[233.358073] [084/156] (789s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-wc)
[233.454782] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-wc
[233.458822] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[233.558721] [085/156] (789s left) gem_exec_schedule (pi-distinct-iova)
[233.738757] Starting subtest: pi-distinct-iova
[233.740894] Starting dynamic subtest: rcs0
[233.816994] Dynamic subtest rcs0: SUCCESS (0.080s)
[233.830935] Starting dynamic subtest: vcs0
[233.878019] Dynamic subtest vcs0: SUCCESS (0.058s)
[233.890836] Starting dynamic subtest: vcs1
[233.945265] Dynamic subtest vcs1: SUCCESS (0.066s)
[233.958940] Starting dynamic subtest: vecs0
[234.002842] Dynamic subtest vecs0: SUCCESS (0.056s)
[234.016375] Starting dynamic subtest: ccs0
[234.061713] Dynamic subtest ccs0: SUCCESS (0.058s)
[234.064168] Subtest pi-distinct-iova: SUCCESS (0.327s)
[235.424434] [086/156] (787s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[235.526406] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip
[235.530276] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[235.614835] [087/156] (787s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-shrfb-fliptrack-mmap-gtt)
[235.714899] Starting subtest: fbcpsrhdr-1p-shrfb-fliptrack-mmap-gtt
[235.718860] Subtest fbcpsrhdr-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[235.825689] [088/156] (787s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[235.938564] Starting subtest: cursorA-vs-flipB-legacy
[235.943071] Subtest cursorA-vs-flipB-legacy: SKIP (0.001s)
[236.087483] [089/156] (787s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180)
[236.194860] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180
[237.228960] Subtest x-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.035s)
[237.363432] [090/156] (786s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt)
[237.468912] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt
[237.472318] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[237.562784] [091/156] (785s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt)
[237.654260] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt
[237.658071] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[237.772786] [092/156] (785s left) kms_getfb (getfb-handle-not-fb)
[237.873585] Starting subtest: getfb-handle-not-fb
[237.875540] Subtest getfb-handle-not-fb: SUCCESS (0.000s)
[237.982926] [093/156] (785s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[238.083746] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[238.088539] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[238.179962] [094/156] (785s left) kms_psr (psr2-cursor-mmap-cpu)
[238.263728] Starting subtest: psr2-cursor-mmap-cpu
[238.265648] Starting dynamic subtest: eDP-1
[240.023088] Dynamic subtest eDP-1: SUCCESS (1.756s)
[240.025367] Subtest psr2-cursor-mmap-cpu: SUCCESS (1.758s)
[240.916573] [095/156] (782s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[241.008406] Starting subtest: addfb25-yf-tiled-legacy
[241.010331] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[241.125048] [096/156] (782s left) kms_cursor_legacy (short-flip-after-cursor-toggle)
[241.251194] Starting subtest: short-flip-after-cursor-toggle
[242.178215] Subtest short-flip-after-cursor-toggle: SUCCESS (0.929s)
[243.040417] [097/156] (780s left) kms_pipe_b_c_ivb (pipe-b-double-modeset-then-modeset-pipe-c)
[243.105668] Subtest pipe-B-double-modeset-then-modeset-pipe-C: SKIP (0.000s)
[243.170526] [098/156] (780s left) prime_self_import (reimport-vs-gem_close-race)
[243.206966] Starting subtest: reimport-vs-gem_close-race
[248.301612] Subtest reimport-vs-gem_close-race: SUCCESS (5.079s)
[248.364893] [099/156] (775s left) kms_chamelium_frames (hdmi-crc-multiple)
[248.764911] Subtest hdmi-crc-multiple: SKIP (0.000s)
[249.570387] [100/156] (774s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-wc)
[249.676175] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-wc
[249.680233] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[249.764821] [101/156] (774s left) kms_big_fb (x-tiled-64bpp-rotate-0)
[249.857929] Starting subtest: x-tiled-64bpp-rotate-0
[251.514546] Subtest x-tiled-64bpp-rotate-0: SUCCESS (1.656s)
[251.683749] [102/156] (772s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb101010-draw-mmap-wc)
[251.780513] Starting subtest: fbcpsrhdr-rgb101010-draw-mmap-wc
[251.783763] Subtest fbcpsrhdr-rgb101010-draw-mmap-wc: SKIP (0.000s)
[251.871938] [103/156] (772s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-msflip-blt)
[251.973792] Starting subtest: fbcpsr-1p-primscrn-indfb-msflip-blt
[259.467407] Subtest fbcpsr-1p-primscrn-indfb-msflip-blt: SUCCESS (7.497s)
[259.639893] [104/156] (764s left) kms_frontbuffer_tracking (basic)
[259.743930] Starting subtest: basic
[263.118658] Subtest basic: SUCCESS (3.381s)
[263.221506] [105/156] (760s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-spr-indfb-draw-pwrite)
[263.329449] Starting subtest: hdr-2p-scndscrn-spr-indfb-draw-pwrite
[263.332883] Subtest hdr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[263.426349] [106/156] (760s left) kms_prime (basic-crc-hybrid)
[263.509191] Subtest basic-crc-hybrid: SKIP (0.000s)
[263.603137] [107/156] (760s left) kms_vblank (query-forked-hang)
[263.700443] Starting subtest: query-forked-hang
[263.702457] Starting dynamic subtest: pipe-A-eDP-1
[290.046806] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.347s)
[290.061802] Starting dynamic subtest: pipe-D-eDP-1
[315.136471] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.086s)
[315.138732] Subtest query-forked-hang: SUCCESS (51.437s)
[315.967035] [108/156] (708s left) gem_gpgpu_fill (offset-16x16)
[316.021299] Starting subtest: offset-16x16
[316.029855] Subtest offset-16x16: SUCCESS (0.010s)
[316.170480] [109/156] (708s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-render)
[316.282726] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-render
[323.211644] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-render: SUCCESS (6.933s)
[323.363156] [110/156] (700s left) sysfs_preempt_timeout (invalid)
[323.427935] Starting subtest: invalid
[323.430501] Starting dynamic subtest: vecs0
[323.432857] Dynamic subtest vecs0: SUCCESS (0.000s)
[323.444983] Starting dynamic subtest: ccs0
[323.447242] Dynamic subtest ccs0: SUCCESS (0.000s)
[323.457388] Starting dynamic subtest: vcs0
[323.459641] Dynamic subtest vcs0: SUCCESS (0.000s)
[323.469296] Starting dynamic subtest: bcs0
[323.471495] Dynamic subtest bcs0: SUCCESS (0.000s)
[323.481148] Starting dynamic subtest: rcs0
[323.483645] Dynamic subtest rcs0: SUCCESS (0.000s)
[323.493696] Starting dynamic subtest: vcs1
[323.495831] Dynamic subtest vcs1: SUCCESS (0.000s)
[323.498072] Subtest invalid: SUCCESS (0.006s)
[323.542543] [111/156] (700s left) gem_partial_pwrite_pread (reads-snoop)
[323.617761] Subtest reads-snoop: SKIP (0.000s)
[323.695860] [112/156] (700s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-cur-indfb-draw-mmap-wc)
[323.799844] Starting subtest: fbchdr-1p-primscrn-cur-indfb-draw-mmap-wc
[323.803990] Subtest fbchdr-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[323.901221] [113/156] (700s left) syncobj_wait (wait-for-submit-complex)
[323.964659] Starting subtest: wait-for-submit-complex
[324.025369] Subtest wait-for-submit-complex: SUCCESS (0.062s)
[324.104956] [114/156] (700s left) kms_vblank (wait-busy-hang)
[324.193388] Starting subtest: wait-busy-hang
[324.195307] Starting dynamic subtest: pipe-A-eDP-1
[351.032050] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.836s)
[351.048073] Starting dynamic subtest: pipe-D-eDP-1
[376.064815] Dynamic subtest pipe-D-eDP-1: SUCCESS (25.031s)
[376.067138] Subtest wait-busy-hang: SUCCESS (51.872s)
[376.951258] [115/156] (647s left) kms_cursor_legacy (single-move)
[377.071922] Starting subtest: single-move
[377.074801] Starting dynamic subtest: pipe-A
[382.507239] Dynamic subtest pipe-A: SUCCESS (5.380s)
[382.518944] Starting dynamic subtest: pipe-B
[387.888836] Dynamic subtest pipe-B: SUCCESS (5.379s)
[387.900450] Starting dynamic subtest: pipe-C
[393.269871] Dynamic subtest pipe-C: SUCCESS (5.378s)
[393.281388] Starting dynamic subtest: pipe-D
[398.652099] Dynamic subtest pipe-D: SUCCESS (5.379s)
[398.664049] Starting dynamic subtest: all-pipes
[404.041665] Dynamic subtest all-pipes: SUCCESS (5.386s)
[404.043969] Subtest single-move: SUCCESS (26.916s)
[404.140697] [116/156] (620s left) gem_exec_whisper (basic-queues)
[404.211086] Starting subtest: basic-queues
[412.192999] Subtest basic-queues: SUCCESS (7.981s)
[412.374686] [117/156] (612s left) kms_frontbuffer_tracking (fbc-1p-indfb-fliptrack-mmap-gtt)
[412.491740] Starting subtest: fbc-1p-indfb-fliptrack-mmap-gtt
[412.496435] Subtest fbc-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[412.595559] [118/156] (612s left) kms_addfb_basic (size-max)
[412.691175] Starting subtest: size-max
[412.693368] Subtest size-max: SUCCESS (0.000s)
[412.807922] [119/156] (611s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-blt)
[412.903199] Starting subtest: psr-1p-offscreen-pri-indfb-draw-blt
[419.877437] Subtest psr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.978s)
[420.044299] [120/156] (604s left) kms_big_fb (4-tiled-addfb)
[420.141891] Starting subtest: 4-tiled-addfb
[420.145895] Subtest 4-tiled-addfb: SUCCESS (0.000s)
[420.257118] [121/156] (604s left) kms_plane_multiple (tiling-4)
[420.354553] Starting subtest: tiling-4
[420.356748] Starting dynamic subtest: pipe-A-eDP-1
[424.199513] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.845s)
[424.212884] Starting dynamic subtest: pipe-B-eDP-1
[428.759775] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.559s)
[428.772165] Starting dynamic subtest: pipe-C-eDP-1
[433.197102] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.436s)
[433.208992] Starting dynamic subtest: pipe-D-eDP-1
[437.550150] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.350s)
[437.552409] Subtest tiling-4: SUCCESS (17.196s)
[438.370632] [122/156] (586s left) gem_exec_gttfill (multigpu-basic)
[438.551040] Starting subtest: multigpu-basic
[451.437062] Subtest multigpu-basic: SUCCESS (12.889s)
[451.497812] [123/156] (573s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-shrfb-msflip-blt)
[451.659379] Starting subtest: fbchdr-2p-primscrn-shrfb-msflip-blt
[451.663577] Subtest fbchdr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[451.754513] [124/156] (573s left) gem_ctx_persistence (legacy-engines-mixed)
[451.810873] Starting subtest: legacy-engines-mixed
[451.813242] Starting dynamic subtest: render
[451.895062] Dynamic subtest render: SUCCESS (0.083s)
[451.908163] Starting dynamic subtest: bsd1
[451.958628] Dynamic subtest bsd1: SUCCESS (0.061s)
[451.971067] Starting dynamic subtest: bsd2
[452.014812] Dynamic subtest bsd2: SUCCESS (0.053s)
[452.026705] Starting dynamic subtest: blt
[452.079553] Dynamic subtest blt: SUCCESS (0.063s)
[452.093520] Starting dynamic subtest: vebox
[452.137814] Dynamic subtest vebox: SUCCESS (0.055s)
[452.140654] Subtest legacy-engines-mixed: SUCCESS (0.328s)
[452.236579] [125/156] (572s left) perf (gen8-unprivileged-single-ctx-counters)
[452.347380] Starting subtest: gen8-unprivileged-single-ctx-counters
[452.352126] Subtest gen8-unprivileged-single-ctx-counters: SKIP (0.000s)
[452.404790] [126/156] (572s left) kms_frontbuffer_tracking (hdr-2p-primscrn-pri-indfb-draw-pwrite)
[452.501845] Starting subtest: hdr-2p-primscrn-pri-indfb-draw-pwrite
[452.505330] Subtest hdr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[452.610734] [127/156] (572s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite)
[452.700486] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite
[459.619320] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.923s)
[459.733266] [128/156] (565s left) gem_mmap_gtt (basic-read-write-distinct)
[459.795878] Subtest basic-read-write-distinct: SKIP (0.000s)
[459.855385] [129/156] (565s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-cur-indfb-draw-pwrite)
[459.961536] Starting subtest: fbcpsrhdr-1p-primscrn-cur-indfb-draw-pwrite
[459.965592] Subtest fbcpsrhdr-1p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[460.071675] [130/156] (565s left) gem_mmap_offset (mmap-unmap)
[460.123271] Starting subtest: mmap-unmap
[460.125202] Starting dynamic subtest: smem0
[484.271088] Dynamic subtest smem0: SUCCESS (24.096s)
[484.273641] Subtest mmap-unmap: SUCCESS (24.098s)
[484.340436] [131/156] (540s left) kms_cursor_legacy (basic-busy-flip-before-cursor-varying-size)
[484.464430] Starting subtest: basic-busy-flip-before-cursor-varying-size
[484.469063] Subtest basic-busy-flip-before-cursor-varying-size: SKIP (0.000s)
[484.611789] [132/156] (540s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-upscaling)
[484.715212] Starting subtest: flip-64bpp-linear-to-32bpp-linear-upscaling
[484.717494] Starting dynamic subtest: pipe-A-default-mode
[487.407513] Dynamic subtest pipe-A-default-mode: SUCCESS (2.690s)
[487.409770] Subtest flip-64bpp-linear-to-32bpp-linear-upscaling: SUCCESS (2.692s)
[488.280768] [133/156] (537s left) i915_drm_fdinfo (all-busy-check-all)
[488.329484] Starting subtest: all-busy-check-all
[488.333813] Subtest all-busy-check-all: SKIP (0.004s)
[488.410726] [134/156] (536s left) syncobj_timeline (multi-wait-available-signaled)
[488.507672] Starting subtest: multi-wait-available-signaled
[488.510199] Subtest multi-wait-available-signaled: SUCCESS (0.000s)
[488.609871] [135/156] (536s left) gem_mmap_gtt (basic-small-bo-tiledx)
[488.672054] Subtest basic-small-bo-tiledX: SKIP (0.000s)
[488.739176] [136/156] (536s left) kms_psr (psr2-no-drrs)
[488.839856] Starting subtest: psr2-no-drrs
[488.842129] Starting dynamic subtest: eDP-1
[490.446480] Dynamic subtest eDP-1: SUCCESS (1.606s)
[490.448819] Subtest psr2-no-drrs: SUCCESS (1.607s)
[491.328388] [137/156] (534s left) gem_userptr_blits (create-destroy-unsync)
[491.392033] Subtest create-destroy-unsync: SKIP (0.000s)
[491.505798] [138/156] (533s left) gem_exec_parallel (fds)
[491.559714] Starting subtest: fds
[491.562087] Starting dynamic subtest: rcs0
[494.206252] Dynamic subtest rcs0: SUCCESS (2.645s)
[494.218516] Starting dynamic subtest: bcs0
[498.112952] Dynamic subtest bcs0: SUCCESS (3.903s)
[498.124082] Starting dynamic subtest: vcs0
[501.529497] Dynamic subtest vcs0: SUCCESS (3.414s)
[501.541101] Starting dynamic subtest: vcs1
[505.529775] Dynamic subtest vcs1: SUCCESS (3.997s)
[505.545632] Starting dynamic subtest: vecs0
[509.520366] Dynamic subtest vecs0: SUCCESS (3.988s)
[509.531977] Starting dynamic subtest: ccs0
[513.596418] Dynamic subtest ccs0: SUCCESS (4.074s)
[513.599033] Subtest fds: SUCCESS (22.036s)
[513.808411] [139/156] (511s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-indfb-msflip-blt)
[513.924919] Starting subtest: fbcpsrhdr-2p-scndscrn-indfb-msflip-blt
[513.929870] Subtest fbcpsrhdr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[514.027713] [140/156] (511s left) kms_ccs (crc-sprite-planes-basic-y-tiled-ccs)
[514.117807] Starting subtest: crc-sprite-planes-basic-y-tiled-ccs
[514.120127] Starting dynamic subtest: pipe-A-eDP-1
[514.175570] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[514.186425] Starting dynamic subtest: pipe-B-eDP-1
[514.244127] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[514.255894] Starting dynamic subtest: pipe-C-eDP-1
[514.313232] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[514.324582] Starting dynamic subtest: pipe-D-eDP-1
[514.381758] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[514.386250] Subtest crc-sprite-planes-basic-y-tiled-ccs: SKIP (0.010s)
[516.396960] [141/156] (509s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[516.501175] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[516.505696] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[516.607379] [142/156] (509s left) perf_pmu (semaphore-busy)
[516.661144] Starting subtest: semaphore-busy
[516.663578] Starting dynamic subtest: rcs0
[518.284123] Dynamic subtest rcs0: SUCCESS (1.621s)
[518.295807] Starting dynamic subtest: bcs0
[519.913778] Dynamic subtest bcs0: SUCCESS (1.626s)
[519.926715] Starting dynamic subtest: vcs0
[523.772445] Dynamic subtest vcs0: SUCCESS (3.854s)
[523.783505] Starting dynamic subtest: vcs1
[529.837689] Dynamic subtest vcs1: SUCCESS (6.013s)
[529.850168] Starting dynamic subtest: vecs0
[535.802080] Dynamic subtest vecs0: SUCCESS (6.011s)
[535.815489] Starting dynamic subtest: ccs0
[538.878458] Dynamic subtest ccs0: SUCCESS (3.073s)
[538.881077] Subtest semaphore-busy: SUCCESS (22.215s)
[538.996376] [143/156] (486s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-pwrite)
[539.097252] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-pwrite
[539.101165] Subtest fbc-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[539.188762] [144/156] (486s left) gem_ctx_shared (q-promotion)
[539.254597] Starting subtest: Q-promotion
[539.256906] Starting dynamic subtest: rcs0
[539.374398] Dynamic subtest rcs0: SUCCESS (0.118s)
[539.386609] Starting dynamic subtest: vcs0
[539.475709] Dynamic subtest vcs0: SUCCESS (0.101s)
[539.488141] Starting dynamic subtest: vcs1
[539.572086] Dynamic subtest vcs1: SUCCESS (0.095s)
[539.591869] Starting dynamic subtest: vecs0
[539.656015] Dynamic subtest vecs0: SUCCESS (0.082s)
[539.672715] Starting dynamic subtest: ccs0
[539.746845] Dynamic subtest ccs0: SUCCESS (0.090s)
[539.749727] Subtest Q-promotion: SUCCESS (0.493s)
[541.416136] [145/156] (484s left) kms_big_fb (yf-tiled-addfb-size-offset-overflow)
[541.517411] Starting subtest: yf-tiled-addfb-size-offset-overflow
[541.521949] Subtest yf-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[541.619227] [146/156] (484s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-cpu)
[541.715125] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-cpu
[541.719508] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[541.814754] [147/156] (484s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[541.914734] Starting subtest: hdr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[541.918788] Subtest hdr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[542.016622] [148/156] (483s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-cur-indfb-move)
[542.118883] Starting subtest: psrhdr-2p-scndscrn-cur-indfb-move
[542.123114] Subtest psrhdr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[542.220922] [149/156] (483s left) perf_pmu (busy-check-all)
[542.258818] Starting subtest: busy-check-all
[542.260906] Starting dynamic subtest: rcs0
[542.813883] Dynamic subtest rcs0: SUCCESS (0.556s)
[542.827914] Starting dynamic subtest: bcs0
[543.364976] Dynamic subtest bcs0: SUCCESS (0.549s)
[543.378271] Starting dynamic subtest: vcs0
[545.280186] Dynamic subtest vcs0: SUCCESS (1.911s)
[545.293841] Starting dynamic subtest: vcs1
[547.328328] Dynamic subtest vcs1: SUCCESS (2.045s)
[547.342431] Starting dynamic subtest: vecs0
[549.312233] Dynamic subtest vecs0: SUCCESS (1.981s)
[549.325824] Starting dynamic subtest: ccs0
[549.868360] Dynamic subtest ccs0: SUCCESS (0.555s)
[549.870882] Subtest busy-check-all: SUCCESS (7.612s)
[549.970986] [150/156] (476s left) i915_pm_rc6_residency (rc6-fence)
[550.018781] Starting subtest: rc6-fence
[550.043754] Starting dynamic subtest: gt0
[562.377585] Dynamic subtest gt0: SUCCESS (12.316s)
[562.389510] Starting dynamic subtest: gt1
[578.239508] Dynamic subtest gt1: SUCCESS (15.875s)
[578.242607] Subtest rc6-fence: SUCCESS (28.220s)
[578.388675] [151/156] (447s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-spr-indfb-draw-mmap-wc)
[578.492095] Starting subtest: psrhdr-2p-primscrn-spr-indfb-draw-mmap-wc
[578.496172] Subtest psrhdr-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[578.606521] [152/156] (447s left) gem_mmap_wc (write-gtt-read-wc)
[578.655096] Subtest write-gtt-read-wc: SKIP (0.000s)
[578.724702] [153/156] (447s left) kms_frontbuffer_tracking (fbchdr-1p-rte)
[578.826298] Starting subtest: fbchdr-1p-rte
[578.830422] Subtest fbchdr-1p-rte: SKIP (0.000s)
[578.936019] [154/156] (447s left) kms_psr_stress_test (invalidate-primary-flip-overlay)
[579.036089] Starting subtest: invalidate-primary-flip-overlay
[589.844455] Subtest invalidate-primary-flip-overlay: SUCCESS (10.810s)
[589.964075] [155/156] (436s left) sw_sync (sync_busy_fork_unixsocket)
[589.997141] Starting subtest: sync_busy_fork_unixsocket
[590.002842] Subtest sync_busy_fork_unixsocket: SUCCESS (0.007s)
[590.071968] [156/156] (436s left) kms_frontbuffer_tracking (hdr-1p-primscrn-indfb-plflip-blt)
[590.176945] Starting subtest: hdr-1p-primscrn-indfb-plflip-blt
[590.180491] Subtest hdr-1p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[590.279298] Closing watchdogs
results: parsing output: 0/ for test: kms_psr2_sf
results: parsing output: 1/ for test: kms_ccs
results: parsing output: 2/ for test: kms_cursor_legacy
results: parsing output: 3/ for test: kms_ccs
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: gem_exec_reloc
results: parsing output: 6/ for test: kms_frontbuffer_tracking
results: parsing output: 7/ for test: kms_plane
results: parsing output: 8/ for test: kms_pipe_crc_basic
results: parsing output: 9/ for test: tools_test
results: parsing output: 10/ for test: kms_feature_discovery
results: parsing output: 11/ for test: gem_exec_fence
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: kms_plane_scaling
results: parsing output: 14/ for test: gem_busy
results: parsing output: 15/ for test: kms_big_fb
results: parsing output: 16/ for test: kms_ccs
results: parsing output: 17/ for test: kms_chamelium_color
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: syncobj_timeline
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: gem_create
results: parsing output: 22/ for test: kms_chamelium_hpd
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: gem_pxp
results: parsing output: 26/ for test: kms_frontbuffer_tracking
results: parsing output: 27/ for test: kms_psr2_su
results: parsing output: 28/ for test: kms_cursor_legacy
results: parsing output: 29/ for test: kms_psr
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: kms_psr
results: parsing output: 32/ for test: gem_render_copy
results: parsing output: 33/ for test: gem_exec_capture
results: parsing output: 34/ for test: gem_exec_balancer
results: parsing output: 35/ for test: i915_query
results: parsing output: 36/ for test: syncobj_wait
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: kms_plane_scaling
results: parsing output: 39/ for test: gem_render_copy
results: parsing output: 40/ for test: gem_exec_schedule
results: parsing output: 41/ for test: core_setmaster
results: parsing output: 42/ for test: kms_big_fb
results: parsing output: 43/ for test: syncobj_timeline
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: kms_cursor_crc
results: parsing output: 46/ for test: api_intel_bb
results: parsing output: 47/ for test: kms_psr2_sf
results: parsing output: 48/ for test: kms_flip
results: parsing output: 49/ for test: kms_flip
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: gem_mmap_gtt
results: parsing output: 52/ for test: kms_invalid_mode
results: parsing output: 53/ for test: gem_exec_reloc
results: parsing output: 54/ for test: gen9_exec_parse
results: parsing output: 55/ for test: gem_exec_params
results: parsing output: 56/ for test: gem_vm_create
results: parsing output: 57/ for test: perf
results: parsing output: 58/ for test: kms_frontbuffer_tracking
results: parsing output: 59/ for test: api_intel_allocator
results: parsing output: 60/ for test: kms_flip
results: parsing output: 61/ for test: syncobj_basic
results: parsing output: 62/ for test: gem_exec_reloc
results: parsing output: 63/ for test: gem_mmap_wc
results: parsing output: 64/ for test: kms_big_fb
results: parsing output: 65/ for test: gem_softpin
results: parsing output: 66/ for test: gem_render_copy
results: parsing output: 67/ for test: gem_ctx_persistence
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: kms_flip_scaled_crc
results: parsing output: 70/ for test: kms_color
results: parsing output: 71/ for test: kms_cursor_crc
results: parsing output: 72/ for test: kms_getfb
results: parsing output: 73/ for test: kms_flip
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: syncobj_eventfd
results: parsing output: 77/ for test: syncobj_wait
results: parsing output: 78/ for test: kms_content_protection
results: parsing output: 79/ for test: kms_pm_rpm
results: parsing output: 80/ for test: kms_plane_alpha_blend
results: parsing output: 81/ for test: gem_spin_batch
results: parsing output: 82/ for test: i915_hangman
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: gem_exec_schedule
results: parsing output: 85/ for test: kms_big_fb
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_cursor_legacy
results: parsing output: 88/ for test: kms_big_fb
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: kms_getfb
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_psr
results: parsing output: 94/ for test: kms_addfb_basic
results: parsing output: 95/ for test: kms_cursor_legacy
results: parsing output: 96/ for test: kms_pipe_b_c_ivb
results: parsing output: 97/ for test: prime_self_import
results: parsing output: 98/ for test: kms_chamelium_frames
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_big_fb
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_prime
results: parsing output: 106/ for test: kms_vblank
results: parsing output: 107/ for test: gem_gpgpu_fill
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: sysfs_preempt_timeout
results: parsing output: 110/ for test: gem_partial_pwrite_pread
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: syncobj_wait
results: parsing output: 113/ for test: kms_vblank
results: parsing output: 114/ for test: kms_cursor_legacy
results: parsing output: 115/ for test: gem_exec_whisper
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: kms_addfb_basic
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: kms_big_fb
results: parsing output: 120/ for test: kms_plane_multiple
results: parsing output: 121/ for test: gem_exec_gttfill
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: gem_ctx_persistence
results: parsing output: 124/ for test: perf
results: parsing output: 125/ for test: kms_frontbuffer_tracking
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: gem_mmap_gtt
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: gem_mmap_offset
results: parsing output: 130/ for test: kms_cursor_legacy
results: parsing output: 131/ for test: kms_flip_scaled_crc
results: parsing output: 132/ for test: i915_drm_fdinfo
results: parsing output: 133/ for test: syncobj_timeline
results: parsing output: 134/ for test: gem_mmap_gtt
results: parsing output: 135/ for test: kms_psr
results: parsing output: 136/ for test: gem_userptr_blits
results: parsing output: 137/ for test: gem_exec_parallel
results: parsing output: 138/ for test: kms_frontbuffer_tracking
results: parsing output: 139/ for test: kms_ccs
results: parsing output: 140/ for test: kms_frontbuffer_tracking
results: parsing output: 141/ for test: perf_pmu
results: parsing output: 142/ for test: kms_frontbuffer_tracking
results: parsing output: 143/ for test: gem_ctx_shared
results: parsing output: 144/ for test: kms_big_fb
results: parsing output: 145/ for test: kms_frontbuffer_tracking
results: parsing output: 146/ for test: kms_frontbuffer_tracking
results: parsing output: 147/ for test: kms_frontbuffer_tracking
results: parsing output: 148/ for test: perf_pmu
results: parsing output: 149/ for test: i915_pm_rc6_residency
results: parsing output: 150/ for test: kms_frontbuffer_tracking
results: parsing output: 151/ for test: gem_mmap_wc
results: parsing output: 152/ for test: kms_frontbuffer_tracking
results: parsing output: 153/ for test: kms_psr_stress_test
results: parsing output: 154/ for test: sw_sync
results: parsing output: 155/ for test: kms_frontbuffer_tracking
Done.