[72.248046] Initializing watchdogs [72.248096] /dev/watchdog0 [72.262846] [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] [72.267819] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [72.270350] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [72.273743] [001/156] (960s left) kms_prime (basic-modeset-hybrid) [72.385608] Subtest basic-modeset-hybrid: SKIP (0.000s) [72.563760] [FACT kms_prime (basic-modeset-hybrid)] new: kernel.kmod_is_loaded.vgem: true [72.567059] [002/156] (960s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping) [72.689241] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping [72.693768] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s) [72.779212] [003/156] (960s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-signaled) [72.971969] Starting subtest: multi-wait-all-for-submit-unsubmitted-signaled [73.082340] Subtest multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.109s) [73.191699] [004/156] (959s left) gem_exec_balancer (parallel-ordering) [73.475855] Starting subtest: parallel-ordering [74.486958] Subtest parallel-ordering: SUCCESS (1.009s) [74.609551] [005/156] (958s left) gem_softpin (full) [74.659113] Starting subtest: full [74.667692] Subtest full: SUCCESS (0.009s) [74.776192] [006/156] (958s left) gem_exec_params (larger-than-life-batch) [74.824118] Starting subtest: larger-than-life-batch [77.051274] Subtest larger-than-life-batch: SUCCESS (2.223s) [78.329601] [007/156] (954s left) kms_vrr (flipline) [78.470930] Starting subtest: flipline [78.477658] Subtest flipline: SKIP (0.000s) [78.544752] [008/156] (954s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-factor-0-25) [78.636221] Starting subtest: planes-downscale-factor-0-5-upscale-factor-0-25 [78.638553] Starting dynamic subtest: pipe-A [78.660192] Dynamic subtest pipe-A: SKIP (0.021s) [78.668304] Starting dynamic subtest: pipe-B [78.698299] Dynamic subtest pipe-B: SKIP (0.036s) [78.706595] Starting dynamic subtest: pipe-C [78.733374] Dynamic subtest pipe-C: SKIP (0.036s) [78.741356] Starting dynamic subtest: pipe-D [78.769031] Dynamic subtest pipe-D: SKIP (0.036s) [78.773337] Subtest planes-downscale-factor-0-5-upscale-factor-0-25: SKIP (0.131s) [78.871899] [009/156] (954s left) syncobj_timeline (reset-during-wait-for-submit) [78.944301] Starting subtest: reset-during-wait-for-submit [79.048496] Subtest reset-during-wait-for-submit: SUCCESS (0.103s) [79.150667] [010/156] (954s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen) [79.255825] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen [79.259786] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s) [79.336519] [011/156] (953s left) gem_softpin (softpin) [79.405051] Starting subtest: softpin [111.780643] Subtest softpin: SUCCESS (32.352s) [111.896909] [012/156] (921s left) gem_mmap_offset (basic-uaf) [111.963834] Starting subtest: basic-uaf [111.966124] Subtest basic-uaf: SUCCESS (0.001s) [112.073542] [013/156] (921s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-cur-indfb-onoff) [112.182229] Starting subtest: psrhdr-2p-scndscrn-cur-indfb-onoff [112.186299] Subtest psrhdr-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s) [112.278944] [014/156] (921s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode) [112.668128] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s) [113.499392] [015/156] (919s left) kms_psr (fbc-psr-dpms) [113.584263] Starting subtest: fbc-psr-dpms [113.586707] Starting dynamic subtest: eDP-1 [113.591388] Dynamic subtest eDP-1: SKIP (0.000s) [113.596172] Subtest fbc-psr-dpms: SKIP (0.000s) [113.655594] [016/156] (919s left) syncobj_wait (multi-wait-for-submit-signaled) [113.705645] Starting subtest: multi-wait-for-submit-signaled [113.707918] Subtest multi-wait-for-submit-signaled: SUCCESS (0.000s) [113.812624] [017/156] (919s left) gem_mmap_gtt (basic-write-read-distinct) [113.872245] Subtest basic-write-read-distinct: SKIP (0.000s) [113.938249] [018/156] (919s left) prime_vgem (basic-read) [113.997717] Starting subtest: basic-read [114.015622] Subtest basic-read: SKIP (0.015s) [114.119152] [019/156] (919s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-spr-indfb-draw-render) [114.212733] Starting subtest: fbchdr-2p-primscrn-spr-indfb-draw-render [114.216748] Subtest fbchdr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s) [114.318908] [020/156] (919s left) kms_frontbuffer_tracking (psrhdr-indfb-scaledprimary) [114.418255] Starting subtest: psrhdr-indfb-scaledprimary [114.422029] Subtest psrhdr-indfb-scaledprimary: SKIP (0.000s) [114.521905] [021/156] (919s left) core_debugfs (read-all-entries) [114.580261] Starting subtest: read-all-entries [114.674068] Subtest read-all-entries: SUCCESS (0.095s) [114.737181] [022/156] (918s left) kms_frontbuffer_tracking (psrhdr-1p-offscreen-pri-indfb-draw-pwrite) [114.843796] Starting subtest: psrhdr-1p-offscreen-pri-indfb-draw-pwrite [114.847767] Subtest psrhdr-1p-offscreen-pri-indfb-draw-pwrite: SKIP (0.000s) [114.936539] [023/156] (918s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-sf) [115.047590] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-sf [115.049599] Starting dynamic subtest: pipe-A-eDP-1 [115.147560] Dynamic subtest pipe-A-eDP-1: SKIP (0.101s) [115.157976] Starting dynamic subtest: pipe-B-eDP-1 [116.299255] Dynamic subtest pipe-B-eDP-1: SKIP (1.149s) [116.304119] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-sf: SKIP (1.252s) [117.477700] [024/156] (916s left) gem_lmem_swapping (heavy-verify-random-ccs) [117.525446] Subtest heavy-verify-random-ccs: SKIP (0.000s) [117.569610] [025/156] (916s left) prime_vgem (shrink) [117.638993] Starting subtest: shrink [117.655763] Subtest shrink: SUCCESS (0.017s) [117.788217] [026/156] (916s left) gem_exec_schedule (lateslice) [117.850367] Starting subtest: lateslice [117.852607] Starting dynamic subtest: rcs0 [117.862873] Dynamic subtest rcs0: SUCCESS (0.022s) [117.873732] Starting dynamic subtest: bcs0 [117.879095] Dynamic subtest bcs0: SUCCESS (0.016s) [117.887599] Starting dynamic subtest: vcs0 [117.895447] Dynamic subtest vcs0: SUCCESS (0.016s) [117.903704] Starting dynamic subtest: vcs1 [117.913874] Dynamic subtest vcs1: SUCCESS (0.019s) [117.922283] Starting dynamic subtest: vecs0 [117.931102] Dynamic subtest vecs0: SUCCESS (0.017s) [117.942290] Starting dynamic subtest: ccs0 [117.950154] Dynamic subtest ccs0: SUCCESS (0.019s) [117.952476] Subtest lateslice: SUCCESS (0.109s) [119.399505] [027/156] (914s left) kms_psr (fbc-pr-no-drrs) [119.498811] Starting subtest: fbc-pr-no-drrs [119.503210] Subtest fbc-pr-no-drrs: SKIP (0.000s) [119.567936] [028/156] (914s left) kms_3d (basic) [119.629793] Starting subtest: basic [121.944101] Subtest basic: SUCCESS (2.315s) [122.454949] [029/156] (911s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-shrfb-pgflip-blt) [122.568507] Starting subtest: hdr-2p-scndscrn-shrfb-pgflip-blt [122.573058] Subtest hdr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s) [122.662909] [030/156] (911s left) kms_explicit_fence (multiplane-atomic-fence-wait) [122.805291] Starting subtest: multiplane-atomic-fence-wait [123.121636] Subtest multiplane-atomic-fence-wait: SUCCESS (0.318s) [124.224113] [031/156] (909s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-cpu) [124.325297] Starting subtest: fbc-rgb101010-draw-mmap-cpu [126.852618] Subtest fbc-rgb101010-draw-mmap-cpu: SUCCESS (2.532s) [128.033443] [032/156] (906s left) i915_hangman (hangcheck-unterminated) [128.086906] Starting subtest: hangcheck-unterminated [139.301836] Subtest hangcheck-unterminated: SUCCESS (11.211s) [139.436100] [033/156] (894s left) syncobj_timeline (single-wait-for-submit-available-submitted) [139.505822] Starting subtest: single-wait-for-submit-available-submitted [139.508262] Subtest single-wait-for-submit-available-submitted: SUCCESS (0.000s) [139.600223] [034/156] (894s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip) [139.711503] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip [140.391053] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.681s) [140.566087] [035/156] (893s left) kms_flip (2x-flip-vs-blocking-wf-vblank) [140.666171] Starting subtest: 2x-flip-vs-blocking-wf-vblank [140.677444] Subtest 2x-flip-vs-blocking-wf-vblank: SKIP (0.010s) [140.792193] [036/156] (893s left) gen9_exec_parse (bb-secure) [140.853498] Subtest bb-secure: SKIP (0.000s) [140.931349] [037/156] (893s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-cpu) [141.021881] Starting subtest: fbcpsr-rgb101010-draw-mmap-cpu [145.723047] Subtest fbcpsr-rgb101010-draw-mmap-cpu: SUCCESS (4.706s) [145.811390] [038/156] (888s left) kms_flip_scaled_crc (flip-64bpp-4tile-to-32bpp-4tile-downscaling) [145.907771] Starting subtest: flip-64bpp-4tile-to-32bpp-4tile-downscaling [145.910068] Starting dynamic subtest: pipe-A-default-mode [147.061807] Dynamic subtest pipe-A-default-mode: SKIP (1.152s) [147.065978] Subtest flip-64bpp-4tile-to-32bpp-4tile-downscaling: SKIP (1.153s) [147.192400] [039/156] (887s left) kms_psr (psr2-cursor-plane-onoff) [147.284335] Starting subtest: psr2-cursor-plane-onoff [147.287693] Starting dynamic subtest: eDP-1 [148.964190] Dynamic subtest eDP-1: SUCCESS (1.680s) [148.966376] Subtest psr2-cursor-plane-onoff: SUCCESS (1.681s) [149.817424] [040/156] (884s left) kms_getfb (getfb-reject-nv12) [149.911162] Starting subtest: getfb-reject-nv12 [149.913492] Subtest getfb-reject-nv12: SUCCESS (0.001s) [150.010440] [041/156] (884s left) kms_frontbuffer_tracking (fbc-2p-pri-indfb-multidraw) [150.110084] Starting subtest: fbc-2p-pri-indfb-multidraw [150.114517] Subtest fbc-2p-pri-indfb-multidraw: SKIP (0.000s) [150.211382] [042/156] (884s left) gem_ctx_shared (detached-shared-gtt) [150.277899] Starting subtest: detached-shared-gtt [152.433913] Subtest detached-shared-gtt: SUCCESS (2.153s) [153.466130] [043/156] (881s left) kms_async_flips (test-time-stamp-atomic) [153.573818] Starting subtest: test-time-stamp-atomic [153.959198] Starting dynamic subtest: pipe-A-eDP-1 [154.797736] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.836s) [155.191917] Starting dynamic subtest: pipe-B-eDP-1 [156.005140] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.820s) [156.381611] Starting dynamic subtest: pipe-C-eDP-1 [157.193062] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.818s) [157.555682] Starting dynamic subtest: pipe-D-eDP-1 [158.393216] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.842s) [158.395641] Subtest test-time-stamp-atomic: SUCCESS (4.819s) [159.613363] [044/156] (874s left) kms_big_fb (x-tiled-8bpp-rotate-90) [159.709275] Starting subtest: x-tiled-8bpp-rotate-90 [159.730973] Subtest x-tiled-8bpp-rotate-90: SKIP (0.021s) [159.852593] [045/156] (874s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-upscaling) [159.950047] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-upscaling [159.952262] Starting dynamic subtest: pipe-A-default-mode [162.738656] Dynamic subtest pipe-A-default-mode: SUCCESS (2.790s) [162.741069] Subtest flip-32bpp-4tile-to-64bpp-4tile-upscaling: SUCCESS (2.791s) [163.629432] [046/156] (871s left) gem_exec_fence (syncobj-import) [164.060991] Starting subtest: syncobj-import [164.066348] Subtest syncobj-import: SUCCESS (0.005s) [165.404168] [047/156] (869s left) kms_psr2_sf (pr-overlay-primary-update-sf-dmg-area) [165.499109] Starting subtest: pr-overlay-primary-update-sf-dmg-area [165.503559] Subtest pr-overlay-primary-update-sf-dmg-area: SKIP (0.000s) [165.562986] [048/156] (869s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling) [165.660710] Subtest addfb25-framebuffer-vs-set-tiling: SKIP (0.000s) [165.753019] [049/156] (869s left) syncobj_timeline (etime-single-wait-for-submit-available-unsubmitted) [165.808922] Starting subtest: etime-single-wait-for-submit-available-unsubmitted [165.913931] Subtest etime-single-wait-for-submit-available-unsubmitted: SUCCESS (0.104s) [165.987595] [050/156] (868s left) syncobj_wait (single-wait-submitted) [166.031823] Starting subtest: single-wait-submitted [166.138464] Subtest single-wait-submitted: SUCCESS (0.105s) [166.263095] [051/156] (868s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-pri-indfb-draw-blt) [166.354727] Starting subtest: fbcpsrhdr-2p-primscrn-pri-indfb-draw-blt [166.359159] Subtest fbcpsrhdr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s) [166.450246] [052/156] (868s left) gem_exec_reloc (basic-wc-cpu-noreloc) [166.500523] Subtest basic-wc-cpu-noreloc: SKIP (0.000s) [166.569531] [053/156] (868s left) kms_cursor_crc (cursor-sliding-512x170) [166.892944] Starting subtest: cursor-sliding-512x170 [166.897446] Subtest cursor-sliding-512x170: SKIP (0.001s) [167.048659] [054/156] (867s left) gem_userptr_blits (unsync-overlap) [167.114417] Subtest unsync-overlap: SKIP (0.000s) [167.237375] [055/156] (867s left) kms_pipe_b_c_ivb (pipe-b-double-modeset-then-modeset-pipe-c) [167.282913] Subtest pipe-B-double-modeset-then-modeset-pipe-C: SKIP (0.000s) [167.343831] [056/156] (867s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-pri-indfb-draw-pwrite) [167.437787] Starting subtest: fbchdr-2p-scndscrn-pri-indfb-draw-pwrite [167.441165] Subtest fbchdr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s) [167.526319] [057/156] (867s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-render) [167.626762] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-render [167.630352] Subtest psr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s) [167.725925] [058/156] (867s left) gem_exec_reloc (basic-cpu-gtt) [167.775153] Subtest basic-cpu-gtt: SKIP (0.000s) [167.845433] [059/156] (867s left) dmabuf (all-tests) [167.883692] Starting subtest: all-tests [167.887533] Subtest all-tests: SKIP (0.000s) [167.941863] [060/156] (867s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-wc) [168.043479] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-wc [168.046864] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [168.135817] [061/156] (867s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-plflip-blt) [168.225879] Starting subtest: fbc-1p-primscrn-indfb-plflip-blt [172.827541] Subtest fbc-1p-primscrn-indfb-plflip-blt: SUCCESS (4.606s) [174.030851] [062/156] (861s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-blt) [174.129401] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-blt [180.951019] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-blt: SUCCESS (6.827s) [181.108708] [063/156] (854s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180) [181.205639] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180 [181.210030] Subtest y-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s) [181.311244] [064/156] (854s left) kms_chamelium_color (degamma) [181.400029] Subtest degamma: SKIP (0.000s) [181.446285] [065/156] (854s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-indfb-plflip-blt) [181.540308] Starting subtest: psrhdr-1p-primscrn-indfb-plflip-blt [181.544731] Subtest psrhdr-1p-primscrn-indfb-plflip-blt: SKIP (0.000s) [181.625280] [066/156] (853s left) gem_ctx_freq (sysfs) [181.681812] Starting subtest: sysfs [181.684428] Starting dynamic subtest: gt0 [187.198314] Dynamic subtest gt0: SUCCESS (5.516s) [187.210855] Starting dynamic subtest: gt1 [229.317427] Dynamic subtest gt1: SUCCESS (42.113s) [229.320672] Subtest sysfs: SUCCESS (47.631s) [229.405122] [067/156] (806s left) kms_cursor_legacy (2x-long-flip-vs-cursor-legacy) [229.532275] Starting subtest: 2x-long-flip-vs-cursor-legacy [229.536670] Subtest 2x-long-flip-vs-cursor-legacy: SKIP (0.001s) [229.676322] [068/156] (805s left) gem_vm_create (isolation) [229.743882] Starting subtest: isolation [229.749572] Subtest isolation: SUCCESS (0.008s) [229.865332] [069/156] (805s left) kms_cursor_legacy (cursora-vs-flipb-varying-size) [229.986393] Starting subtest: cursorA-vs-flipB-varying-size [229.990861] Subtest cursorA-vs-flipB-varying-size: SKIP (0.001s) [230.133774] [070/156] (805s left) syncobj_wait (multi-wait-all-submitted) [230.194551] Starting subtest: multi-wait-all-submitted [230.299077] Subtest multi-wait-all-submitted: SUCCESS (0.103s) [230.391485] [071/156] (805s left) gem_mmap_wc (read) [230.443917] Subtest read: SKIP (0.000s) [230.508467] [072/156] (805s left) gem_eio (create) [230.700836] Starting subtest: create [230.968202] Subtest create: SUCCESS (0.267s) [231.081171] [073/156] (804s left) kms_psr (fbc-psr2-sprite-plane-move) [231.177295] Starting subtest: fbc-psr2-sprite-plane-move [231.179589] Starting dynamic subtest: eDP-1 [231.183958] Dynamic subtest eDP-1: SKIP (0.000s) [231.188272] Subtest fbc-psr2-sprite-plane-move: SKIP (0.001s) [231.260458] [074/156] (804s left) kms_cursor_legacy (flip-vs-cursor-busy-crc-atomic) [231.373370] Starting subtest: flip-vs-cursor-busy-crc-atomic [232.087963] Subtest flip-vs-cursor-busy-crc-atomic: SUCCESS (0.714s) [232.922664] [075/156] (802s left) gem_exec_balancer (hang) [233.180506] Starting subtest: hang [234.835528] Subtest hang: SUCCESS (1.659s) [234.977809] [076/156] (800s left) i915_query (engine-info) [235.043965] Starting subtest: engine-info [235.049746] Subtest engine-info: SUCCESS (0.005s) [235.177973] [077/156] (800s left) gem_exec_store (dword) [235.242062] Starting subtest: dword [235.244336] Starting dynamic subtest: rcs0 [235.325899] Dynamic subtest rcs0: SUCCESS (0.083s) [235.337925] Starting dynamic subtest: bcs0 [235.370424] Dynamic subtest bcs0: SUCCESS (0.043s) [235.380999] Starting dynamic subtest: vcs0 [235.413408] Dynamic subtest vcs0: SUCCESS (0.041s) [235.424350] Starting dynamic subtest: vcs1 [237.254829] Dynamic subtest vcs1: SUCCESS (1.837s) [237.267232] Starting dynamic subtest: vecs0 [237.299277] Dynamic subtest vecs0: SUCCESS (0.044s) [237.309134] Starting dynamic subtest: ccs0 [237.345725] Dynamic subtest ccs0: SUCCESS (0.044s) [237.348777] Subtest dword: SUCCESS (2.104s) [237.533834] [078/156] (798s left) kms_frontbuffer_tracking (hdr-1p-offscreen-pri-indfb-draw-render) [237.643740] Starting subtest: hdr-1p-offscreen-pri-indfb-draw-render [237.648236] Subtest hdr-1p-offscreen-pri-indfb-draw-render: SKIP (0.000s) [237.744442] [079/156] (798s left) kms_cursor_crc (cursor-rapid-movement-128x42) [237.965749] Starting subtest: cursor-rapid-movement-128x42 [238.015590] Subtest cursor-rapid-movement-128x42: SKIP (0.045s) [238.225686] [080/156] (797s left) perf_pmu (busy-accuracy-98) [238.263564] Starting subtest: busy-accuracy-98 [238.265697] Starting dynamic subtest: rcs0 [241.304900] Dynamic subtest rcs0: SUCCESS (3.039s) [241.316789] Starting dynamic subtest: bcs0 [244.358811] Dynamic subtest bcs0: SUCCESS (3.052s) [244.371369] Starting dynamic subtest: vcs0 [247.399872] Dynamic subtest vcs0: SUCCESS (3.039s) [247.412184] Starting dynamic subtest: vcs1 [250.444449] Dynamic subtest vcs1: SUCCESS (3.042s) [250.454272] Starting dynamic subtest: vecs0 [253.488890] Dynamic subtest vecs0: SUCCESS (3.043s) [253.500541] Starting dynamic subtest: ccs0 [256.549984] Dynamic subtest ccs0: SUCCESS (3.056s) [256.552720] Subtest busy-accuracy-98: SUCCESS (18.283s) [256.671464] [081/156] (779s left) kms_ccs (crc-primary-basic-4-tiled-dg2-mc-ccs) [256.772793] Starting subtest: crc-primary-basic-4-tiled-dg2-mc-ccs [256.775120] Starting dynamic subtest: pipe-A-eDP-1 [256.797707] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [256.809257] Starting dynamic subtest: pipe-B-eDP-1 [256.830818] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [256.839843] Starting dynamic subtest: pipe-C-eDP-1 [256.861884] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [256.871171] Starting dynamic subtest: pipe-D-eDP-1 [256.892868] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [256.897176] Subtest crc-primary-basic-4-tiled-dg2-mc-ccs: SKIP (0.005s) [259.015861] [082/156] (777s left) kms_frontbuffer_tracking (hdr-2p-primscrn-pri-shrfb-draw-mmap-gtt) [259.117601] Starting subtest: hdr-2p-primscrn-pri-shrfb-draw-mmap-gtt [259.121698] Subtest hdr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s) [259.219382] [083/156] (776s left) gem_workarounds (suspend-resume-context) [259.289700] Starting subtest: suspend-resume-context [274.684415] Subtest suspend-resume-context: SUCCESS (1.296s) [274.823658] [084/156] (761s left) gem_mmap_gtt (cpuset-big-copy-xy) [274.884503] Subtest cpuset-big-copy-XY: SKIP (0.000s) [274.944476] [085/156] (761s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-cur-indfb-move) [275.040273] Starting subtest: fbchdr-1p-primscrn-cur-indfb-move [275.044239] Subtest fbchdr-1p-primscrn-cur-indfb-move: SKIP (0.000s) [275.131053] [086/156] (761s left) kms_addfb_basic (bo-too-small) [275.225178] Starting subtest: bo-too-small [275.227180] Subtest bo-too-small: SUCCESS (0.000s) [275.334094] [087/156] (761s left) prime_mmap (test_correct) [275.396564] Starting subtest: test_correct [275.398661] Starting dynamic subtest: test_correct-smem [275.425811] Dynamic subtest test_correct-smem: SUCCESS (0.031s) [275.428406] Subtest test_correct: SUCCESS (0.031s) [275.564756] [088/156] (760s left) kms_plane_alpha_blend (alpha-transparent-fb) [275.665968] Starting subtest: alpha-transparent-fb [275.965656] Starting dynamic subtest: pipe-A-eDP-1 [276.636135] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.642s) [276.648009] Starting dynamic subtest: pipe-D-eDP-1 [278.099229] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.411s) [278.101744] Subtest alpha-transparent-fb: SUCCESS (2.342s) [279.001576] [089/156] (757s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc) [279.103249] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc [286.183252] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc: SUCCESS (6.959s) [286.308441] [090/156] (750s left) gem_softpin (allocator-basic) [286.360440] Starting subtest: allocator-basic [286.428689] Subtest allocator-basic: SUCCESS (0.067s) [286.568138] [091/156] (749s left) kms_cursor_crc (cursor-random-128x128) [286.774484] Starting subtest: cursor-random-128x128 [286.779385] Starting dynamic subtest: pipe-A-eDP-1 [290.130544] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.323s) [290.161691] Starting dynamic subtest: pipe-D-eDP-1 [294.124680] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.949s) [294.127312] Subtest cursor-random-128x128: SUCCESS (7.299s) [294.981435] [092/156] (741s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-indfb-plflip-blt) [295.080175] Starting subtest: fbcpsrhdr-1p-primscrn-indfb-plflip-blt [295.084300] Subtest fbcpsrhdr-1p-primscrn-indfb-plflip-blt: SKIP (0.000s) [295.178663] [093/156] (741s left) gem_eio (in-flight-internal-immediate) [295.391595] Starting subtest: in-flight-internal-immediate [296.476896] Subtest in-flight-internal-immediate: SUCCESS (1.080s) [296.640358] [094/156] (740s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-indfb-fliptrack-mmap-gtt) [296.741011] Starting subtest: fbcpsrhdr-2p-indfb-fliptrack-mmap-gtt [296.745153] Subtest fbcpsrhdr-2p-indfb-fliptrack-mmap-gtt: SKIP (0.000s) [296.839287] [095/156] (739s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled) [296.884002] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled [296.886302] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s) [296.987106] [096/156] (739s left) kms_frontbuffer_tracking (hdr-1p-primscrn-cur-indfb-onoff) [297.081502] Starting subtest: hdr-1p-primscrn-cur-indfb-onoff [297.085543] Subtest hdr-1p-primscrn-cur-indfb-onoff: SKIP (0.000s) [297.175051] [097/156] (739s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-75) [297.264947] Starting subtest: planes-unity-scaling-downscale-factor-0-75 [297.267300] Starting dynamic subtest: pipe-A [297.327150] Dynamic subtest pipe-A: SUCCESS (0.064s) [297.337779] Starting dynamic subtest: pipe-B [298.492455] Dynamic subtest pipe-B: SUCCESS (1.161s) [298.505133] Starting dynamic subtest: pipe-C [299.672591] Dynamic subtest pipe-C: SUCCESS (1.176s) [299.683197] Starting dynamic subtest: pipe-D [300.787954] Dynamic subtest pipe-D: SUCCESS (1.112s) [300.790323] Subtest planes-unity-scaling-downscale-factor-0-75: SUCCESS (3.517s) [302.010973] [098/156] (734s left) syncobj_eventfd (timeline-wait) [302.071638] Starting subtest: timeline-wait [302.080148] Subtest timeline-wait: SUCCESS (0.011s) [302.194634] [099/156] (734s left) kms_display_modes (extended-mode-basic) [302.289500] Starting subtest: extended-mode-basic [302.294020] Subtest extended-mode-basic: SKIP (0.000s) [302.340897] [100/156] (734s left) kms_flip (bo-too-big) [302.435374] Starting subtest: bo-too-big [302.437510] Starting dynamic subtest: A-eDP1 [303.725281] Dynamic subtest A-eDP1: SUCCESS (1.288s) [303.738887] Starting dynamic subtest: B-eDP1 [305.031113] Dynamic subtest B-eDP1: SUCCESS (1.302s) [305.043668] Starting dynamic subtest: C-eDP1 [306.337315] Dynamic subtest C-eDP1: SUCCESS (1.306s) [306.352852] Starting dynamic subtest: D-eDP1 [307.627645] Dynamic subtest D-eDP1: SUCCESS (1.287s) [307.630101] Subtest bo-too-big: SUCCESS (5.193s) [308.826525] [101/156] (728s left) kms_pm_rpm (i2c) [310.565119] Starting subtest: i2c [315.825734] Subtest i2c: SUCCESS (5.261s) [315.940568] [102/156] (721s left) kms_frontbuffer_tracking (fbchdr-2p-primscrn-cur-indfb-draw-blt) [316.046553] Starting subtest: fbchdr-2p-primscrn-cur-indfb-draw-blt [316.050656] Subtest fbchdr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s) [316.170935] [103/156] (720s left) gem_userptr_blits (sync-unmap-after-close) [316.239374] Starting subtest: sync-unmap-after-close [316.247456] Subtest sync-unmap-after-close: SUCCESS (0.011s) [316.364097] [104/156] (720s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-cpu) [316.456674] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-cpu [323.568247] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.114s) [323.684172] [105/156] (713s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip) [323.792274] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip [323.796527] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s) [323.894005] [106/156] (713s left) kms_rotation_crc (primary-rotation-90) [323.985159] Starting subtest: primary-rotation-90 [323.989672] Subtest primary-rotation-90: SKIP (0.001s) [324.065214] [107/156] (713s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-rc-ccs) [324.157069] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-rc-ccs [324.159199] Starting dynamic subtest: pipe-A-eDP-1 [324.181008] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [324.203938] Starting dynamic subtest: pipe-B-eDP-1 [324.227002] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [324.250165] Starting dynamic subtest: pipe-C-eDP-1 [324.272591] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [324.294802] Starting dynamic subtest: pipe-D-eDP-1 [324.318686] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [324.322947] Subtest crc-primary-rotation-180-y-tiled-gen12-rc-ccs: SKIP (0.006s) [326.458437] [108/156] (710s left) kms_lease (page-flip-implicit-plane) [326.556210] Starting subtest: page-flip-implicit-plane [326.558484] Starting dynamic subtest: pipe-A-eDP-1 [327.022103] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.466s) [327.034519] Starting dynamic subtest: pipe-B-eDP-1 [328.205616] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.181s) [328.217467] Starting dynamic subtest: pipe-C-eDP-1 [329.313663] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.106s) [329.325806] Starting dynamic subtest: pipe-D-eDP-1 [330.446368] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.129s) [330.448310] Subtest page-flip-implicit-plane: SUCCESS (3.888s) [331.298588] [109/156] (706s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-spr-indfb-draw-mmap-cpu) [331.403891] Starting subtest: hdr-2p-scndscrn-spr-indfb-draw-mmap-cpu [331.408177] Subtest hdr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [331.497261] [110/156] (705s left) perf (create-destroy-userspace-config) [331.627467] Starting subtest: create-destroy-userspace-config [331.646246] Subtest create-destroy-userspace-config: SUCCESS (0.019s) [331.694261] [111/156] (705s left) gem_softpin (noreloc-interruptible) [331.761277] Starting subtest: noreloc-interruptible [337.141231] Subtest noreloc-interruptible: SUCCESS (5.379s) [337.285534] [112/156] (700s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-indfb-draw-render) [337.398486] Starting subtest: fbcpsrhdr-1p-offscreen-pri-indfb-draw-render [337.402691] Subtest fbcpsrhdr-1p-offscreen-pri-indfb-draw-render: SKIP (0.000s) [337.486220] [113/156] (700s left) kms_plane (pixel-format-yf-tiled-ccs-modifier-source-clamping) [337.578676] Starting subtest: pixel-format-yf-tiled-ccs-modifier-source-clamping [337.582976] Subtest pixel-format-yf-tiled-ccs-modifier-source-clamping: SKIP (0.000s) [337.653290] [114/156] (699s left) api_intel_allocator (two-level-inception-interruptible) [337.710545] Starting subtest: two-level-inception-interruptible [343.118467] Subtest two-level-inception-interruptible: SUCCESS (5.407s) [343.245421] [115/156] (694s left) kms_frontbuffer_tracking (fbc-shrfb-scaledprimary) [343.351388] Starting subtest: fbc-shrfb-scaledprimary [346.291567] Subtest fbc-shrfb-scaledprimary: SUCCESS (2.945s) [347.495971] [116/156] (690s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-downscaling) [347.595998] Starting subtest: flip-64bpp-ytile-to-32bpp-ytile-downscaling [347.600181] Subtest flip-64bpp-ytile-to-32bpp-ytile-downscaling: SKIP (0.000s) [347.687387] [117/156] (689s left) kms_frontbuffer_tracking (fbchdr-modesetfrombusy) [347.784927] Starting subtest: fbchdr-modesetfrombusy [347.789113] Subtest fbchdr-modesetfrombusy: SKIP (0.000s) [347.873164] [118/156] (689s left) gem_mmap_wc (write-gtt-read-wc) [347.926003] Subtest write-gtt-read-wc: SKIP (0.000s) [347.981525] [119/156] (689s left) i915_pm_rpm (reg-read-ioctl) [349.511805] Starting subtest: reg-read-ioctl [351.906973] Subtest reg-read-ioctl: SUCCESS (2.393s) [352.349881] [120/156] (685s left) kms_flip (flip-vs-expired-vblank-interruptible) [352.445149] Starting subtest: flip-vs-expired-vblank-interruptible [352.447495] Starting dynamic subtest: A-eDP1 [361.089625] Dynamic subtest A-eDP1: SUCCESS (8.640s) [361.103335] Starting dynamic subtest: B-eDP1 [369.719408] Dynamic subtest B-eDP1: SUCCESS (8.625s) [369.730983] Starting dynamic subtest: C-eDP1 [378.354504] Dynamic subtest C-eDP1: SUCCESS (8.637s) [378.367823] Starting dynamic subtest: D-eDP1 [386.978816] Dynamic subtest D-eDP1: SUCCESS (8.623s) [386.984997] Subtest flip-vs-expired-vblank-interruptible: SUCCESS (34.536s) [388.151414] [121/156] (649s left) kms_ccs (bad-rotation-90-4-tiled-bmg-ccs) [388.240564] Starting subtest: bad-rotation-90-4-tiled-bmg-ccs [388.245340] Subtest bad-rotation-90-4-tiled-bmg-ccs: SKIP (0.000s) [389.627401] [122/156] (648s left) gem_eio (in-flight-1us) [389.832887] Starting subtest: in-flight-1us [398.141995] Subtest in-flight-1us: SUCCESS (8.309s) [398.266172] [123/156] (639s left) gem_exec_capture (userptr) [398.325823] Starting subtest: userptr [399.156820] Subtest userptr: SUCCESS (0.832s) [399.263309] [124/156] (638s left) kms_invalid_mode (overflow-vrefresh) [399.358192] Starting subtest: overflow-vrefresh [399.360369] Starting dynamic subtest: pipe-A-eDP-1 [399.642481] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s) [399.655162] Starting dynamic subtest: pipe-B-eDP-1 [399.657076] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s) [399.667924] Starting dynamic subtest: pipe-C-eDP-1 [399.670272] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s) [399.681204] Starting dynamic subtest: pipe-D-eDP-1 [399.683523] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s) [399.685898] Subtest overflow-vrefresh: SUCCESS (0.290s) [400.457735] [125/156] (637s left) gem_ccs (large-ctrl-surf-copy) [400.530449] Starting subtest: large-ctrl-surf-copy [400.535163] Subtest large-ctrl-surf-copy: SKIP (0.000s) [400.657900] [126/156] (637s left) kms_big_fb (linear-64bpp-rotate-180) [400.761796] Starting subtest: linear-64bpp-rotate-180 [402.441236] Subtest linear-64bpp-rotate-180: SUCCESS (1.680s) [402.610119] [127/156] (635s left) kms_chamelium_audio (hdmi-audio-edid) [403.001981] Subtest hdmi-audio-edid: SKIP (0.000s) [403.871375] [128/156] (634s left) kms_content_protection (dp-mst-type-0-suspend-resume) [404.015349] Starting subtest: dp-mst-type-0-suspend-resume [404.019977] Subtest dp-mst-type-0-suspend-resume: SKIP (0.000s) [404.127863] [129/156] (634s left) gem_render_copy (linear-to-vebox-y-tiled) [404.181229] Starting subtest: linear-to-vebox-y-tiled [404.185704] Subtest linear-to-vebox-y-tiled: SKIP (0.000s) [404.367339] [130/156] (633s left) kms_frontbuffer_tracking (fbcpsrhdr-farfromfence-mmap-gtt) [404.461998] Starting subtest: fbcpsrhdr-farfromfence-mmap-gtt [404.466194] Subtest fbcpsrhdr-farfromfence-mmap-gtt: SKIP (0.000s) [404.565426] [131/156] (633s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0) [404.657622] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0 [405.690019] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.034s) [405.816489] [132/156] (632s left) kms_frontbuffer_tracking (hdr-1p-primscrn-spr-indfb-draw-render) [405.913729] Starting subtest: hdr-1p-primscrn-spr-indfb-draw-render [405.917126] Subtest hdr-1p-primscrn-spr-indfb-draw-render: SKIP (0.000s) [406.005483] [133/156] (632s left) kms_color_pipeline (plane-lut1d-pre-ctm3x4) [406.095792] Starting subtest: plane-lut1d-pre-ctm3x4 [406.241233] Starting dynamic subtest: pipe-A-plane-0 [406.430079] Dynamic subtest pipe-A-plane-0: SUCCESS (0.189s) [406.441157] Starting dynamic subtest: pipe-A-plane-1 [406.619325] Dynamic subtest pipe-A-plane-1: SUCCESS (0.188s) [406.630872] Starting dynamic subtest: pipe-A-plane-2 [406.785738] Dynamic subtest pipe-A-plane-2: SUCCESS (0.166s) [408.023520] Starting dynamic subtest: pipe-B-plane-0 [408.203044] Dynamic subtest pipe-B-plane-0: SUCCESS (0.189s) [408.215171] Starting dynamic subtest: pipe-B-plane-1 [408.360862] Dynamic subtest pipe-B-plane-1: SUCCESS (0.155s) [408.371712] Starting dynamic subtest: pipe-B-plane-2 [408.537203] Dynamic subtest pipe-B-plane-2: SUCCESS (0.177s) [409.709760] Starting dynamic subtest: pipe-C-plane-0 [409.866871] Dynamic subtest pipe-C-plane-0: SUCCESS (0.166s) [409.878973] Starting dynamic subtest: pipe-C-plane-1 [410.033657] Dynamic subtest pipe-C-plane-1: SUCCESS (0.166s) [410.045036] Starting dynamic subtest: pipe-C-plane-2 [410.200745] Dynamic subtest pipe-C-plane-2: SUCCESS (0.166s) [411.471076] Starting dynamic subtest: pipe-D-plane-0 [411.616718] Dynamic subtest pipe-D-plane-0: SUCCESS (0.155s) [411.627721] Starting dynamic subtest: pipe-D-plane-1 [411.760989] Dynamic subtest pipe-D-plane-1: SUCCESS (0.144s) [411.771944] Starting dynamic subtest: pipe-D-plane-2 [411.905903] Dynamic subtest pipe-D-plane-2: SUCCESS (0.144s) [412.196414] Subtest plane-lut1d-pre-ctm3x4: SUCCESS (6.099s) [413.021361] [134/156] (625s left) i915_drm_fdinfo (virtual-busy-all) [413.063777] Starting subtest: virtual-busy-all [413.068095] Subtest virtual-busy-all: SKIP (0.000s) [413.138323] [135/156] (625s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc) [413.252152] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc [413.256623] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s) [413.341982] [136/156] (625s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-render) [413.431203] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-render [413.435280] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s) [413.528355] [137/156] (625s left) kms_ccs (missing-ccs-buffer-yf-tiled-ccs) [413.619205] Starting subtest: missing-ccs-buffer-yf-tiled-ccs [413.621473] Starting dynamic subtest: pipe-A-eDP-1 [413.644246] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [413.656135] Starting dynamic subtest: pipe-B-eDP-1 [413.677700] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [413.687974] Starting dynamic subtest: pipe-C-eDP-1 [413.709686] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [413.719946] Starting dynamic subtest: pipe-D-eDP-1 [413.742392] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [413.746867] Subtest missing-ccs-buffer-yf-tiled-ccs: SKIP (0.004s) [415.870570] [138/156] (622s left) syncobj_timeline (invalid-query-illegal-handle) [415.923631] Starting subtest: invalid-query-illegal-handle [415.925976] Subtest invalid-query-illegal-handle: SUCCESS (0.000s) [416.030022] [139/156] (622s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-cur-indfb-draw-render) [416.122767] Starting subtest: psrhdr-2p-primscrn-cur-indfb-draw-render [416.126977] Subtest psrhdr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s) [416.206886] [140/156] (622s left) gem_exec_params (invalid-bsd1-flag-on-render) [416.260383] Starting subtest: invalid-bsd1-flag-on-render [416.262705] Subtest invalid-bsd1-flag-on-render: SUCCESS (0.000s) [416.358261] [141/156] (622s left) kms_frontbuffer_tracking (fbchdr-1p-rte) [416.461770] Starting subtest: fbchdr-1p-rte [416.465853] Subtest fbchdr-1p-rte: SKIP (0.000s) [416.542187] [142/156] (622s left) kms_big_fb (y-tiled-16bpp-rotate-270) [416.643201] Starting subtest: y-tiled-16bpp-rotate-270 [416.647207] Subtest y-tiled-16bpp-rotate-270: SKIP (0.000s) [416.730555] [143/156] (622s left) gem_close_race (multigpu-basic-threads) [416.789659] Starting subtest: multigpu-basic-threads [416.793445] Subtest multigpu-basic-threads: SKIP (0.000s) [417.014270] [144/156] (621s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu) [417.112502] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu [417.116576] Subtest fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s) [417.210875] [145/156] (621s left) kms_psr (psr-primary-page-flip) [417.296419] Starting subtest: psr-primary-page-flip [417.298742] Starting dynamic subtest: eDP-1 [419.082433] Dynamic subtest eDP-1: SUCCESS (1.785s) [419.084993] Subtest psr-primary-page-flip: SUCCESS (1.786s) [419.933669] [146/156] (619s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-spr-indfb-draw-pwrite) [420.049904] Starting subtest: psrhdr-2p-primscrn-spr-indfb-draw-pwrite [420.054347] Subtest psrhdr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [420.144143] [147/156] (618s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-pwrite) [420.253387] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-pwrite [424.631856] Subtest fbc-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (4.384s) [425.837818] [148/156] (613s left) kms_psr (psr2-primary-render) [425.933272] Starting subtest: psr2-primary-render [425.935595] Starting dynamic subtest: eDP-1 [427.733831] Dynamic subtest eDP-1: SUCCESS (1.801s) [427.736202] Subtest psr2-primary-render: SUCCESS (1.802s) [428.605583] [149/156] (610s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt) [428.695071] Starting subtest: psr-rgb565-draw-mmap-gtt [428.699040] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s) [428.791798] [150/156] (610s left) sysfs_heartbeat_interval (mixed) [428.845618] Starting subtest: mixed [428.847883] Starting dynamic subtest: vecs0 [434.040110] Dynamic subtest vecs0: SUCCESS (5.192s) [434.053814] Starting dynamic subtest: ccs0 [439.246794] Dynamic subtest ccs0: SUCCESS (5.203s) [439.262145] Starting dynamic subtest: vcs0 [444.451693] Dynamic subtest vcs0: SUCCESS (5.202s) [444.465398] Starting dynamic subtest: bcs0 [449.665856] Dynamic subtest bcs0: SUCCESS (5.210s) [449.677294] Starting dynamic subtest: rcs0 [454.872773] Dynamic subtest rcs0: SUCCESS (5.204s) [454.883409] Starting dynamic subtest: vcs1 [460.112247] Dynamic subtest vcs1: SUCCESS (5.236s) [460.114925] Subtest mixed: SUCCESS (31.259s) [460.191662] [151/156] (578s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions) [460.316311] Starting subtest: cursorA-vs-flipA-atomic-transitions [471.500264] Subtest cursorA-vs-flipA-atomic-transitions: SUCCESS (11.178s) [472.344826] [152/156] (566s left) perf_pmu (enable-race) [472.393522] Starting subtest: enable-race [472.395822] Starting dynamic subtest: rcs0 [485.160031] Dynamic subtest rcs0: SUCCESS (12.762s) [485.174044] Starting dynamic subtest: bcs0 [497.903046] Dynamic subtest bcs0: SUCCESS (12.736s) [497.919776] Starting dynamic subtest: vcs0 [513.366825] Dynamic subtest vcs0: SUCCESS (15.464s) [513.380941] Starting dynamic subtest: vcs1 [529.431438] Dynamic subtest vcs1: SUCCESS (16.065s) [529.444613] Starting dynamic subtest: vecs0 [545.367435] Dynamic subtest vecs0: SUCCESS (15.934s) [545.379085] Starting dynamic subtest: ccs0 [558.110066] Dynamic subtest ccs0: SUCCESS (12.741s) [558.113090] Subtest enable-race: SUCCESS (85.718s) [558.232133] [153/156] (481s left) gem_exec_schedule (preempt-user) [558.308536] Starting subtest: preempt-user [558.310963] Starting dynamic subtest: rcs0 [558.335548] Dynamic subtest rcs0: SUCCESS (0.034s) [558.348624] Starting dynamic subtest: bcs0 [558.365159] Dynamic subtest bcs0: SUCCESS (0.029s) [558.376427] Starting dynamic subtest: vcs0 [558.388787] Dynamic subtest vcs0: SUCCESS (0.023s) [558.401241] Starting dynamic subtest: vcs1 [558.411563] Dynamic subtest vcs1: SUCCESS (0.022s) [558.423708] Starting dynamic subtest: vecs0 [558.436335] Dynamic subtest vecs0: SUCCESS (0.024s) [558.447280] Starting dynamic subtest: ccs0 [558.469552] Dynamic subtest ccs0: SUCCESS (0.032s) [558.471946] Subtest preempt-user: SUCCESS (0.169s) [560.485785] [154/156] (478s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-pwrite) [560.581683] Starting subtest: psr-1p-primscrn-spr-indfb-draw-pwrite [567.536690] Subtest psr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.957s) [567.652310] [155/156] (471s left) kms_vblank (query-forked) [567.747201] Starting subtest: query-forked [567.749094] Starting dynamic subtest: pipe-A-eDP-1 [569.572666] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.827s) [569.588329] Starting dynamic subtest: pipe-D-eDP-1 [572.066726] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.489s) [572.069128] Subtest query-forked: SUCCESS (4.319s) [572.919624] [156/156] (466s left) gem_pwrite (basic-self) [572.969503] Subtest basic-self: SKIP (0.000s) [573.027536] Closing watchdogs results: parsing output: 0/ for test: kms_prime results: parsing output: 1/ for test: kms_plane results: parsing output: 2/ for test: syncobj_wait results: parsing output: 3/ for test: gem_exec_balancer results: parsing output: 4/ for test: gem_softpin results: parsing output: 5/ for test: gem_exec_params results: parsing output: 6/ for test: kms_vrr results: parsing output: 7/ for test: kms_plane_scaling results: parsing output: 8/ for test: syncobj_timeline results: parsing output: 9/ for test: kms_frontbuffer_tracking results: parsing output: 10/ for test: gem_softpin results: parsing output: 11/ for test: gem_mmap_offset results: parsing output: 12/ for test: kms_frontbuffer_tracking results: parsing output: 13/ for test: kms_chamelium_hpd results: parsing output: 14/ for test: kms_psr results: parsing output: 15/ for test: syncobj_wait results: parsing output: 16/ for test: gem_mmap_gtt results: parsing output: 17/ for test: prime_vgem results: parsing output: 18/ for test: kms_frontbuffer_tracking results: parsing output: 19/ for test: kms_frontbuffer_tracking results: parsing output: 20/ for test: core_debugfs results: parsing output: 21/ for test: kms_frontbuffer_tracking results: parsing output: 22/ for test: kms_psr2_sf results: parsing output: 23/ for test: gem_lmem_swapping results: parsing output: 24/ for test: prime_vgem results: parsing output: 25/ for test: gem_exec_schedule results: parsing output: 26/ for test: kms_psr results: parsing output: 27/ for test: kms_3d results: parsing output: 28/ for test: kms_frontbuffer_tracking results: parsing output: 29/ for test: kms_explicit_fence results: parsing output: 30/ for test: kms_frontbuffer_tracking results: parsing output: 31/ for test: i915_hangman results: parsing output: 32/ for test: syncobj_timeline results: parsing output: 33/ for test: kms_big_fb results: parsing output: 34/ for test: kms_flip results: parsing output: 35/ for test: gen9_exec_parse results: parsing output: 36/ for test: kms_frontbuffer_tracking results: parsing output: 37/ for test: kms_flip_scaled_crc results: parsing output: 38/ for test: kms_psr results: parsing output: 39/ for test: kms_getfb results: parsing output: 40/ for test: kms_frontbuffer_tracking results: parsing output: 41/ for test: gem_ctx_shared results: parsing output: 42/ for test: kms_async_flips results: parsing output: 43/ for test: kms_big_fb results: parsing output: 44/ for test: kms_flip_scaled_crc results: parsing output: 45/ for test: gem_exec_fence results: parsing output: 46/ for test: kms_psr2_sf results: parsing output: 47/ for test: kms_addfb_basic results: parsing output: 48/ for test: syncobj_timeline results: parsing output: 49/ for test: syncobj_wait results: parsing output: 50/ for test: kms_frontbuffer_tracking results: parsing output: 51/ for test: gem_exec_reloc results: parsing output: 52/ for test: kms_cursor_crc results: parsing output: 53/ for test: gem_userptr_blits results: parsing output: 54/ for test: kms_pipe_b_c_ivb results: parsing output: 55/ for test: kms_frontbuffer_tracking results: parsing output: 56/ for test: kms_frontbuffer_tracking results: parsing output: 57/ for test: gem_exec_reloc results: parsing output: 58/ for test: dmabuf results: parsing output: 59/ for test: kms_frontbuffer_tracking results: parsing output: 60/ for test: kms_frontbuffer_tracking results: parsing output: 61/ for test: kms_frontbuffer_tracking results: parsing output: 62/ for test: kms_big_fb results: parsing output: 63/ for test: kms_chamelium_color results: parsing output: 64/ for test: kms_frontbuffer_tracking results: parsing output: 65/ for test: gem_ctx_freq results: parsing output: 66/ for test: kms_cursor_legacy results: parsing output: 67/ for test: gem_vm_create results: parsing output: 68/ for test: kms_cursor_legacy results: parsing output: 69/ for test: syncobj_wait results: parsing output: 70/ for test: gem_mmap_wc results: parsing output: 71/ for test: gem_eio results: parsing output: 72/ for test: kms_psr results: parsing output: 73/ for test: kms_cursor_legacy results: parsing output: 74/ for test: gem_exec_balancer results: parsing output: 75/ for test: i915_query results: parsing output: 76/ for test: gem_exec_store results: parsing output: 77/ for test: kms_frontbuffer_tracking results: parsing output: 78/ for test: kms_cursor_crc results: parsing output: 79/ for test: perf_pmu results: parsing output: 80/ for test: kms_ccs results: parsing output: 81/ for test: kms_frontbuffer_tracking results: parsing output: 82/ for test: gem_workarounds results: parsing output: 83/ for test: gem_mmap_gtt results: parsing output: 84/ for test: kms_frontbuffer_tracking results: parsing output: 85/ for test: kms_addfb_basic results: parsing output: 86/ for test: prime_mmap results: parsing output: 87/ for test: kms_plane_alpha_blend results: parsing output: 88/ for test: kms_frontbuffer_tracking results: parsing output: 89/ for test: gem_softpin results: parsing output: 90/ for test: kms_cursor_crc results: parsing output: 91/ for test: kms_frontbuffer_tracking results: parsing output: 92/ for test: gem_eio results: parsing output: 93/ for test: kms_frontbuffer_tracking results: parsing output: 94/ for test: syncobj_wait results: parsing output: 95/ for test: kms_frontbuffer_tracking results: parsing output: 96/ for test: kms_plane_scaling results: parsing output: 97/ for test: syncobj_eventfd results: parsing output: 98/ for test: kms_display_modes results: parsing output: 99/ for test: kms_flip results: parsing output: 100/ for test: kms_pm_rpm results: parsing output: 101/ for test: kms_frontbuffer_tracking results: parsing output: 102/ for test: gem_userptr_blits results: parsing output: 103/ for test: kms_frontbuffer_tracking results: parsing output: 104/ for test: kms_big_fb results: parsing output: 105/ for test: kms_rotation_crc results: parsing output: 106/ for test: kms_ccs results: parsing output: 107/ for test: kms_lease results: parsing output: 108/ for test: kms_frontbuffer_tracking results: parsing output: 109/ for test: perf results: parsing output: 110/ for test: gem_softpin results: parsing output: 111/ for test: kms_frontbuffer_tracking results: parsing output: 112/ for test: kms_plane results: parsing output: 113/ for test: api_intel_allocator results: parsing output: 114/ for test: kms_frontbuffer_tracking results: parsing output: 115/ for test: kms_flip_scaled_crc results: parsing output: 116/ for test: kms_frontbuffer_tracking results: parsing output: 117/ for test: gem_mmap_wc results: parsing output: 118/ for test: i915_pm_rpm results: parsing output: 119/ for test: kms_flip results: parsing output: 120/ for test: kms_ccs results: parsing output: 121/ for test: gem_eio results: parsing output: 122/ for test: gem_exec_capture results: parsing output: 123/ for test: kms_invalid_mode results: parsing output: 124/ for test: gem_ccs results: parsing output: 125/ for test: kms_big_fb results: parsing output: 126/ for test: kms_chamelium_audio results: parsing output: 127/ for test: kms_content_protection results: parsing output: 128/ for test: gem_render_copy results: parsing output: 129/ for test: kms_frontbuffer_tracking results: parsing output: 130/ for test: kms_big_fb results: parsing output: 131/ for test: kms_frontbuffer_tracking results: parsing output: 132/ for test: kms_color_pipeline results: parsing output: 133/ for test: i915_drm_fdinfo results: parsing output: 134/ for test: kms_frontbuffer_tracking results: parsing output: 135/ for test: kms_frontbuffer_tracking results: parsing output: 136/ for test: kms_ccs results: parsing output: 137/ for test: syncobj_timeline results: parsing output: 138/ for test: kms_frontbuffer_tracking results: parsing output: 139/ for test: gem_exec_params results: parsing output: 140/ for test: kms_frontbuffer_tracking results: parsing output: 141/ for test: kms_big_fb results: parsing output: 142/ for test: gem_close_race results: parsing output: 143/ for test: kms_frontbuffer_tracking results: parsing output: 144/ for test: kms_psr 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_psr results: parsing output: 148/ for test: kms_frontbuffer_tracking results: parsing output: 149/ for test: sysfs_heartbeat_interval results: parsing output: 150/ for test: kms_cursor_legacy results: parsing output: 151/ for test: perf_pmu results: parsing output: 152/ for test: gem_exec_schedule results: parsing output: 153/ for test: kms_frontbuffer_tracking results: parsing output: 154/ for test: kms_vblank results: parsing output: 155/ for test: gem_pwrite Done.