[78.271023] Initializing watchdogs [78.271151] /dev/watchdog0 [78.293678] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:0102 Intel Sandybridge (Gen6) 2nd Generation Core Processor Family Integrated Graphics Controller (XPS 8300) [78.301308] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [78.306600] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [78.310337] [001/130] (960s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc) [78.826482] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc [78.828048] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [78.922284] [002/130] (959s left) api_intel_allocator (two-level-inception) [78.981405] Starting subtest: two-level-inception [84.424532] Subtest two-level-inception: SUCCESS (5.442s) [84.525533] [003/130] (954s left) syncobj_timeline (wait-for-submit-delayed-submit) [84.589012] Starting subtest: wait-for-submit-delayed-submit [84.692731] Subtest wait-for-submit-delayed-submit: SUCCESS (0.103s) [84.790399] [004/130] (954s left) kms_plane_scaling (planes-downscale-factor-0-75-unity-scaling) [85.270615] Starting subtest: planes-downscale-factor-0-75-unity-scaling [85.271543] Starting dynamic subtest: pipe-A [85.274493] Dynamic subtest pipe-A: SKIP (0.002s) [85.285871] Starting dynamic subtest: pipe-B [85.289625] Dynamic subtest pipe-B: SKIP (0.001s) [85.291334] Subtest planes-downscale-factor-0-75-unity-scaling: SKIP (0.005s) [85.362292] [005/130] (953s left) kms_properties (connector-properties-atomic) [85.854866] Starting subtest: connector-properties-atomic [85.855881] Starting dynamic subtest: pipe-A-VGA-1 [86.109384] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.253s) [86.118796] Starting dynamic subtest: pipe-A-HDMI-A-1 [87.278734] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.168s) [87.289236] Starting dynamic subtest: pipe-None-DP-1 [87.290986] Dynamic subtest pipe-None-DP-1: SUCCESS (0.001s) [87.292039] Subtest connector-properties-atomic: SUCCESS (1.425s) [87.534477] [006/130] (951s left) gen3_mixed_blits [87.642733] [007/130] (951s left) gem_madvise (dontneed-before-pwrite) [87.695121] Starting subtest: dontneed-before-pwrite [87.698731] Subtest dontneed-before-pwrite: SUCCESS (0.004s) [87.802138] [008/130] (951s left) gem_ctx_isolation (dirty-create) [87.874842] Starting subtest: dirty-create [87.875689] Starting dynamic subtest: rcs0 [88.472608] Dynamic subtest rcs0: SUCCESS (0.598s) [88.473470] Subtest dirty-create: SUCCESS (0.598s) [88.698140] [009/130] (950s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-signaled) [88.757573] Starting subtest: etime-multi-wait-all-available-unsubmitted-signaled [88.866373] Subtest etime-multi-wait-all-available-unsubmitted-signaled: SUCCESS (0.108s) [88.948394] [010/130] (950s left) kms_content_protection (lic-type-0) [89.452687] Starting subtest: lic-type-0 [89.454452] Subtest lic-type-0: SKIP (0.000s) [89.550488] [011/130] (949s left) kms_ccs (crc-primary-basic-yf-tiled-ccs) [89.607545] Subtest crc-primary-basic-yf-tiled-ccs: SKIP (0.000s) [89.662048] [012/130] (949s left) kms_psr (psr-sprite-plane-move) [90.147185] Subtest psr-sprite-plane-move: SKIP (0.000s) [90.204313] [013/130] (949s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-mc-ccs) [90.262019] Subtest crc-primary-rotation-180-y-tiled-gen12-mc-ccs: SKIP (0.000s) [90.321053] [014/130] (949s left) gem_readwrite (write-bad-handle) [90.376403] Starting subtest: write-bad-handle [90.378194] Subtest write-bad-handle: SUCCESS (0.000s) [90.478295] [015/130] (948s left) kms_ccs (bad-rotation-90-4-tiled-dg2-mc-ccs) [90.536185] Subtest bad-rotation-90-4-tiled-dg2-mc-ccs: SKIP (0.000s) [90.587656] [016/130] (948s left) gem_fence_thrash (bo-write-verify-threaded-none) [90.642739] Starting subtest: bo-write-verify-threaded-none [92.444415] Subtest bo-write-verify-threaded-none: SUCCESS (1.801s) [92.544697] [017/130] (946s left) gem_exec_whisper (basic-queues-priority-all) [92.615697] Starting subtest: basic-queues-priority-all [92.617315] Subtest basic-queues-priority-all: SKIP (0.001s) [92.813852] [018/130] (946s left) kms_chamelium_hpd (dp-hpd-with-enabled-mode) [93.414495] Subtest dp-hpd-with-enabled-mode: SKIP (0.000s) [93.618443] [019/130] (945s left) syncobj_timeline (multi-wait-signaled) [93.680142] Starting subtest: multi-wait-signaled [93.681752] Subtest multi-wait-signaled: SUCCESS (0.001s) [93.772636] [020/130] (945s left) kms_big_fb (linear-addfb) [94.265383] Starting subtest: linear-addfb [94.266437] Subtest linear-addfb: SUCCESS (0.000s) [94.371482] [021/130] (945s left) kms_flip (basic-plain-flip) [94.855830] Starting subtest: basic-plain-flip [94.857375] Starting dynamic subtest: A-VGA1 [95.643315] Dynamic subtest A-VGA1: SUCCESS (0.786s) [95.653953] Starting dynamic subtest: B-VGA1 [96.350360] Dynamic subtest B-VGA1: SUCCESS (0.705s) [96.361729] Starting dynamic subtest: A-HDMI-A1 [97.104687] Dynamic subtest A-HDMI-A1: SUCCESS (0.753s) [97.116526] Starting dynamic subtest: B-HDMI-A1 [97.890634] Dynamic subtest B-HDMI-A1: SUCCESS (0.784s) [97.891960] Subtest basic-plain-flip: SUCCESS (3.036s) [98.072962] [022/130] (941s left) kms_color (invalid-ctm-matrix-sizes) [98.564132] Starting subtest: invalid-ctm-matrix-sizes [98.565250] Starting dynamic subtest: pipe-A [98.566965] Dynamic subtest pipe-A: SUCCESS (0.002s) [98.577616] Starting dynamic subtest: pipe-B [98.578873] Dynamic subtest pipe-B: SUCCESS (0.003s) [98.580108] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.006s) [98.659715] [023/130] (941s left) kms_cursor_edge_walk (128x128-left-edge) [99.141727] Starting subtest: 128x128-left-edge [99.142794] Starting dynamic subtest: pipe-A-VGA-1 [102.538307] Dynamic subtest pipe-A-VGA-1: SUCCESS (3.395s) [102.547939] Starting dynamic subtest: pipe-B-HDMI-A-1 [105.870846] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (3.331s) [105.871631] Subtest 128x128-left-edge: SUCCESS (6.729s) [106.109880] [024/130] (933s left) syncobj_timeline (etime-single-wait-submitted) [106.174605] Starting subtest: etime-single-wait-submitted [106.282334] Subtest etime-single-wait-submitted: SUCCESS (0.107s) [106.373652] [025/130] (933s left) gem_exec_params (larger-than-life-batch) [106.434295] Starting subtest: larger-than-life-batch [106.435859] Subtest larger-than-life-batch: SKIP (0.000s) [106.538747] [026/130] (933s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc) [107.026459] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc [108.454116] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (1.428s) [108.666953] [027/130] (931s left) kms_frontbuffer_tracking (fbcpsr-modesetfrombusy) [109.161181] Starting subtest: fbcpsr-modesetfrombusy [109.163179] Subtest fbcpsr-modesetfrombusy: SKIP (0.000s) [109.266126] [028/130] (930s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling) [109.323954] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SKIP (0.000s) [109.377778] [029/130] (930s left) gem_eio (wait-wedge-10ms) [109.444023] Starting subtest: wait-wedge-10ms [109.485448] Subtest wait-wedge-10ms: SUCCESS (0.042s) [110.003103] [030/130] (930s left) kms_selftest (drm_plane_helper) [110.063410] Starting subtest: drm_plane_helper [110.074364] Starting dynamic subtest: drm_test_check_plane_state [110.152666] Dynamic subtest drm_test_check_plane_state: SUCCESS (0.081s) [110.163281] Starting dynamic subtest: drm_test_check_invalid_plane_state [110.218094] Dynamic subtest drm_test_check_invalid_plane_state: SUCCESS (0.064s) [110.218737] Subtest drm_plane_helper: SUCCESS (0.154s) [110.348755] [031/130] (929s left) gem_mmap_offset (partial-mmap) [110.404316] Starting subtest: partial-mmap [110.405093] Starting dynamic subtest: smem0 [110.408463] Dynamic subtest smem0: SUCCESS (0.005s) [110.409429] Subtest partial-mmap: SUCCESS (0.005s) [110.522165] [032/130] (929s left) gem_mmap_gtt (basic-write-read) [110.577113] Starting subtest: basic-write-read [110.595991] Subtest basic-write-read: SUCCESS (0.019s) [110.694849] [033/130] (929s left) kms_cdclk (plane-scaling) [110.750950] Subtest plane-scaling: SKIP (0.000s) [110.811538] [034/130] (929s left) gem_exec_flush (basic-batch-kernel-default-uc) [110.879617] Starting subtest: basic-batch-kernel-default-uc [116.501228] Subtest basic-batch-kernel-default-uc: SUCCESS (5.621s) [116.706232] [035/130] (923s left) gem_pxp (verify-pxp-execution-after-suspend-resume) [119.277180] Starting subtest: verify-pxp-execution-after-suspend-resume [119.278731] Subtest verify-pxp-execution-after-suspend-resume: SKIP (0.000s) [119.360839] [036/130] (920s left) kms_chamelium_frames (hdmi-crc-single) [119.953024] Subtest hdmi-crc-single: SKIP (0.000s) [120.160275] [037/130] (920s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-0-async-flip) [120.652091] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-0-async-flip [121.271059] Subtest x-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SUCCESS (0.618s) [121.553058] [038/130] (918s left) kms_flip (modeset-vs-vblank-race-interruptible) [122.050693] Starting subtest: modeset-vs-vblank-race-interruptible [122.051488] Starting dynamic subtest: A-VGA1 [125.180478] Dynamic subtest A-VGA1: SUCCESS (3.128s) [125.193414] Starting dynamic subtest: B-VGA1 [128.283352] Dynamic subtest B-VGA1: SUCCESS (3.100s) [128.298387] Starting dynamic subtest: A-HDMI-A1 [131.406364] Dynamic subtest A-HDMI-A1: SUCCESS (3.118s) [131.418385] Starting dynamic subtest: B-HDMI-A1 [134.584114] Dynamic subtest B-HDMI-A1: SUCCESS (3.177s) [134.587058] Subtest modeset-vs-vblank-race-interruptible: SUCCESS (12.535s) [134.770317] [039/130] (905s left) kms_cursor_legacy (forked-bo) [135.293518] Starting subtest: forked-bo [135.294236] Starting dynamic subtest: pipe-A [140.736148] Dynamic subtest pipe-A: SUCCESS (5.440s) [140.748242] Starting dynamic subtest: pipe-B [146.191396] Dynamic subtest pipe-B: SUCCESS (5.454s) [146.201998] Starting dynamic subtest: all-pipes [151.651734] Dynamic subtest all-pipes: SUCCESS (5.458s) [151.652499] Subtest forked-bo: SUCCESS (16.359s) [151.741529] [040/130] (888s left) kms_rotation_crc (primary-y-tiled-reflect-x-90) [152.218857] Starting subtest: primary-y-tiled-reflect-x-90 [152.220598] Subtest primary-y-tiled-reflect-x-90: SKIP (0.001s) [152.307061] [041/130] (888s left) kms_joiner (switch-modeset-ultra-joiner-big-joiner) [152.779405] Starting subtest: switch-modeset-ultra-joiner-big-joiner [152.780984] Subtest switch-modeset-ultra-joiner-big-joiner: SKIP (0.000s) [152.919449] [042/130] (887s left) kms_pipe_stress (stress-xrgb8888-4tiled) [153.397688] Starting subtest: stress-xrgb8888-4tiled [153.398927] Subtest stress-xrgb8888-4tiled: SKIP (0.000s) [153.450293] [043/130] (887s left) gem_exec_balancer (bonded-semaphore) [153.510307] Subtest bonded-semaphore: SKIP (0.000s) [153.605433] [044/130] (887s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-blt) [154.084375] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-blt [156.138378] Subtest fbc-2p-primscrn-cur-indfb-draw-blt: SUCCESS (2.054s) [156.280674] [045/130] (884s left) gem_spin_batch (resubmit) [156.352266] Starting subtest: resubmit [156.353012] Starting dynamic subtest: rcs0 [156.355127] Dynamic subtest rcs0: SUCCESS (0.002s) [156.365738] Starting dynamic subtest: bcs0 [156.366453] Dynamic subtest bcs0: SUCCESS (0.001s) [156.376292] Starting dynamic subtest: vcs0 [156.376994] Dynamic subtest vcs0: SUCCESS (0.001s) [156.377654] Subtest resubmit: SUCCESS (0.006s) [156.546570] [046/130] (884s left) gem_render_copy (y-tiled-to-vebox-y-tiled) [156.613396] Starting subtest: y-tiled-to-vebox-y-tiled [156.615980] Subtest y-tiled-to-vebox-y-tiled: SKIP (0.000s) [156.815805] [047/130] (884s left) i915_pm_rc6_residency (rc6-accuracy) [156.870680] Starting subtest: rc6-accuracy [156.871512] Starting dynamic subtest: gt0 [160.040329] Dynamic subtest gt0: SUCCESS (3.168s) [160.041176] Subtest rc6-accuracy: SUCCESS (3.170s) [160.125116] [048/130] (880s left) kms_psr (psr-cursor-mmap-gtt) [160.602893] Subtest psr-cursor-mmap-gtt: SKIP (0.000s) [160.656400] [049/130] (880s left) gem_ctx_exec (basic) [160.718460] Starting subtest: basic [160.719278] Subtest basic: SUCCESS (0.001s) [160.837216] [050/130] (880s left) kms_invalid_mode (int-max-clock) [161.309953] Starting subtest: int-max-clock [161.310725] Starting dynamic subtest: pipe-A-VGA-1 [161.411033] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.104s) [161.422224] Starting dynamic subtest: pipe-A-HDMI-A-1 [161.423664] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.000s) [161.435027] Starting dynamic subtest: pipe-B-VGA-1 [161.435830] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.000s) [161.446296] Starting dynamic subtest: pipe-B-HDMI-A-1 [161.447104] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.000s) [161.447926] Subtest int-max-clock: SUCCESS (0.112s) [161.665639] [051/130] (879s left) gem_exec_reloc (basic-wc-gtt) [161.731887] Starting subtest: basic-wc-gtt [161.734935] Subtest basic-wc-gtt: SUCCESS (0.004s) [162.246629] [052/130] (878s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier) [162.722842] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier [162.724242] Subtest pixel-format-4-tiled-bmg-ccs-modifier: SKIP (0.000s) [162.829976] [053/130] (878s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt) [163.311719] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt [163.313788] Subtest psr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s) [163.415132] [054/130] (877s left) gem_userptr_blits (map-fixed-invalidate-overlap-busy) [163.488568] Starting subtest: map-fixed-invalidate-overlap-busy [163.489497] Starting dynamic subtest: gtt [164.536320] Dynamic subtest gtt: SUCCESS (1.046s) [164.547427] Starting dynamic subtest: wb [165.594025] Dynamic subtest wb: SUCCESS (1.056s) [165.605055] Starting dynamic subtest: wc [166.661142] Dynamic subtest wc: SUCCESS (1.066s) [166.672087] Starting dynamic subtest: uc [167.717322] Dynamic subtest uc: SUCCESS (1.055s) [167.718111] Subtest map-fixed-invalidate-overlap-busy: SUCCESS (4.229s) [167.848282] [055/130] (873s left) kms_psr (pr-primary-mmap-cpu) [168.329172] Subtest pr-primary-mmap-cpu: SKIP (0.000s) [168.390843] [056/130] (872s left) gem_mmap_wc (write-gtt-read-wc) [168.448167] Starting subtest: write-gtt-read-wc [168.619325] Subtest write-gtt-read-wc: SUCCESS (0.171s) [168.718435] [057/130] (872s left) syncobj_timeline (invalid-transfer-bad-pad) [168.781978] Starting subtest: invalid-transfer-bad-pad [168.782792] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s) [168.881447] [058/130] (872s left) kms_psr (fbc-psr2-cursor-mmap-cpu) [169.354902] Subtest fbc-psr2-cursor-mmap-cpu: SKIP (0.000s) [169.411579] [059/130] (872s left) gem_exec_reloc (basic-write-gtt) [169.471357] Starting subtest: basic-write-gtt [169.475221] Subtest basic-write-gtt: SUCCESS (0.004s) [169.985877] [060/130] (871s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt) [170.469592] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt [170.471430] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s) [170.588024] [061/130] (870s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt) [171.075768] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt [173.035280] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (1.959s) [173.305114] [062/130] (868s left) gem_exec_balancer (parallel-keep-submit-fence) [173.369016] Subtest parallel-keep-submit-fence: SKIP (0.000s) [173.462373] [063/130] (868s left) gem_ctx_persistence (legacy-engines-hostile) [173.522235] Subtest legacy-engines-hostile: SKIP (0.000s) [173.582596] [064/130] (868s left) kms_busy (extended-pageflip-hang-newfb) [174.063866] Starting subtest: extended-pageflip-hang-newfb [174.066256] Starting dynamic subtest: pipe-A [179.979194] Dynamic subtest pipe-A: SUCCESS (5.913s) [179.995749] Starting dynamic subtest: pipe-B [185.954792] Dynamic subtest pipe-B: SUCCESS (5.969s) [185.960155] Subtest extended-pageflip-hang-newfb: SUCCESS (11.891s) [186.200768] [065/130] (855s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0) [186.693146] Starting subtest: linear-max-hw-stride-32bpp-rotate-0 [187.890659] Subtest linear-max-hw-stride-32bpp-rotate-0: SUCCESS (1.197s) [188.140785] [066/130] (853s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-pwrite) [188.622899] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-pwrite [188.624574] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s) [188.743701] [067/130] (853s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy) [189.222999] Starting subtest: addfb25-x-tiled-mismatch-legacy [189.223871] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.000s) [189.318722] [068/130] (852s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-blt) [189.802286] Starting subtest: psr-1p-primscrn-cur-indfb-draw-blt [189.803738] Subtest psr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s) [189.907948] [069/130] (852s left) gem_basic (multigpu-create-close) [189.966115] Starting subtest: multigpu-create-close [189.967503] Subtest multigpu-create-close: SKIP (0.000s) [190.055795] [070/130] (851s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-upscaling) [190.115753] Subtest flip-32bpp-ytile-to-64bpp-ytile-upscaling: SKIP (0.000s) [190.168484] [071/130] (851s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-blt) [190.648679] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-blt [190.650234] Subtest psr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s) [190.776756] [072/130] (851s left) kms_atomic (plane-invalid-params-fence) [191.253082] Starting subtest: plane-invalid-params-fence [191.253917] Starting dynamic subtest: pipe-A-VGA-1 [191.420893] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.166s) [191.421651] Subtest plane-invalid-params-fence: SUCCESS (0.169s) [191.673153] [073/130] (850s left) kms_atomic_transition (plane-all-modeset-transition-fencing) [192.154286] Starting subtest: plane-all-modeset-transition-fencing [192.156913] Starting dynamic subtest: pipe-A-VGA-1 [196.915602] Dynamic subtest pipe-A-VGA-1: SUCCESS (4.759s) [196.962266] Starting dynamic subtest: pipe-A-HDMI-A-1 [203.850842] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.898s) [203.926938] Starting dynamic subtest: pipe-B-VGA-1 [208.604366] Dynamic subtest pipe-B-VGA-1: SUCCESS (4.688s) [208.651189] Starting dynamic subtest: pipe-B-HDMI-A-1 [215.494839] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (6.853s) [215.557757] Subtest plane-all-modeset-transition-fencing: SUCCESS (23.403s) [215.833212] [074/130] (826s left) kms_vblank (query-forked-busy) [216.314345] Starting subtest: query-forked-busy [216.315618] Starting dynamic subtest: pipe-A-VGA-1 [218.778623] Dynamic subtest pipe-A-VGA-1: SUCCESS (2.464s) [218.790786] Starting dynamic subtest: pipe-A-HDMI-A-1 [221.204578] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.424s) [221.216747] Starting dynamic subtest: pipe-B-VGA-1 [223.554940] Dynamic subtest pipe-B-VGA-1: SUCCESS (2.347s) [223.567386] Starting dynamic subtest: pipe-B-HDMI-A-1 [225.997315] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.441s) [225.998160] Subtest query-forked-busy: SUCCESS (9.685s) [226.256625] [075/130] (815s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-pwrite) [226.743918] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-pwrite [226.745629] Subtest psr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [226.858913] [076/130] (815s left) kms_flip (2x-flip-vs-expired-vblank) [227.339659] Starting subtest: 2x-flip-vs-expired-vblank [227.341296] Starting dynamic subtest: AB-VGA1-HDMI-A1 [257.737024] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (30.395s) [257.739787] Subtest 2x-flip-vs-expired-vblank: SUCCESS (30.399s) [258.009932] [077/130] (784s left) kms_atomic_interruptible (universal-setplane-cursor) [258.489668] Starting subtest: universal-setplane-cursor [258.495220] Starting dynamic subtest: pipe-A-VGA-1 [264.778789] Dynamic subtest pipe-A-VGA-1: SUCCESS (6.286s) [264.780511] Subtest universal-setplane-cursor: SUCCESS (6.289s) [265.033856] [078/130] (777s left) kms_plane (plane-position-covered) [265.509575] Starting subtest: plane-position-covered [265.875054] Starting dynamic subtest: pipe-A-plane-1 [266.249513] Dynamic subtest pipe-A-plane-1: SUCCESS (0.375s) [266.262786] Starting dynamic subtest: pipe-A-plane-2 [266.265199] Dynamic subtest pipe-A-plane-2: SUCCESS (0.004s) [266.563545] Starting dynamic subtest: pipe-B-plane-1 [266.979330] Dynamic subtest pipe-B-plane-1: SUCCESS (0.425s) [266.991834] Starting dynamic subtest: pipe-B-plane-2 [266.993417] Dynamic subtest pipe-B-plane-2: SUCCESS (0.010s) [266.994101] Subtest plane-position-covered: SUCCESS (1.484s) [267.248874] [079/130] (775s left) kms_cursor_crc (cursor-offscreen-max-size) [267.750532] Starting subtest: cursor-offscreen-max-size [267.752883] Subtest cursor-offscreen-max-size: SKIP (0.000s) [267.864768] [080/130] (774s left) syncobj_wait (single-wait-submitted) [267.923311] Starting subtest: single-wait-submitted [268.025671] Subtest single-wait-submitted: SUCCESS (0.102s) [268.109881] [081/130] (774s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-wc) [268.590307] Starting subtest: fbc-rgb565-draw-mmap-wc [270.358483] Subtest fbc-rgb565-draw-mmap-wc: SUCCESS (1.767s) [270.576596] [082/130] (771s left) gem_exec_params (cliprects-invalid) [270.640385] Starting subtest: cliprects-invalid [270.641419] Subtest cliprects-invalid: SUCCESS (0.000s) [270.751561] [083/130] (771s left) gem_mmap_gtt (cpuset-big-copy) [270.810583] Starting subtest: cpuset-big-copy [274.414387] Subtest cpuset-big-copy: SUCCESS (3.603s) [274.550366] [084/130] (768s left) perf_pmu (busy-accuracy-50) [274.711235] Starting subtest: busy-accuracy-50 [274.711971] Starting dynamic subtest: rcs0 [274.713509] Dynamic subtest rcs0: SKIP (0.000s) [274.727035] Starting dynamic subtest: bcs0 [274.729467] Dynamic subtest bcs0: SKIP (0.000s) [274.742854] Starting dynamic subtest: vcs0 [274.745040] Dynamic subtest vcs0: SKIP (0.000s) [274.746944] Subtest busy-accuracy-50: SKIP (0.005s) [274.801055] [085/130] (767s left) gem_mmap_gtt (fault-concurrent) [274.860016] Starting subtest: fault-concurrent [278.579565] Subtest fault-concurrent: SUCCESS (3.719s) [278.740817] [086/130] (763s left) kms_psr2_sf (pr-cursor-plane-update-sf) [279.230942] Subtest pr-cursor-plane-update-sf: SKIP (0.000s) [279.292592] [087/130] (763s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-pgflip-blt) [279.776977] Starting subtest: fbcpsr-2p-primscrn-indfb-pgflip-blt [279.778255] Subtest fbcpsr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s) [279.890561] [088/130] (762s left) sw_sync (sync_expired_merge) [279.958912] Starting subtest: sync_expired_merge [281.033118] Subtest sync_expired_merge: SUCCESS (1.074s) [281.102896] [089/130] (761s left) kms_big_fb (yf-tiled-8bpp-rotate-90) [281.589090] Starting subtest: yf-tiled-8bpp-rotate-90 [281.590508] Subtest yf-tiled-8bpp-rotate-90: SKIP (0.000s) [281.685527] [090/130] (761s left) kms_psr (fbc-pr-cursor-plane-move) [282.165634] Subtest fbc-pr-cursor-plane-move: SKIP (0.000s) [282.229622] [091/130] (760s left) i915_drm_fdinfo (isolation) [282.290077] Subtest isolation: SKIP (0.000s) [282.349708] [092/130] (760s left) kms_frontbuffer_tracking (fbcpsr-tiling-4) [282.832525] Starting subtest: fbcpsr-tiling-4 [282.834230] Subtest fbcpsr-tiling-4: SKIP (0.000s) [282.939572] [093/130] (760s left) prime_vgem (busy) [283.067806] Starting subtest: busy [283.068704] Starting dynamic subtest: rcs0 [283.087841] Dynamic subtest rcs0: SUCCESS (0.019s) [283.102630] Starting dynamic subtest: bcs0 [283.106514] Dynamic subtest bcs0: SUCCESS (0.017s) [283.109149] Subtest busy: SUCCESS (0.040s) [283.243396] [FACT prime_vgem (busy)] new: kernel.kmod_is_loaded.vgem: true [283.246667] [094/130] (759s left) kms_hdr (bpc-switch-suspend) [283.722765] Starting subtest: bpc-switch-suspend [289.618982] Subtest bpc-switch-suspend: SKIP (5.895s) [289.953304] [095/130] (753s left) kms_cursor_crc (cursor-random-128x128) [290.469171] Starting subtest: cursor-random-128x128 [290.487839] Starting dynamic subtest: pipe-A-VGA-1 [294.282955] Dynamic subtest pipe-A-VGA-1: SUCCESS (3.795s) [294.323035] Starting dynamic subtest: pipe-B-HDMI-A-1 [298.022303] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (3.700s) [298.023739] Subtest cursor-random-128x128: SUCCESS (7.544s) [298.281892] [096/130] (744s left) core_debugfs (read-all-entries) [298.344386] Starting subtest: read-all-entries [298.428898] Subtest read-all-entries: SUCCESS (0.084s) [298.530704] [097/130] (744s left) gem_partial_pwrite_pread (writes-after-reads) [298.588778] Starting subtest: writes-after-reads [303.617252] Subtest writes-after-reads: SUCCESS (5.029s) [303.747230] [098/130] (739s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-render) [304.227209] Starting subtest: fbc-rgb101010-draw-render [306.886594] Subtest fbc-rgb101010-draw-render: SUCCESS (2.659s) [307.127363] [099/130] (736s left) perf_pmu (gt-awake) [307.188842] Starting subtest: gt-awake [309.199695] Subtest gt-awake: SUCCESS (2.009s) [309.309910] [100/130] (734s left) kms_prop_blob (blob-prop-lifetime) [309.366337] Starting subtest: blob-prop-lifetime [309.367200] Subtest blob-prop-lifetime: SUCCESS (0.001s) [309.459665] [101/130] (733s left) kms_pm_rpm (cursor) [321.231117] Subtest cursor: SKIP (0.000s) [321.295443] [102/130] (722s left) gen9_exec_parse (secure-batches) [321.372755] Subtest secure-batches: SKIP (0.000s) [321.474253] [103/130] (722s left) kms_big_fb (4-tiled-32bpp-rotate-180) [321.956328] Starting subtest: 4-tiled-32bpp-rotate-180 [321.957971] Subtest 4-tiled-32bpp-rotate-180: SKIP (0.000s) [322.062879] [104/130] (721s left) kms_dp_link_training (uhbr-sst) [322.542558] Starting subtest: uhbr-sst [322.544835] Subtest uhbr-sst: SKIP (0.000s) [322.642930] [105/130] (721s left) syncobj_timeline (single-wait-available-submitted) [322.705938] Starting subtest: single-wait-available-submitted [322.706730] Subtest single-wait-available-submitted: SUCCESS (0.000s) [322.809653] [106/130] (720s left) kms_ccs (crc-sprite-planes-basic-4-tiled-bmg-ccs) [322.872905] Subtest crc-sprite-planes-basic-4-tiled-bmg-ccs: SKIP (0.000s) [322.938197] [107/130] (720s left) gem_softpin (evict-active) [323.000543] Starting subtest: evict-active [323.005683] Subtest evict-active: SUCCESS (0.005s) [323.133639] [108/130] (720s left) drm_mm (drm_mm) [323.193781] Starting subtest: drm_mm [323.202128] Starting dynamic subtest: drm_test_mm_init [323.271722] Dynamic subtest drm_test_mm_init: SUCCESS (0.067s) [323.286290] Starting dynamic subtest: drm_test_mm_debug [323.339117] Dynamic subtest drm_test_mm_debug: SUCCESS (0.066s) [323.353432] Starting dynamic subtest: drm_test_mm_align32 [323.411295] Dynamic subtest drm_test_mm_align32: SUCCESS (0.070s) [323.425692] Starting dynamic subtest: drm_test_mm_align64 [323.484282] Dynamic subtest drm_test_mm_align64: SUCCESS (0.071s) [323.499271] Starting dynamic subtest: drm_test_mm_lowest [323.554857] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.069s) [323.569089] Starting dynamic subtest: drm_test_mm_highest [323.624142] Dynamic subtest drm_test_mm_highest: SUCCESS (0.069s) [323.626382] Subtest drm_mm: SUCCESS (0.432s) [323.770828] [109/130] (720s left) prime_mmap (test_refcounting) [323.832916] Starting subtest: test_refcounting [323.833792] Starting dynamic subtest: test_refcounting-smem [323.834552] Dynamic subtest test_refcounting-smem: SUCCESS (0.003s) [323.835262] Subtest test_refcounting: SUCCESS (0.004s) [323.946561] [110/130] (720s left) kms_flip (wf_vblank-ts-check) [324.424949] Starting subtest: wf_vblank-ts-check [324.425824] Starting dynamic subtest: A-VGA1 [332.532965] Dynamic subtest A-VGA1: SUCCESS (8.107s) [332.549070] Starting dynamic subtest: B-VGA1 [340.553777] Dynamic subtest B-VGA1: SUCCESS (8.016s) [340.569322] Starting dynamic subtest: A-HDMI-A1 [348.744444] Dynamic subtest A-HDMI-A1: SUCCESS (8.185s) [348.757688] Starting dynamic subtest: B-HDMI-A1 [356.965276] Dynamic subtest B-HDMI-A1: SUCCESS (8.219s) [356.968657] Subtest wf_vblank-ts-check: SUCCESS (32.543s) [357.153430] [111/130] (686s left) gem_exec_whisper (basic-fds) [357.226881] Starting subtest: basic-fds [360.010566] Subtest basic-fds: SUCCESS (2.783s) [360.215266] [112/130] (683s left) gem_userptr_blits (userfault) [360.279762] Starting subtest: userfault [360.280580] Subtest userfault: SUCCESS (0.002s) [360.445680] [113/130] (683s left) kms_big_fb (y-tiled-64bpp-rotate-0) [360.932999] Starting subtest: y-tiled-64bpp-rotate-0 [360.935318] Subtest y-tiled-64bpp-rotate-0: SKIP (0.000s) [361.054561] [114/130] (683s left) i915_drm_fdinfo (virtual-idle) [361.112313] Subtest virtual-idle: SKIP (0.000s) [361.176898] [115/130] (683s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite) [361.660525] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite [361.661973] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s) [361.783546] [116/130] (682s left) gem_create (create-size-update) [361.844722] Starting subtest: create-size-update [361.845476] Subtest create-size-update: SUCCESS (0.000s) [362.066252] [117/130] (682s left) kms_psr (fbc-psr-basic) [362.543790] Subtest fbc-psr-basic: SKIP (0.000s) [362.613754] [118/130] (681s left) gem_exec_fence (parallel) [362.793074] Subtest parallel: SKIP (0.000s) [363.188487] [119/130] (681s left) i915_suspend (sysfs-reader) [363.249930] Starting subtest: sysfs-reader [381.870480] Subtest sysfs-reader: SUCCESS (2.611s) [388.970933] [120/130] (662s left) gem_ppgtt (shrink-vs-evict-pinned) [389.060761] Starting subtest: shrink-vs-evict-pinned [389.062104] Subtest shrink-vs-evict-pinned: SKIP (0.002s) [389.142835] [121/130] (662s left) gem_mmap_wc (copy) [389.205914] Starting subtest: copy [389.402210] Subtest copy: SUCCESS (0.197s) [389.500525] [122/130] (662s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc) [389.990974] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc [392.004262] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (2.014s) [392.249131] [123/130] (659s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-cc-modifier) [392.729281] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-cc-modifier [392.730848] Subtest pixel-format-4-tiled-mtl-rc-ccs-cc-modifier: SKIP (0.000s) [392.834205] [124/130] (658s left) syncobj_wait (invalid-reset-zero-handles) [392.895594] Starting subtest: invalid-reset-zero-handles [392.896267] Subtest invalid-reset-zero-handles: SUCCESS (0.000s) [392.994912] [125/130] (658s left) gem_exec_schedule (preemptive-hang) [393.069491] Subtest preemptive-hang: SKIP (0.000s) [393.285423] [126/130] (658s left) vgem_slow (nohang) [393.362310] Starting subtest: nohang [403.692188] Subtest nohang: SUCCESS (10.330s) [403.777943] [127/130] (648s left) gem_flink_race (flink_name) [403.841770] Starting subtest: flink_name [409.217717] Subtest flink_name: SUCCESS (5.373s) [409.329181] [128/130] (642s left) kms_addfb_basic (bad-pitch-32) [409.392878] Starting subtest: bad-pitch-32 [409.393562] Subtest bad-pitch-32: SUCCESS (0.000s) [409.929784] [129/130] (642s left) kms_addfb_basic (unused-pitches) [409.992969] Starting subtest: unused-pitches [409.993800] Subtest unused-pitches: SUCCESS (0.000s) [410.526691] [130/130] (641s left) gem_exec_schedule (submit-late-slice) [410.601574] Subtest submit-late-slice: SKIP (0.000s) [410.814939] Closing watchdogs results: parsing output: 0/ for test: kms_frontbuffer_tracking results: parsing output: 1/ for test: api_intel_allocator results: parsing output: 2/ for test: syncobj_timeline results: parsing output: 3/ for test: kms_plane_scaling results: parsing output: 4/ for test: kms_properties results: parsing output: 5/ for test: gen3_mixed_blits results: parsing output: 6/ for test: gem_madvise results: parsing output: 7/ for test: gem_ctx_isolation results: parsing output: 8/ for test: syncobj_timeline results: parsing output: 9/ for test: kms_content_protection results: parsing output: 10/ for test: kms_ccs results: parsing output: 11/ for test: kms_psr results: parsing output: 12/ for test: kms_ccs results: parsing output: 13/ for test: gem_readwrite results: parsing output: 14/ for test: kms_ccs results: parsing output: 15/ for test: gem_fence_thrash results: parsing output: 16/ for test: gem_exec_whisper results: parsing output: 17/ for test: kms_chamelium_hpd results: parsing output: 18/ for test: syncobj_timeline results: parsing output: 19/ for test: kms_big_fb results: parsing output: 20/ for test: kms_flip results: parsing output: 21/ for test: kms_color results: parsing output: 22/ for test: kms_cursor_edge_walk results: parsing output: 23/ for test: syncobj_timeline results: parsing output: 24/ for test: gem_exec_params results: parsing output: 25/ for test: kms_frontbuffer_tracking results: parsing output: 26/ for test: kms_frontbuffer_tracking results: parsing output: 27/ for test: kms_flip_scaled_crc results: parsing output: 28/ for test: gem_eio results: parsing output: 29/ for test: kms_selftest results: parsing output: 30/ for test: gem_mmap_offset results: parsing output: 31/ for test: gem_mmap_gtt results: parsing output: 32/ for test: kms_cdclk results: parsing output: 33/ for test: gem_exec_flush results: parsing output: 34/ for test: gem_pxp results: parsing output: 35/ for test: kms_chamelium_frames results: parsing output: 36/ for test: kms_big_fb results: parsing output: 37/ for test: kms_flip results: parsing output: 38/ for test: kms_cursor_legacy results: parsing output: 39/ for test: kms_rotation_crc results: parsing output: 40/ for test: kms_joiner results: parsing output: 41/ for test: kms_pipe_stress results: parsing output: 42/ for test: gem_exec_balancer results: parsing output: 43/ for test: kms_frontbuffer_tracking results: parsing output: 44/ for test: gem_spin_batch results: parsing output: 45/ for test: gem_render_copy results: parsing output: 46/ for test: i915_pm_rc6_residency results: parsing output: 47/ for test: kms_psr results: parsing output: 48/ for test: gem_ctx_exec results: parsing output: 49/ for test: kms_invalid_mode results: parsing output: 50/ for test: gem_exec_reloc results: parsing output: 51/ for test: kms_plane results: parsing output: 52/ for test: kms_frontbuffer_tracking results: parsing output: 53/ for test: gem_userptr_blits results: parsing output: 54/ for test: kms_psr results: parsing output: 55/ for test: gem_mmap_wc results: parsing output: 56/ for test: syncobj_timeline results: parsing output: 57/ for test: kms_psr 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: gem_exec_balancer results: parsing output: 62/ for test: gem_ctx_persistence results: parsing output: 63/ for test: kms_busy results: parsing output: 64/ for test: kms_big_fb results: parsing output: 65/ for test: kms_frontbuffer_tracking results: parsing output: 66/ for test: kms_addfb_basic results: parsing output: 67/ for test: kms_frontbuffer_tracking results: parsing output: 68/ for test: gem_basic results: parsing output: 69/ for test: kms_flip_scaled_crc results: parsing output: 70/ for test: kms_frontbuffer_tracking results: parsing output: 71/ for test: kms_atomic results: parsing output: 72/ for test: kms_atomic_transition results: parsing output: 73/ for test: kms_vblank results: parsing output: 74/ for test: kms_frontbuffer_tracking results: parsing output: 75/ for test: kms_flip results: parsing output: 76/ for test: kms_atomic_interruptible results: parsing output: 77/ for test: kms_plane results: parsing output: 78/ for test: kms_cursor_crc results: parsing output: 79/ for test: syncobj_wait results: parsing output: 80/ for test: kms_frontbuffer_tracking results: parsing output: 81/ for test: gem_exec_params results: parsing output: 82/ for test: gem_mmap_gtt results: parsing output: 83/ for test: perf_pmu results: parsing output: 84/ for test: gem_mmap_gtt results: parsing output: 85/ for test: kms_psr2_sf results: parsing output: 86/ for test: kms_frontbuffer_tracking results: parsing output: 87/ for test: sw_sync results: parsing output: 88/ for test: kms_big_fb results: parsing output: 89/ for test: kms_psr results: parsing output: 90/ for test: i915_drm_fdinfo results: parsing output: 91/ for test: kms_frontbuffer_tracking results: parsing output: 92/ for test: prime_vgem results: parsing output: 93/ for test: kms_hdr results: parsing output: 94/ for test: kms_cursor_crc results: parsing output: 95/ for test: core_debugfs results: parsing output: 96/ for test: gem_partial_pwrite_pread results: parsing output: 97/ for test: kms_frontbuffer_tracking results: parsing output: 98/ for test: perf_pmu results: parsing output: 99/ for test: kms_prop_blob results: parsing output: 100/ for test: kms_pm_rpm results: parsing output: 101/ for test: gen9_exec_parse results: parsing output: 102/ for test: kms_big_fb results: parsing output: 103/ for test: kms_dp_link_training results: parsing output: 104/ for test: syncobj_timeline results: parsing output: 105/ for test: kms_ccs results: parsing output: 106/ for test: gem_softpin results: parsing output: 107/ for test: drm_mm results: parsing output: 108/ for test: prime_mmap results: parsing output: 109/ for test: kms_flip results: parsing output: 110/ for test: gem_exec_whisper results: parsing output: 111/ for test: gem_userptr_blits results: parsing output: 112/ for test: kms_big_fb results: parsing output: 113/ for test: i915_drm_fdinfo results: parsing output: 114/ for test: kms_frontbuffer_tracking results: parsing output: 115/ for test: gem_create results: parsing output: 116/ for test: kms_psr results: parsing output: 117/ for test: gem_exec_fence results: parsing output: 118/ for test: i915_suspend results: parsing output: 119/ for test: gem_ppgtt results: parsing output: 120/ for test: gem_mmap_wc results: parsing output: 121/ for test: kms_frontbuffer_tracking results: parsing output: 122/ for test: kms_plane results: parsing output: 123/ for test: syncobj_wait results: parsing output: 124/ for test: gem_exec_schedule results: parsing output: 125/ for test: vgem_slow results: parsing output: 126/ for test: gem_flink_race results: parsing output: 127/ for test: kms_addfb_basic results: parsing output: 128/ for test: kms_addfb_basic results: parsing output: 129/ for test: gem_exec_schedule Done.