[63.616610] Initializing watchdogs
[63.616654]   /dev/watchdog0
[63.631146] [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]
[63.635563] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[63.637668] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[63.639870] [001/133] (960s left) gem_exec_balancer (parallel-keep-submit-fence)
[63.906484] Starting subtest: parallel-keep-submit-fence
[64.993866] Subtest parallel-keep-submit-fence: SUCCESS (1.087s)
[65.121587] [002/133] (959s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic)
[65.247353] Starting subtest: 2x-cursor-vs-flip-atomic
[65.257134] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.002s)
[65.390017] [003/133] (958s left) perf (gen8-unprivileged-single-ctx-counters)
[65.518706] Starting subtest: gen8-unprivileged-single-ctx-counters
[65.520399] Subtest gen8-unprivileged-single-ctx-counters: SKIP (0.000s)
[65.556694] [004/133] (958s left) gem_exec_whisper (basic-sync)
[65.626714] Starting subtest: basic-sync
[72.291643] Subtest basic-sync: SUCCESS (6.661s)
[72.479587] [005/133] (951s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-gtt)
[72.584202] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-gtt
[72.586044] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[72.678344] [006/133] (951s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[72.733763] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[72.734657] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[72.849596] [007/133] (951s left) api_intel_bb (reset-flags)
[72.895073] Starting subtest: reset-flags
[72.903208] Subtest reset-flags: SUCCESS (0.009s)
[73.060541] [008/133] (951s left) kms_ccs (bad-aux-stride-yf-tiled-ccs)
[73.150879] Starting subtest: bad-aux-stride-yf-tiled-ccs
[73.151844] Starting dynamic subtest: pipe-A-eDP-1
[73.160531] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[73.167020] Starting dynamic subtest: pipe-B-eDP-1
[73.175531] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[73.182540] Starting dynamic subtest: pipe-C-eDP-1
[73.190875] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[73.196234] Starting dynamic subtest: pipe-D-eDP-1
[73.204543] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[73.206144] Subtest bad-aux-stride-yf-tiled-ccs: SKIP (0.003s)
[75.387056] [009/133] (948s left) gem_tiled_partial_pwrite_pread (reads)
[75.445028] Subtest reads: SKIP (0.000s)
[75.507242] [010/133] (948s left) kms_joiner (basic-big-joiner)
[75.616714] Starting subtest: basic-big-joiner
[75.618455] Subtest basic-big-joiner: SKIP (0.000s)
[75.689693] [011/133] (948s left) gem_exec_schedule (deep)
[75.863385] Starting subtest: deep
[75.864561] Starting dynamic subtest: rcs0
[80.913528] Dynamic subtest rcs0: SKIP (5.046s)
[80.922448] Starting dynamic subtest: vcs0
[91.267810] Dynamic subtest vcs0: SUCCESS (10.354s)
[91.276518] Starting dynamic subtest: vcs1
[103.292450] Dynamic subtest vcs1: SUCCESS (12.023s)
[103.301995] Starting dynamic subtest: vecs0
[114.905242] Dynamic subtest vecs0: SUCCESS (11.612s)
[114.911838] Starting dynamic subtest: ccs0
[126.888503] Dynamic subtest ccs0: SUCCESS (11.984s)
[126.890123] Subtest deep: SUCCESS (51.021s)
[127.999861] [FACT gem_exec_schedule (deep)] new: kernel.kmod_is_loaded.vgem: true
[128.001665] [012/133] (896s left) kms_rotation_crc (primary-yf-tiled-reflect-x-180)
[128.089959] Starting subtest: primary-yf-tiled-reflect-x-180
[128.149977] Subtest primary-yf-tiled-reflect-x-180: SKIP (0.060s)
[128.257218] [013/133] (896s left) gem_spin_batch (spin-each)
[128.325293] Starting subtest: spin-each
[131.681743] Subtest spin-each: SUCCESS (3.356s)
[131.981112] [014/133] (892s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-16bpp-4tile-upscaling)
[132.096064] Starting subtest: flip-64bpp-4tile-to-16bpp-4tile-upscaling
[132.097084] Starting dynamic subtest: pipe-A-default-mode
[134.851782] Dynamic subtest pipe-A-default-mode: SUCCESS (2.754s)
[134.852816] Subtest flip-64bpp-4tile-to-16bpp-4tile-upscaling: SUCCESS (2.755s)
[135.689546] [015/133] (888s left) gem_mmap_gtt (cpuset-big-copy-xy)
[135.748200] Subtest cpuset-big-copy-XY: SKIP (0.000s)
[135.807397] [016/133] (888s left) gem_softpin (evict-snoop)
[135.858424] Starting subtest: evict-snoop
[135.860278] Subtest evict-snoop: SKIP (0.000s)
[136.001018] [017/133] (888s left) kms_selftest (drm_format_helper)
[136.035799] Starting subtest: drm_format_helper
[136.078161] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8
[136.251939] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_gray8: SUCCESS (0.174s)
[136.260055] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332
[136.376540] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb332: SUCCESS (0.123s)
[136.384038] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565
[136.512512] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb565: SUCCESS (0.135s)
[136.520021] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555
[136.654495] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb1555: SUCCESS (0.141s)
[136.662247] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555
[136.788752] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb1555: SUCCESS (0.134s)
[136.796087] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551
[136.935658] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgba5551: SUCCESS (0.146s)
[136.943169] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888
[137.094552] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_rgb888: SUCCESS (0.158s)
[137.102425] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888
[137.244421] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_bgr888: SUCCESS (0.150s)
[137.252317] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888
[137.392565] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb8888: SUCCESS (0.149s)
[137.400846] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010
[137.514376] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xrgb2101010: SUCCESS (0.120s)
[137.522429] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010
[137.635486] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_argb2101010: SUCCESS (0.122s)
[137.642243] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_mono
[137.751288] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_mono: SUCCESS (0.113s)
[137.757876] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_swab
[137.828974] Dynamic subtest drm_format_helper_test-drm_test_fb_swab: SUCCESS (0.079s)
[137.836832] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888
[137.949181] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_xbgr8888: SUCCESS (0.120s)
[137.955157] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888
[138.111124] Dynamic subtest drm_format_helper_test-drm_test_fb_xrgb8888_to_abgr8888: SUCCESS (0.160s)
[138.117152] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_clip_offset
[138.264165] Dynamic subtest drm_format_helper_test-drm_test_fb_clip_offset: SUCCESS (0.154s)
[138.270148] Starting dynamic subtest: drm_format_helper_test-drm_test_fb_memcpy
[138.396511] Dynamic subtest drm_format_helper_test-drm_test_fb_memcpy: SUCCESS (0.132s)
[138.397594] Subtest drm_format_helper: SUCCESS (2.361s)
[138.615430] [018/133] (886s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[138.716926] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[138.717912] Starting dynamic subtest: pipe-A-eDP-1
[138.740038] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.023s)
[138.746908] Starting dynamic subtest: pipe-B-eDP-1
[138.761056] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.020s)
[138.767495] Starting dynamic subtest: pipe-C-eDP-1
[138.781468] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.020s)
[138.787844] Starting dynamic subtest: pipe-D-eDP-1
[138.804955] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.023s)
[138.805759] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SUCCESS (0.088s)
[140.963289] [019/133] (883s left) syncobj_wait (single-wait-submitted)
[141.018311] Starting subtest: single-wait-submitted
[141.124559] Subtest single-wait-submitted: SUCCESS (0.104s)
[141.202757] [020/133] (883s left) kms_vrr (flip-dpms)
[141.290266] Starting subtest: flip-dpms
[141.292830] Subtest flip-dpms: SKIP (0.000s)
[141.379569] [021/133] (883s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[141.471757] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[141.473616] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[141.590329] [022/133] (883s left) gem_workarounds (suspend-resume)
[141.647993] Starting subtest: suspend-resume
[157.595898] Subtest suspend-resume: SUCCESS (1.692s)
[165.755883] [023/133] (867s left) vgem_basic (dmabuf-fence)
[165.801500] Starting subtest: dmabuf-fence
[165.802365] Subtest dmabuf-fence: SUCCESS (0.000s)
[165.864801] [024/133] (866s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-plflip-blt)
[165.950745] Starting subtest: fbcpsr-2p-primscrn-indfb-plflip-blt
[165.952332] Subtest fbcpsr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[166.072923] [025/133] (866s left) kms_cursor_crc (cursor-size-change)
[166.168534] Starting subtest: cursor-size-change
[166.169581] Starting dynamic subtest: pipe-A-eDP-1
[166.995160] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.823s)
[167.002969] Starting dynamic subtest: pipe-D-eDP-1
[168.442373] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.434s)
[168.443292] Subtest cursor-size-change: SUCCESS (2.259s)
[169.269261] [026/133] (863s left) kms_rotation_crc (cursor-rotation-180)
[169.369289] Starting subtest: cursor-rotation-180
[170.829723] Subtest cursor-rotation-180: SUCCESS (1.452s)
[172.058147] [027/133] (860s left) kms_pm_rpm (modeset-lpsp-stress-no-wait)
[174.301886] Starting subtest: modeset-lpsp-stress-no-wait
[183.926342] Subtest modeset-lpsp-stress-no-wait: SUCCESS (9.606s)
[184.014124] [028/133] (848s left) kms_big_fb (4-tiled-64bpp-rotate-180)
[184.106233] Starting subtest: 4-tiled-64bpp-rotate-180
[185.719497] Subtest 4-tiled-64bpp-rotate-180: SUCCESS (1.612s)
[185.882300] [029/133] (847s left) kms_psr (pr-dpms)
[185.973838] Starting subtest: pr-dpms
[185.975642] Subtest pr-dpms: SKIP (0.000s)
[186.059861] [030/133] (847s left) dmabuf_sync_file (import-basic)
[186.098435] Starting subtest: import-basic
[186.099429] Subtest import-basic: SUCCESS (0.001s)
[186.162543] [031/133] (846s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-gtt)
[186.266726] Starting subtest: fbcpsr-rgb101010-draw-mmap-gtt
[186.268436] Subtest fbcpsr-rgb101010-draw-mmap-gtt: SKIP (0.000s)
[186.394892] [032/133] (846s left) kms_dirtyfb (psr-dirtyfb-ioctl)
[186.480820] Starting subtest: psr-dirtyfb-ioctl
[186.481830] Starting dynamic subtest: A-eDP-1
[190.307692] Dynamic subtest A-eDP-1: SUCCESS (3.822s)
[190.308559] Subtest psr-dirtyfb-ioctl: SUCCESS (3.823s)
[191.108010] [033/133] (842s left) kms_flip (dpms-vs-vblank-race)
[191.219945] Starting subtest: dpms-vs-vblank-race
[191.224526] Starting dynamic subtest: A-eDP1
[196.220348] Dynamic subtest A-eDP1: SUCCESS (4.991s)
[196.228202] Starting dynamic subtest: B-eDP1
[200.842580] Dynamic subtest B-eDP1: SUCCESS (4.622s)
[200.850222] Starting dynamic subtest: C-eDP1
[205.460418] Dynamic subtest C-eDP1: SUCCESS (4.616s)
[205.468257] Starting dynamic subtest: D-eDP1
[210.092685] Dynamic subtest D-eDP1: SUCCESS (4.633s)
[210.094708] Subtest dpms-vs-vblank-race: SUCCESS (18.872s)
[210.981713] [034/133] (822s left) kms_content_protection (atomic-hdcp14)
[211.125244] Starting subtest: atomic-hdcp14
[211.127417] Subtest atomic-hdcp14: SKIP (0.000s)
[211.276623] [035/133] (821s left) i915_pm_rpm (sysfs-read)
[213.401844] Starting subtest: sysfs-read
[214.556976] Subtest sysfs-read: SUCCESS (1.153s)
[214.942974] [036/133] (818s left) perf_pmu (module-unload)
[215.041780] Starting subtest: module-unload
[223.392542] Subtest module-unload: FAIL (8.314s)
[223.412534] [FACT perf_pmu (module-unload)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[223.413229] [FACT perf_pmu (module-unload)] deleted: kernel.kmod_is_loaded.i915: true
[223.414734] [037/133] (809s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[224.891629] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-wc
[224.893358] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[224.971427] [FACT kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-wc)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[224.973165] [FACT kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-wc)] new: kernel.kmod_is_loaded.i915: true
[224.975422] [038/133] (808s left) gem_bad_reloc (negative-reloc-lut)
[225.032986] Subtest negative-reloc-lut: SKIP (0.000s)
[225.093321] [039/133] (808s left) gem_ctx_bad_destroy (double-destroy)
[225.145145] Starting subtest: double-destroy
[225.146184] Subtest double-destroy: SUCCESS (0.000s)
[225.216125] [040/133] (808s left) kms_atomic (plane-invalid-params-fence)
[225.312669] Starting subtest: plane-invalid-params-fence
[225.313549] Starting dynamic subtest: pipe-A-eDP-1
[225.694998] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.382s)
[225.695979] Subtest plane-invalid-params-fence: SUCCESS (0.383s)
[226.588278] [041/133] (806s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0)
[226.703356] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0
[227.737484] Subtest x-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.034s)
[227.870108] [042/133] (805s left) kms_psr2_su (frontbuffer-xrgb8888)
[227.932314] Subtest frontbuffer-XRGB8888: SKIP (0.000s)
[227.998914] [043/133] (805s left) gem_userptr_blits (vma-merge)
[228.077865] Starting subtest: vma-merge
[228.118529] Subtest vma-merge: SUCCESS (0.040s)
[228.284240] [044/133] (805s left) gem_exec_whisper (basic-contexts-priority)
[228.350692] Starting subtest: basic-contexts-priority
[251.922113] Subtest basic-contexts-priority: SUCCESS (23.560s)
[252.114243] [045/133] (781s left) gem_exec_flush (basic-wb-set-default)
[252.168285] Starting subtest: basic-wb-set-default
[257.624647] Subtest basic-wb-set-default: SUCCESS (5.454s)
[257.817364] [046/133] (775s left) syncobj_timeline (multi-wait-all-available-submitted)
[257.874241] Starting subtest: multi-wait-all-available-submitted
[257.875349] Subtest multi-wait-all-available-submitted: SUCCESS (0.000s)
[257.990302] [047/133] (775s left) gem_partial_pwrite_pread (writes-after-reads-uncached)
[258.034369] Subtest writes-after-reads-uncached: SKIP (0.000s)
[258.120115] [048/133] (775s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc)
[258.215120] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc
[264.779424] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (6.564s)
[264.908256] [049/133] (768s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[265.005172] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt
[265.006917] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[265.117499] [050/133] (768s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[265.210048] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu
[272.201868] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (6.996s)
[272.329586] [051/133] (761s left) gem_ccs (ctrl-surf-copy-new-ctx)
[272.391210] Starting subtest: ctrl-surf-copy-new-ctx
[272.393201] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s)
[272.507356] [052/133] (761s left) gem_exec_reloc (basic-write-cpu)
[272.571620] Subtest basic-write-cpu: SKIP (0.000s)
[272.635739] [053/133] (761s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180)
[272.730821] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180
[272.732659] Subtest y-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s)
[272.854323] [054/133] (761s left) gem_exec_fence (syncobj-signal)
[273.327899] Starting subtest: syncobj-signal
[273.330834] Subtest syncobj-signal: SUCCESS (0.005s)
[275.264160] [055/133] (758s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-plflip-blt)
[275.373743] Starting subtest: psr-2p-primscrn-shrfb-plflip-blt
[275.375453] Subtest psr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[275.498367] [056/133] (758s left) kms_psr (psr2-sprite-blt)
[275.578467] Starting subtest: psr2-sprite-blt
[275.579378] Starting dynamic subtest: eDP-1
[277.307852] Dynamic subtest eDP-1: SUCCESS (1.728s)
[277.308816] Subtest psr2-sprite-blt: SUCCESS (1.729s)
[278.180429] [057/133] (755s left) gem_exec_alignment (forked)
[278.243269] Starting subtest: forked
[316.188142] Subtest forked: SUCCESS (37.941s)
[316.280990] [058/133] (717s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[316.405166] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[316.407075] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[316.530423] [059/133] (717s left) gem_exec_reloc (basic-cpu-active)
[316.589238] Subtest basic-cpu-active: SKIP (0.000s)
[316.673987] [060/133] (717s left) kms_frontbuffer_tracking (fbcpsr-abgr161616f-draw-mmap-wc)
[316.781951] Starting subtest: fbcpsr-abgr161616f-draw-mmap-wc
[316.783691] Subtest fbcpsr-abgr161616f-draw-mmap-wc: SKIP (0.000s)
[316.907157] [061/133] (717s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-render)
[317.003974] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-render
[324.246358] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.242s)
[324.411156] [062/133] (709s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-submitted-signal
[324.478154] Starting subtest: etime-multi-wait-all-available-unsubmitted-submitted-signaled
[324.587759] Subtest etime-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.107s)
[324.675091] [063/133] (709s left) gem_render_copy (x-tiled-to-vebox-yf-tiled)
[324.741855] Starting subtest: x-tiled-to-vebox-yf-tiled
[324.743634] Subtest x-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[324.933393] [064/133] (709s left) kms_plane_cursor (viewport)
[325.021861] Starting subtest: viewport
[325.023650] Starting dynamic subtest: pipe-A-eDP-1-size-64
[327.521011] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.498s)
[327.582212] Starting dynamic subtest: pipe-A-eDP-1-size-128
[329.989728] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.415s)
[330.053323] Starting dynamic subtest: pipe-A-eDP-1-size-256
[332.489375] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.449s)
[332.840423] Starting dynamic subtest: pipe-B-eDP-1-size-64
[335.967943] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.135s)
[336.029994] Starting dynamic subtest: pipe-B-eDP-1-size-128
[338.481408] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.460s)
[338.542465] Starting dynamic subtest: pipe-B-eDP-1-size-256
[341.027443] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.494s)
[341.375351] Starting dynamic subtest: pipe-C-eDP-1-size-64
[344.119880] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.754s)
[344.159767] Starting dynamic subtest: pipe-C-eDP-1-size-128
[346.275885] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.125s)
[346.316612] Starting dynamic subtest: pipe-C-eDP-1-size-256
[348.398543] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.091s)
[348.724085] Starting dynamic subtest: pipe-D-eDP-1-size-64
[351.583626] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.867s)
[351.622451] Starting dynamic subtest: pipe-D-eDP-1-size-128
[353.628853] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.014s)
[353.666876] Starting dynamic subtest: pipe-D-eDP-1-size-256
[355.751436] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.091s)
[356.068477] Subtest viewport: SUCCESS (31.039s)
[356.928252] [065/133] (677s left) prime_vgem (basic-read)
[357.007537] Starting subtest: basic-read
[357.028502] Subtest basic-read: SKIP (0.020s)
[357.154007] [066/133] (677s left) kms_pm_backlight (fade-with-suspend)
[357.240677] Starting subtest: fade-with-suspend
[373.593068] Starting dynamic subtest: eDP-1
[376.254522] Dynamic subtest eDP-1: SUCCESS (2.664s)
[376.255644] Subtest fade-with-suspend: SUCCESS (4.310s)
[381.100674] [067/133] (657s left) kms_fbcon_fbt (fbc)
[381.174102] Starting subtest: fbc
[387.518750] Subtest fbc: SUCCESS (6.306s)
[388.615525] [068/133] (649s left) gem_mmap_offset (pf-nonblock)
[388.677580] Starting subtest: pf-nonblock
[388.682327] Subtest pf-nonblock: SUCCESS (0.006s)
[388.834444] [069/133] (649s left) gem_eio (wait-10ms)
[389.076560] Starting subtest: wait-10ms
[389.440370] Subtest wait-10ms: SUCCESS (0.363s)
[389.623411] [070/133] (648s left) i915_suspend (fence-restore-untiled)
[389.681107] Starting subtest: fence-restore-untiled
[389.683865] Subtest fence-restore-untiled: SKIP (0.000s)
[389.796790] [071/133] (648s left) kms_cursor_crc (cursor-rapid-movement-512x512)
[390.099667] Starting subtest: cursor-rapid-movement-512x512
[390.101759] Subtest cursor-rapid-movement-512x512: SKIP (0.001s)
[390.291464] [072/133] (648s left) kms_plane_scaling (plane-downscale-factor-0-5-with-rotation)
[390.379579] Starting subtest: plane-downscale-factor-0-5-with-rotation
[390.380875] Starting dynamic subtest: pipe-A
[390.396220] Dynamic subtest pipe-A: SKIP (0.015s)
[390.405217] Starting dynamic subtest: pipe-B
[390.423004] Dynamic subtest pipe-B: SKIP (0.027s)
[390.431813] Starting dynamic subtest: pipe-C
[390.451049] Dynamic subtest pipe-C: SKIP (0.027s)
[390.459774] Starting dynamic subtest: pipe-D
[390.477755] Dynamic subtest pipe-D: SKIP (0.027s)
[390.479378] Subtest plane-downscale-factor-0-5-with-rotation: SKIP (0.098s)
[390.595324] [073/133] (647s left) kms_atomic_transition (plane-all-modeset-transition)
[390.697132] Starting subtest: plane-all-modeset-transition
[390.699438] Subtest plane-all-modeset-transition: SKIP (0.000s)
[390.780630] [074/133] (647s left) kms_properties (colorop-properties-atomic)
[390.878251] Starting subtest: colorop-properties-atomic
[390.879641] Starting dynamic subtest: pipe-A-eDP-1
[391.219393] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.339s)
[391.228954] Starting dynamic subtest: pipe-B-eDP-1
[392.315524] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.090s)
[392.326494] Starting dynamic subtest: pipe-C-eDP-1
[393.337953] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.020s)
[393.347723] Starting dynamic subtest: pipe-D-eDP-1
[394.371669] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.031s)
[394.372637] Subtest colorop-properties-atomic: SUCCESS (3.485s)
[395.178494] [075/133] (643s left) kms_chamelium_frames (hdmi-cmp-planar-formats)
[395.561177] Subtest hdmi-cmp-planar-formats: SKIP (0.000s)
[396.381044] [076/133] (642s left) i915_pciid
[396.536267] [077/133] (642s left) kms_chamelium_audio (dp-audio)
[396.915758] Subtest dp-audio: SKIP (0.000s)
[397.715816] [078/133] (641s left) kms_psr (fbc-psr2-sprite-mmap-cpu)
[397.803108] Starting subtest: fbc-psr2-sprite-mmap-cpu
[397.804478] Starting dynamic subtest: eDP-1
[397.806568] Dynamic subtest eDP-1: SKIP (0.000s)
[397.808452] Subtest fbc-psr2-sprite-mmap-cpu: SKIP (0.001s)
[397.883059] [079/133] (640s left) perf (invalid-oa-format-id)
[398.013496] Starting subtest: invalid-oa-format-id
[398.025242] Subtest invalid-oa-format-id: SUCCESS (0.011s)
[398.066039] [080/133] (640s left) kms_psr (fbc-psr-no-drrs)
[398.161640] Starting subtest: fbc-psr-no-drrs
[398.162845] Starting dynamic subtest: eDP-1
[398.165415] Dynamic subtest eDP-1: SKIP (0.000s)
[398.167648] Subtest fbc-psr-no-drrs: SKIP (0.003s)
[398.245097] [081/133] (640s left) gem_mmap_gtt (flink-race)
[398.304107] Subtest flink-race: SKIP (0.000s)
[398.366545] [082/133] (640s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-downscaling)
[398.461069] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-downscaling
[398.462105] Starting dynamic subtest: pipe-A-default-mode
[398.749650] Dynamic subtest pipe-A-default-mode: SKIP (0.286s)
[398.751275] Subtest flip-64bpp-ytile-to-32bpp-ytile-downscaling: SKIP (0.288s)
[399.582842] [083/133] (639s left) kms_plane_scaling (plane-upscale-20x20-with-modifiers)
[399.680578] Starting subtest: plane-upscale-20x20-with-modifiers
[399.681774] Starting dynamic subtest: pipe-A
[400.028904] Dynamic subtest pipe-A: SUCCESS (0.349s)
[400.037654] Starting dynamic subtest: pipe-B
[401.475395] Dynamic subtest pipe-B: SUCCESS (1.444s)
[401.484526] Starting dynamic subtest: pipe-C
[402.909992] Dynamic subtest pipe-C: SUCCESS (1.432s)
[402.920812] Starting dynamic subtest: pipe-D
[404.348465] Dynamic subtest pipe-D: SUCCESS (1.435s)
[404.349503] Subtest plane-upscale-20x20-with-modifiers: SUCCESS (4.665s)
[405.527146] [084/133] (633s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-onoff)
[405.632199] Starting subtest: fbc-2p-scndscrn-cur-indfb-onoff
[405.634441] Subtest fbc-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[405.733557] [085/133] (633s left) kms_getfb (getfb-repeated-different-handles)
[405.834398] Starting subtest: getfb-repeated-different-handles
[405.835693] Subtest getfb-repeated-different-handles: SUCCESS (0.000s)
[405.972596] [086/133] (633s left) gem_exec_schedule (u-independent)
[406.039099] Starting subtest: u-independent
[406.040637] Starting dynamic subtest: rcs0
[407.862881] Dynamic subtest rcs0: SUCCESS (1.825s)
[407.873930] Starting dynamic subtest: vcs0
[409.885296] Dynamic subtest vcs0: SUCCESS (2.018s)
[409.908568] Starting dynamic subtest: vcs1
[411.860026] Dynamic subtest vcs1: SUCCESS (1.972s)
[411.871939] Starting dynamic subtest: vecs0
[413.916079] Dynamic subtest vecs0: SUCCESS (2.051s)
[413.926778] Starting dynamic subtest: ccs0
[415.864032] Dynamic subtest ccs0: SUCCESS (1.947s)
[415.865892] Subtest u-independent: SUCCESS (9.825s)
[416.173975] [087/133] (622s left) kms_ccs (crc-primary-rotation-180-4-tiled-bmg-ccs)
[416.278707] Starting subtest: crc-primary-rotation-180-4-tiled-bmg-ccs
[416.280779] Subtest crc-primary-rotation-180-4-tiled-bmg-ccs: SKIP (0.000s)
[417.370488] [088/133] (621s left) kms_chamelium_hpd (vga-hpd-after-suspend)
[417.757971] Subtest vga-hpd-after-suspend: SKIP (0.000s)
[418.583297] [089/133] (620s left) template (b)
[418.637367] Starting subtest: B
[418.639064] Subtest B: SUCCESS (0.000s)
[418.762463] [090/133] (620s left) i915_drm_fdinfo (memory-info-shared)
[418.799604] Starting subtest: memory-info-shared
[418.800943] Starting dynamic subtest: smem0
[418.866039] Dynamic subtest smem0: SUCCESS (0.067s)
[418.867594] Subtest memory-info-shared: SUCCESS (0.067s)
[418.946052] [091/133] (620s left) gem_exec_reloc (basic-wc-gtt)
[419.005787] Subtest basic-wc-gtt: SKIP (0.000s)
[419.095951] [092/133] (620s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted)
[419.152536] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted
[419.153730] Subtest multi-wait-for-submit-available-unsubmitted-submitted: SUCCESS (0.000s)
[419.274904] [093/133] (620s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)
[419.364053] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-cpu
[419.366366] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[419.481940] [094/133] (619s left) kms_frontbuffer_tracking (fbc-rgb565-draw-pwrite)
[419.579123] Starting subtest: fbc-rgb565-draw-pwrite
[424.174007] Subtest fbc-rgb565-draw-pwrite: SUCCESS (4.597s)
[425.304253] [095/133] (614s left) syncobj_wait (single-wait-all-signaled)
[425.373013] Starting subtest: single-wait-all-signaled
[425.374466] Subtest single-wait-all-signaled: SUCCESS (0.000s)
[425.482524] [096/133] (613s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[425.582562] Subtest addfb25-x-tiled-legacy: SKIP (0.000s)
[425.701450] [097/133] (613s left) kms_cursor_crc (cursor-offscreen-256x85)
[425.963006] Starting subtest: cursor-offscreen-256x85
[426.004658] Subtest cursor-offscreen-256x85: SKIP (0.038s)
[426.190890] [098/133] (613s left) kms_plane (pixel-format-linear-modifier)
[426.284095] Starting subtest: pixel-format-linear-modifier
[426.311848] Starting dynamic subtest: pipe-A-plane-0
[429.944730] Dynamic subtest pipe-A-plane-0: SUCCESS (3.633s)
[429.954012] Starting dynamic subtest: pipe-A-plane-3
[431.833408] Dynamic subtest pipe-A-plane-3: SUCCESS (1.888s)
[431.842523] Starting dynamic subtest: pipe-A-plane-5
[432.044620] Dynamic subtest pipe-A-plane-5: SUCCESS (0.210s)
[433.182750] Starting dynamic subtest: pipe-B-plane-0
[436.853212] Dynamic subtest pipe-B-plane-0: SUCCESS (3.678s)
[436.862183] Starting dynamic subtest: pipe-B-plane-3
[438.598208] Dynamic subtest pipe-B-plane-3: SUCCESS (1.744s)
[438.607532] Starting dynamic subtest: pipe-B-plane-5
[438.809368] Dynamic subtest pipe-B-plane-5: SUCCESS (0.211s)
[439.116201] Subtest pixel-format-linear-modifier: SUCCESS (12.831s)
[439.964859] [099/133] (599s left) syncobj_basic (bad-destroy-pad)
[440.026124] Starting subtest: bad-destroy-pad
[440.027132] Subtest bad-destroy-pad: SUCCESS (0.000s)
[440.142474] [100/133] (599s left) gem_ctx_isolation (dirty-switch)
[440.204382] Starting subtest: dirty-switch
[440.205403] Starting dynamic subtest: rcs0
[440.396389] Dynamic subtest rcs0: SUCCESS (0.191s)
[440.406459] Starting dynamic subtest: bcs0
[440.624315] Dynamic subtest bcs0: SUCCESS (0.227s)
[440.634120] Starting dynamic subtest: vcs0
[440.870651] Dynamic subtest vcs0: SUCCESS (0.246s)
[440.879664] Starting dynamic subtest: vcs1
[442.049967] Dynamic subtest vcs1: SUCCESS (1.178s)
[442.060479] Starting dynamic subtest: vecs0
[444.143418] Dynamic subtest vecs0: SUCCESS (2.092s)
[444.152359] Starting dynamic subtest: ccs0
[446.148233] Dynamic subtest ccs0: SUCCESS (2.003s)
[446.149992] Subtest dirty-switch: SUCCESS (5.942s)
[446.417161] [101/133] (593s left) kms_plane_lowres (tiling-none)
[446.514207] Starting subtest: tiling-none
[446.515586] Starting dynamic subtest: pipe-A-eDP-1
[446.517540] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[446.818865] Starting dynamic subtest: pipe-B-eDP-1
[446.821847] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[446.842397] Starting dynamic subtest: pipe-C-eDP-1
[446.845497] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[446.855884] Starting dynamic subtest: pipe-D-eDP-1
[446.858338] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[446.860814] Subtest tiling-none: SKIP (0.292s)
[447.694538] [102/133] (591s left) perf_pmu (busy-idle-no-semaphores)
[447.735739] Starting subtest: busy-idle-no-semaphores
[447.736842] Starting dynamic subtest: rcs0
[448.423974] Dynamic subtest rcs0: SUCCESS (0.685s)
[448.436341] Starting dynamic subtest: bcs0
[449.075099] Dynamic subtest bcs0: SUCCESS (0.649s)
[449.087621] Starting dynamic subtest: vcs0
[449.729487] Dynamic subtest vcs0: SUCCESS (0.651s)
[449.741946] Starting dynamic subtest: vcs1
[451.488525] Dynamic subtest vcs1: SUCCESS (1.756s)
[451.501264] Starting dynamic subtest: vecs0
[453.474105] Dynamic subtest vecs0: SUCCESS (1.982s)
[453.486229] Starting dynamic subtest: ccs0
[455.457383] Dynamic subtest ccs0: SUCCESS (1.980s)
[455.458850] Subtest busy-idle-no-semaphores: SUCCESS (7.719s)
[455.591383] [103/133] (584s left) kms_flip (blocking-absolute-wf_vblank)
[455.694101] Starting subtest: blocking-absolute-wf_vblank
[455.695671] Starting dynamic subtest: A-eDP1
[464.448770] Dynamic subtest A-eDP1: SUCCESS (8.750s)
[464.458982] Starting dynamic subtest: B-eDP1
[473.178442] Dynamic subtest B-eDP1: SUCCESS (8.725s)
[473.189787] Starting dynamic subtest: C-eDP1
[481.899499] Dynamic subtest C-eDP1: SUCCESS (8.718s)
[481.912398] Starting dynamic subtest: D-eDP1
[490.629188] Dynamic subtest D-eDP1: SUCCESS (8.730s)
[490.631524] Subtest blocking-absolute-wf_vblank: SUCCESS (34.934s)
[491.861894] [104/133] (547s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[491.961650] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[491.963485] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[492.086483] [105/133] (547s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-render)
[492.186358] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-render
[492.188113] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[492.302149] [106/133] (547s left) kms_frontbuffer_tracking (basic)
[492.400166] Starting subtest: basic
[495.556811] Subtest basic: SUCCESS (3.159s)
[495.682805] [107/133] (544s left) kms_getfb (getfb2-accept-nv12)
[495.780997] Starting subtest: getfb2-accept-nv12
[495.782008] Subtest getfb2-accept-nv12: SUCCESS (0.001s)
[495.907838] [108/133] (543s left) kms_scaling_modes (scaling-mode-full)
[496.011867] Starting subtest: scaling-mode-full
[496.012932] Starting dynamic subtest: pipe-A-eDP-1
[496.107792] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.096s)
[496.117959] Starting dynamic subtest: pipe-B-eDP-1
[497.277980] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.169s)
[497.288042] Starting dynamic subtest: pipe-C-eDP-1
[498.396826] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.117s)
[498.408771] Starting dynamic subtest: pipe-D-eDP-1
[499.531186] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.133s)
[499.532207] Subtest scaling-mode-full: SUCCESS (3.521s)
[500.708781] [109/133] (539s left) gem_ringfill (legacy-basic)
[506.875440] Starting subtest: legacy-basic
[506.876604] Starting dynamic subtest: default
[506.963173] Dynamic subtest default: SUCCESS (0.088s)
[506.981219] Starting dynamic subtest: render
[507.007454] Dynamic subtest render: SUCCESS (0.041s)
[507.019729] Starting dynamic subtest: bsd
[507.054655] Dynamic subtest bsd: SUCCESS (0.045s)
[507.064798] Starting dynamic subtest: bsd1
[507.100869] Dynamic subtest bsd1: SUCCESS (0.044s)
[507.111251] Starting dynamic subtest: bsd2
[507.144597] Dynamic subtest bsd2: SUCCESS (0.041s)
[507.154932] Starting dynamic subtest: blt
[507.191417] Dynamic subtest blt: SUCCESS (0.044s)
[507.201088] Starting dynamic subtest: vebox
[507.234649] Dynamic subtest vebox: SUCCESS (0.042s)
[507.235777] Subtest legacy-basic: SUCCESS (0.363s)
[507.320846] [110/133] (532s left) gem_ctx_persistence (heartbeat-many)
[507.376113] Starting subtest: heartbeat-many
[507.377777] Subtest heartbeat-many: SKIP (0.000s)
[507.510326] [111/133] (532s left) gem_softpin (overlap)
[507.568996] Starting subtest: overlap
[508.531907] Subtest overlap: SUCCESS (0.961s)
[508.683053] [112/133] (531s left) gen9_exec_parse (cmd-crossing-page)
[508.732545] Subtest cmd-crossing-page: SKIP (0.000s)
[508.785398] [113/133] (531s left) perf (buffer-fill)
[508.874383] Starting subtest: buffer-fill
[508.875477] Starting dynamic subtest: 0-rcs0
[511.161015] Dynamic subtest 0-rcs0: SUCCESS (2.284s)
[511.170950] Starting dynamic subtest: 1-vcs1
[515.601793] Dynamic subtest 1-vcs1: SUCCESS (4.439s)
[515.602947] Subtest buffer-fill: SUCCESS (6.726s)
[515.654521] [114/133] (524s left) kms_psr2_sf (pr-overlay-primary-update-sf-dmg-area)
[520.683239] Starting subtest: pr-overlay-primary-update-sf-dmg-area
[520.686839] Subtest pr-overlay-primary-update-sf-dmg-area: SKIP (0.002s)
[521.543555] [115/133] (518s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[521.638637] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[522.552747] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SUCCESS (0.915s)
[522.744851] [116/133] (517s left) api_intel_bb (blit-reloc-keep-cache)
[522.793876] Starting subtest: blit-reloc-keep-cache
[522.796028] Subtest blit-reloc-keep-cache: SKIP (0.000s)
[522.933559] [117/133] (517s left) kms_color (ctm-green-to-red)
[523.020079] Starting subtest: ctm-green-to-red
[523.021427] Starting dynamic subtest: pipe-A-eDP-1
[523.704694] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.685s)
[523.713643] Starting dynamic subtest: pipe-B-eDP-1
[525.107916] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.403s)
[525.117507] Starting dynamic subtest: pipe-C-eDP-1
[526.392780] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.282s)
[526.401998] Starting dynamic subtest: pipe-D-eDP-1
[527.731002] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.338s)
[527.732226] Subtest ctm-green-to-red: SUCCESS (4.713s)
[528.588369] [118/133] (511s left) sw_sync (sync_multi_consumer)
[528.625184] Starting subtest: sync_multi_consumer
[529.053609] Subtest sync_multi_consumer: SUCCESS (0.429s)
[529.120891] [119/133] (511s left) kms_addfb_basic (bad-pitch-32)
[529.177190] Starting subtest: bad-pitch-32
[529.178787] Subtest bad-pitch-32: SUCCESS (0.000s)
[529.343231] [120/133] (510s left) gem_exec_async (forked-writes)
[529.411094] Starting subtest: forked-writes
[529.412606] Starting dynamic subtest: rcs0
[529.440641] Dynamic subtest rcs0: SUCCESS (0.030s)
[529.450625] Starting dynamic subtest: bcs0
[529.465546] Dynamic subtest bcs0: SUCCESS (0.024s)
[529.474920] Starting dynamic subtest: vcs0
[529.488543] Dynamic subtest vcs0: SUCCESS (0.022s)
[529.498740] Starting dynamic subtest: vcs1
[529.512027] Dynamic subtest vcs1: SUCCESS (0.023s)
[529.521982] Starting dynamic subtest: vecs0
[529.536854] Dynamic subtest vecs0: SUCCESS (0.024s)
[529.545975] Starting dynamic subtest: ccs0
[529.560229] Dynamic subtest ccs0: SUCCESS (0.023s)
[529.561466] Subtest forked-writes: SUCCESS (0.150s)
[529.805411] [121/133] (510s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[529.894208] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-gtt
[529.896484] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[530.015100] [122/133] (510s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180-hflip)
[530.115010] Starting subtest: linear-max-hw-stride-32bpp-rotate-180-hflip
[530.117496] Subtest linear-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[530.245888] [123/133] (510s left) syncobj_timeline (single-wait-all-for-submit-signaled)
[530.302722] Starting subtest: single-wait-all-for-submit-signaled
[530.304220] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[530.426259] [124/133] (509s left) kms_hdmi_inject (inject-audio)
[530.765737] Starting subtest: inject-audio
[531.039717] Subtest inject-audio: SUCCESS (0.274s)
[531.653784] [125/133] (508s left) gem_exec_schedule (preemptive-hang)
[531.820048] Starting subtest: preemptive-hang
[531.821687] Starting dynamic subtest: rcs0
[540.977876] Dynamic subtest rcs0: SUCCESS (9.155s)
[540.989021] Starting dynamic subtest: bcs0
[550.049036] Dynamic subtest bcs0: SUCCESS (9.071s)
[550.059865] Starting dynamic subtest: vcs0
[559.005226] Dynamic subtest vcs0: SUCCESS (8.951s)
[559.014852] Starting dynamic subtest: vcs1
[567.999928] Dynamic subtest vcs1: SUCCESS (8.991s)
[568.010708] Starting dynamic subtest: vecs0
[577.102811] Dynamic subtest vecs0: SUCCESS (9.098s)
[577.114568] Starting dynamic subtest: ccs0
[586.026379] Dynamic subtest ccs0: SUCCESS (8.923s)
[586.027825] Subtest preemptive-hang: SUCCESS (54.198s)
[586.294781] [126/133] (454s left) kms_mmap_write_crc (main)
[586.394876] Starting subtest: main
[586.395986] Starting dynamic subtest: pipe-A-eDP-1
[589.800363] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.403s)
[589.801779] Subtest main: SUCCESS (3.404s)
[590.670317] [127/133] (449s left) syncobj_wait (single-wait-all-submitted)
[590.726202] Starting subtest: single-wait-all-submitted
[590.835136] Subtest single-wait-all-submitted: SUCCESS (0.107s)
[590.919662] [128/133] (449s left) kms_feature_discovery (dp-mst)
[591.005471] Starting subtest: dp-mst
[591.007876] Subtest dp-mst: SKIP (0.000s)
[591.088863] [129/133] (449s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-fullscreen)
[591.174387] Starting subtest: psr-1p-primscrn-spr-indfb-fullscreen
[597.796958] Subtest psr-1p-primscrn-spr-indfb-fullscreen: SUCCESS (6.623s)
[597.939615] [130/133] (442s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs-cc)
[598.035994] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs-cc
[598.036960] Starting dynamic subtest: pipe-A-eDP-1
[598.864341] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.825s)
[598.875466] Starting dynamic subtest: pipe-B-eDP-1
[600.497455] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.631s)
[600.506501] Starting dynamic subtest: pipe-C-eDP-1
[601.978004] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.477s)
[601.987007] Starting dynamic subtest: pipe-D-eDP-1
[603.424285] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.445s)
[603.425070] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.385s)
[604.609079] [131/133] (436s left) kms_cursor_edge_walk (64x64-right-edge)
[604.714498] Starting subtest: 64x64-right-edge
[604.715918] Starting dynamic subtest: pipe-A-eDP-1
[608.157097] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.442s)
[608.166331] Starting dynamic subtest: pipe-D-eDP-1
[611.276087] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.118s)
[611.277573] Subtest 64x64-right-edge: SUCCESS (6.563s)
[612.107755] [132/133] (428s left) syncobj_eventfd (binary-wait)
[612.163446] Starting subtest: binary-wait
[612.172245] Subtest binary-wait: SUCCESS (0.011s)
[612.294499] [133/133] (428s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-upscaling)
[612.387141] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-upscaling
[612.388236] Starting dynamic subtest: pipe-A-default-mode
[612.689825] Dynamic subtest pipe-A-default-mode: SKIP (0.302s)
[612.691811] Subtest flip-32bpp-yftile-to-64bpp-yftile-upscaling: SKIP (0.304s)
[613.529472] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_balancer
results: parsing output: 1/ for test: kms_cursor_legacy
results: parsing output: 2/ for test: perf
results: parsing output: 3/ for test: gem_exec_whisper
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: syncobj_timeline
results: parsing output: 6/ for test: api_intel_bb
results: parsing output: 7/ for test: kms_ccs
results: parsing output: 8/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 9/ for test: kms_joiner
results: parsing output: 10/ for test: gem_exec_schedule
results: parsing output: 11/ for test: kms_rotation_crc
results: parsing output: 12/ for test: gem_spin_batch
results: parsing output: 13/ for test: kms_flip_scaled_crc
results: parsing output: 14/ for test: gem_mmap_gtt
results: parsing output: 15/ for test: gem_softpin
results: parsing output: 16/ for test: kms_selftest
results: parsing output: 17/ for test: kms_ccs
results: parsing output: 18/ for test: syncobj_wait
results: parsing output: 19/ for test: kms_vrr
results: parsing output: 20/ for test: kms_big_fb
results: parsing output: 21/ for test: gem_workarounds
results: parsing output: 22/ for test: vgem_basic
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: kms_cursor_crc
results: parsing output: 25/ for test: kms_rotation_crc
results: parsing output: 26/ for test: kms_pm_rpm
results: parsing output: 27/ for test: kms_big_fb
results: parsing output: 28/ for test: kms_psr
results: parsing output: 29/ for test: dmabuf_sync_file
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_dirtyfb
results: parsing output: 32/ for test: kms_flip
results: parsing output: 33/ for test: kms_content_protection
results: parsing output: 34/ for test: i915_pm_rpm
results: parsing output: 35/ for test: perf_pmu
results: parsing output: 36/ for test: kms_frontbuffer_tracking
results: parsing output: 37/ for test: gem_bad_reloc
results: parsing output: 38/ for test: gem_ctx_bad_destroy
results: parsing output: 39/ for test: kms_atomic
results: parsing output: 40/ for test: kms_big_fb
results: parsing output: 41/ for test: kms_psr2_su
results: parsing output: 42/ for test: gem_userptr_blits
results: parsing output: 43/ for test: gem_exec_whisper
results: parsing output: 44/ for test: gem_exec_flush
results: parsing output: 45/ for test: syncobj_timeline
results: parsing output: 46/ for test: gem_partial_pwrite_pread
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: gem_ccs
results: parsing output: 51/ for test: gem_exec_reloc
results: parsing output: 52/ for test: kms_big_fb
results: parsing output: 53/ for test: gem_exec_fence
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_psr
results: parsing output: 56/ for test: gem_exec_alignment
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: gem_exec_reloc
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: syncobj_timeline
results: parsing output: 62/ for test: gem_render_copy
results: parsing output: 63/ for test: kms_plane_cursor
results: parsing output: 64/ for test: prime_vgem
results: parsing output: 65/ for test: kms_pm_backlight
results: parsing output: 66/ for test: kms_fbcon_fbt
results: parsing output: 67/ for test: gem_mmap_offset
results: parsing output: 68/ for test: gem_eio
results: parsing output: 69/ for test: i915_suspend
results: parsing output: 70/ for test: kms_cursor_crc
results: parsing output: 71/ for test: kms_plane_scaling
results: parsing output: 72/ for test: kms_atomic_transition
results: parsing output: 73/ for test: kms_properties
results: parsing output: 74/ for test: kms_chamelium_frames
results: parsing output: 75/ for test: i915_pciid
results: parsing output: 76/ for test: kms_chamelium_audio
results: parsing output: 77/ for test: kms_psr
results: parsing output: 78/ for test: perf
results: parsing output: 79/ for test: kms_psr
results: parsing output: 80/ for test: gem_mmap_gtt
results: parsing output: 81/ for test: kms_flip_scaled_crc
results: parsing output: 82/ for test: kms_plane_scaling
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_getfb
results: parsing output: 85/ for test: gem_exec_schedule
results: parsing output: 86/ for test: kms_ccs
results: parsing output: 87/ for test: kms_chamelium_hpd
results: parsing output: 88/ for test: template
results: parsing output: 89/ for test: i915_drm_fdinfo
results: parsing output: 90/ for test: gem_exec_reloc
results: parsing output: 91/ for test: syncobj_timeline
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: syncobj_wait
results: parsing output: 95/ for test: kms_addfb_basic
results: parsing output: 96/ for test: kms_cursor_crc
results: parsing output: 97/ for test: kms_plane
results: parsing output: 98/ for test: syncobj_basic
results: parsing output: 99/ for test: gem_ctx_isolation
results: parsing output: 100/ for test: kms_plane_lowres
results: parsing output: 101/ for test: perf_pmu
results: parsing output: 102/ for test: kms_flip
results: parsing output: 103/ for test: kms_big_fb
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: kms_getfb
results: parsing output: 107/ for test: kms_scaling_modes
results: parsing output: 108/ for test: gem_ringfill
results: parsing output: 109/ for test: gem_ctx_persistence
results: parsing output: 110/ for test: gem_softpin
results: parsing output: 111/ for test: gen9_exec_parse
results: parsing output: 112/ for test: perf
results: parsing output: 113/ for test: kms_psr2_sf
results: parsing output: 114/ for test: kms_big_fb
results: parsing output: 115/ for test: api_intel_bb
results: parsing output: 116/ for test: kms_color
results: parsing output: 117/ for test: sw_sync
results: parsing output: 118/ for test: kms_addfb_basic
results: parsing output: 119/ for test: gem_exec_async
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: kms_big_fb
results: parsing output: 122/ for test: syncobj_timeline
results: parsing output: 123/ for test: kms_hdmi_inject
results: parsing output: 124/ for test: gem_exec_schedule
results: parsing output: 125/ for test: kms_mmap_write_crc
results: parsing output: 126/ for test: syncobj_wait
results: parsing output: 127/ for test: kms_feature_discovery
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: kms_ccs
results: parsing output: 130/ for test: kms_cursor_edge_walk
results: parsing output: 131/ for test: syncobj_eventfd
results: parsing output: 132/ for test: kms_flip_scaled_crc
Done.