[87.373697] Initializing watchdogs [87.374211] /dev/watchdog0 [87.461532] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:22b1 Intel Cherryview (Gen8) Atom/Celeron/Pentium Processor x5-E8000/J3xxx/N3xxx Integrated Graphics Controller [87.480108] [001/162] (960s left) i915_module_load (load) [88.564974] Starting subtest: load [94.235175] Subtest load: SUCCESS (5.667s) [94.550916] [FACT i915_module_load (load)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [94.592135] [FACT i915_module_load (load)] new: kernel.kmod_is_loaded.i915: true [94.617942] [002/162] (953s left) core_auth (basic-auth) [94.959261] Starting subtest: basic-auth [94.961959] Subtest basic-auth: SUCCESS (0.007s) [95.152528] [003/162] (953s left) core_debugfs (read-all-entries) [95.380191] Starting subtest: read-all-entries [95.390187] Subtest read-all-entries: SUCCESS (0.013s) [95.582572] [004/162] (953s left) core_sysfs (read-all-entries) [95.820932] Starting subtest: read-all-entries [95.842956] Subtest read-all-entries: SUCCESS (0.020s) [96.025968] [005/162] (952s left) fbdev (eof) [96.304753] Subtest eof: SKIP (0.000s) [96.474148] [006/162] (952s left) fbdev (info) [96.749380] Subtest info: SKIP (0.000s) [96.916279] [007/162] (952s left) fbdev (nullptr) [97.189152] Subtest nullptr: SKIP (0.000s) [97.354419] [008/162] (952s left) fbdev (read) [97.636331] Subtest read: SKIP (0.000s) [97.803964] [009/162] (951s left) fbdev (write) [98.093296] Subtest write: SKIP (0.000s) [98.260489] [010/162] (951s left) gem_basic (bad-close) [98.492484] Starting subtest: bad-close [98.500076] Subtest bad-close: SUCCESS (0.000s) [98.678989] [011/162] (951s left) gem_basic (create-close) [98.914580] Starting subtest: create-close [98.921833] Subtest create-close: SUCCESS (0.001s) [99.090910] [012/162] (951s left) gem_basic (create-fd-close) [99.338552] Starting subtest: create-fd-close [99.349250] Subtest create-fd-close: SUCCESS (0.002s) [99.520223] [013/162] (950s left) gem_busy (busy@all-engines) [99.818263] Starting subtest: busy [99.821029] Starting dynamic subtest: all-engines [100.159238] Dynamic subtest all-engines: SUCCESS (0.342s) [100.163134] Subtest busy: SUCCESS (0.343s) [100.804556] [014/162] (949s left) gem_close_race (basic-process) [101.124149] Starting subtest: basic-process [101.269121] Subtest basic-process: SUCCESS (0.149s) [101.592424] [015/162] (949s left) gem_close_race (basic-threads) [101.886061] Starting subtest: basic-threads [103.215572] Subtest basic-threads: SUCCESS (1.333s) [103.531226] [016/162] (947s left) gem_ctx_create (basic) [103.807154] Starting subtest: basic [103.809205] Subtest basic: SUCCESS (0.000s) [104.096532] [017/162] (947s left) gem_ctx_create (basic-files) [104.375371] Starting subtest: basic-files [106.437355] Subtest basic-files: SUCCESS (2.068s) [106.758394] [018/162] (944s left) gem_ctx_exec (basic) [106.996210] Starting subtest: basic [107.014641] Subtest basic: SUCCESS (0.017s) [107.210402] [019/162] (944s left) gem_exec_basic (basic) [107.456465] Starting subtest: basic [107.461218] Starting dynamic subtest: rcs0-smem [107.463615] Dynamic subtest rcs0-smem: SUCCESS (0.008s) [107.502612] Starting dynamic subtest: bcs0-smem [107.504359] Dynamic subtest bcs0-smem: SUCCESS (0.004s) [107.532246] Starting dynamic subtest: vcs0-smem [107.533999] Dynamic subtest vcs0-smem: SUCCESS (0.004s) [107.561641] Starting dynamic subtest: vecs0-smem [107.563318] Dynamic subtest vecs0-smem: SUCCESS (0.003s) [107.564920] Subtest basic: SUCCESS (0.028s) [107.814292] [020/162] (943s left) gem_exec_create (basic) [108.086663] Starting subtest: basic [108.089209] Starting dynamic subtest: smem [110.181494] Dynamic subtest smem: SUCCESS (2.098s) [110.185764] Subtest basic: SUCCESS (2.100s) [110.498565] [021/162] (941s left) gem_exec_fence (basic-busy) [110.931246] Starting subtest: basic-busy [110.934834] Starting dynamic subtest: rcs0 [110.966648] Dynamic subtest rcs0: SUCCESS (0.030s) [111.003179] Starting dynamic subtest: bcs0 [111.013164] Dynamic subtest bcs0: SUCCESS (0.036s) [111.055364] Starting dynamic subtest: vcs0 [111.058942] Dynamic subtest vcs0: SUCCESS (0.032s) [111.089351] Starting dynamic subtest: vecs0 [111.092495] Dynamic subtest vecs0: SUCCESS (0.036s) [111.094097] Subtest basic-busy: SUCCESS (0.148s) [112.059535] [FACT gem_exec_fence (basic-busy)] new: kernel.kmod_is_loaded.vgem: true [112.066693] [022/162] (939s left) gem_exec_fence (basic-wait) [112.512627] Starting subtest: basic-wait [112.515641] Starting dynamic subtest: rcs0 [112.544302] Dynamic subtest rcs0: SUCCESS (0.032s) [112.593303] Starting dynamic subtest: bcs0 [112.596262] Dynamic subtest bcs0: SUCCESS (0.027s) [112.629996] Starting dynamic subtest: vcs0 [112.634312] Dynamic subtest vcs0: SUCCESS (0.030s) [112.666938] Starting dynamic subtest: vecs0 [112.668718] Dynamic subtest vecs0: SUCCESS (0.029s) [112.670466] Subtest basic-wait: SUCCESS (0.130s) [113.433378] [023/162] (938s left) gem_exec_fence (basic-await) [113.864964] Starting subtest: basic-await [113.868154] Starting dynamic subtest: rcs0 [114.103163] Dynamic subtest rcs0: SUCCESS (0.212s) [114.189359] Starting dynamic subtest: bcs0 [114.361216] Dynamic subtest bcs0: SUCCESS (0.271s) [114.397111] Starting dynamic subtest: vcs0 [114.555370] Dynamic subtest vcs0: SUCCESS (0.196s) [114.593431] Starting dynamic subtest: vecs0 [114.741918] Dynamic subtest vecs0: SUCCESS (0.184s) [114.744515] Subtest basic-await: SUCCESS (0.874s) [115.573930] [024/162] (936s left) gem_exec_fence (nb-await) [116.003103] Starting subtest: nb-await [116.008140] Starting dynamic subtest: rcs0 [116.103225] Dynamic subtest rcs0: SUCCESS (0.097s) [116.139384] Starting dynamic subtest: bcs0 [116.201334] Dynamic subtest bcs0: SUCCESS (0.097s) [116.238218] Starting dynamic subtest: vcs0 [116.305364] Dynamic subtest vcs0: SUCCESS (0.093s) [116.342207] Starting dynamic subtest: vecs0 [116.386364] Dynamic subtest vecs0: SUCCESS (0.085s) [116.388532] Subtest nb-await: SUCCESS (0.381s) [117.171221] [025/162] (935s left) gem_exec_gttfill (basic) [117.455929] Starting subtest: basic [151.356229] Subtest basic: SUCCESS (33.898s) [151.731325] [026/162] (901s left) gem_exec_parallel (engines) [152.209161] Starting subtest: engines [152.211547] Starting dynamic subtest: basic [160.800346] Dynamic subtest basic: SUCCESS (8.587s) [160.837397] Starting dynamic subtest: contexts [172.052899] Dynamic subtest contexts: SUCCESS (11.246s) [172.095373] Starting dynamic subtest: fds [184.803646] Dynamic subtest fds: SUCCESS (12.748s) [184.869526] Starting dynamic subtest: userptr [191.295260] Dynamic subtest userptr: SUCCESS (6.491s) [191.297123] Subtest engines: SUCCESS (39.087s) [191.673565] [027/162] (861s left) gem_exec_store (basic) [191.962210] Starting subtest: basic [192.044324] Subtest basic: SUCCESS (0.086s) [192.382954] [028/162] (860s left) gem_flink_basic (bad-flink) [192.618138] Starting subtest: bad-flink [192.625149] Subtest bad-flink: SUCCESS (0.000s) [192.833297] [029/162] (860s left) gem_flink_basic (bad-open) [193.052753] Starting subtest: bad-open [193.056428] Subtest bad-open: SUCCESS (0.000s) [193.251580] [030/162] (860s left) gem_flink_basic (basic) [193.471285] Starting subtest: basic [193.474095] Subtest basic: SUCCESS (0.000s) [193.697381] [031/162] (860s left) gem_flink_basic (double-flink) [193.923609] Starting subtest: double-flink [193.926437] Subtest double-flink: SUCCESS (0.001s) [194.142108] [032/162] (860s left) gem_flink_basic (flink-lifetime) [194.367246] Starting subtest: flink-lifetime [194.381236] Subtest flink-lifetime: SUCCESS (0.011s) [194.593495] [033/162] (859s left) gem_huc_copy (huc-copy) [194.845180] Subtest huc-copy: SKIP (0.000s) [195.058385] [034/162] (859s left) gem_linear_blits (basic) [195.655312] Starting subtest: basic [195.689191] Subtest basic: SUCCESS (0.045s) [195.947914] [035/162] (858s left) gem_mmap (basic) [196.406307] Starting subtest: basic [196.418241] Subtest basic: SUCCESS (0.001s) [196.618408] [036/162] (858s left) gem_mmap_gtt (basic) [196.860916] Starting subtest: basic [196.864246] Subtest basic: SUCCESS (0.006s) [197.082368] [037/162] (858s left) gem_render_linear_blits (basic) [197.330174] Starting subtest: basic [197.468085] Subtest basic: SUCCESS (0.140s) [197.686097] [038/162] (857s left) gem_render_tiled_blits (basic) [197.928503] Starting subtest: basic [198.127334] Subtest basic: SUCCESS (0.180s) [198.347933] [039/162] (857s left) gem_ringfill (basic-all) [198.872141] Starting subtest: basic-all [200.304961] Subtest basic-all: SUCCESS (1.431s) [200.542427] [040/162] (855s left) gem_softpin (allocator-basic) [200.793245] Starting subtest: allocator-basic [201.211950] Subtest allocator-basic: SUCCESS (0.418s) [201.472241] [041/162] (854s left) gem_softpin (allocator-basic-reserve) [201.733864] Starting subtest: allocator-basic-reserve [202.156619] Subtest allocator-basic-reserve: SUCCESS (0.428s) [202.449353] [042/162] (853s left) gem_softpin (safe-alignment) [202.702295] Starting subtest: safe-alignment [202.770481] Subtest safe-alignment: SUCCESS (0.061s) [202.994204] [043/162] (853s left) gem_sync (basic-all) [203.275205] Starting subtest: basic-all [206.896426] Subtest basic-all: SUCCESS (3.623s) [207.240880] [044/162] (849s left) gem_sync (basic-each) [207.522245] Starting subtest: basic-each [210.301858] Subtest basic-each: SUCCESS (2.780s) [210.639695] [045/162] (846s left) gem_tiled_blits (basic) [211.088948] Starting subtest: basic [211.186632] Subtest basic: SUCCESS (0.094s) [211.424750] [046/162] (845s left) gem_tiled_fence_blits (basic) [212.092199] Starting subtest: basic [212.162841] Subtest basic: SUCCESS (0.070s) [212.394183] [047/162] (844s left) gem_tiled_pread_basic (basic) [212.779196] Starting subtest: basic [213.908032] Subtest basic: SUCCESS (1.127s) [214.127969] [048/162] (843s left) gem_wait (busy@all-engines) [214.423690] Starting subtest: busy [214.427388] Starting dynamic subtest: all-engines [214.957980] Dynamic subtest all-engines: SUCCESS (0.536s) [214.966063] Subtest busy: SUCCESS (0.540s) [215.395990] [049/162] (842s left) gem_wait (wait@all-engines) [215.705307] Starting subtest: wait [215.708524] Starting dynamic subtest: all-engines [216.771226] Dynamic subtest all-engines: SUCCESS (1.064s) [216.779193] Subtest wait: SUCCESS (1.071s) [217.201772] [050/162] (840s left) i915_getparams_basic (basic-eu-total) [217.424701] Starting subtest: basic-eu-total [217.430286] Subtest basic-eu-total: SUCCESS (0.000s) [217.630814] [051/162] (840s left) i915_getparams_basic (basic-subslice-total) [217.852917] Starting subtest: basic-subslice-total [217.863317] Subtest basic-subslice-total: SUCCESS (0.000s) [218.067145] [052/162] (840s left) i915_hangman (error-state-basic) [218.333158] Starting subtest: error-state-basic [218.393116] Subtest error-state-basic: SUCCESS (0.057s) [218.683453] [053/162] (839s left) i915_pciid [219.128305] [054/162] (839s left) intel_hwmon (hwmon-read) [219.352735] Subtest hwmon-read: SKIP (0.000s) [219.555477] [055/162] (839s left) intel_hwmon (hwmon-write) [219.771213] Subtest hwmon-write: SKIP (0.000s) [219.973598] [056/162] (839s left) kms_addfb_basic (addfb25-4-tiled) [220.557307] Starting subtest: addfb25-4-tiled [220.560210] Subtest addfb25-4-tiled: SUCCESS (0.001s) [220.774228] [057/162] (838s left) kms_addfb_basic (addfb25-bad-modifier) [221.324197] Starting subtest: addfb25-bad-modifier [221.327397] Subtest addfb25-bad-modifier: SUCCESS (0.003s) [221.546530] [058/162] (838s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling) [222.111288] Starting subtest: addfb25-framebuffer-vs-set-tiling [222.116679] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.001s) [222.336435] [059/162] (837s left) kms_addfb_basic (addfb25-modifier-no-flag) [222.862511] Starting subtest: addfb25-modifier-no-flag [222.866192] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s) [223.083595] [060/162] (837s left) kms_addfb_basic (addfb25-x-tiled-legacy) [223.656239] Starting subtest: addfb25-x-tiled-legacy [223.659870] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s) [223.870899] [061/162] (836s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy) [224.440692] Starting subtest: addfb25-x-tiled-mismatch-legacy [224.444293] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.001s) [224.663237] [062/162] (835s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [225.216387] Starting subtest: addfb25-yf-tiled-legacy [225.219258] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.001s) [225.428916] [063/162] (835s left) kms_addfb_basic (addfb25-y-tiled-legacy) [225.976214] Starting subtest: addfb25-y-tiled-legacy [225.981716] Subtest addfb25-y-tiled-legacy: SUCCESS (0.002s) [226.185576] [064/162] (834s left) kms_addfb_basic (addfb25-y-tiled-small-legacy) [226.759342] Starting subtest: addfb25-y-tiled-small-legacy [226.767191] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s) [226.982684] [065/162] (834s left) kms_addfb_basic (bad-pitch-0) [227.221596] Starting subtest: bad-pitch-0 [227.223754] Subtest bad-pitch-0: SUCCESS (0.000s) [227.745763] [066/162] (833s left) kms_addfb_basic (bad-pitch-1024) [227.975765] Starting subtest: bad-pitch-1024 [227.979917] Subtest bad-pitch-1024: SUCCESS (0.000s) [228.537384] [067/162] (833s left) kms_addfb_basic (bad-pitch-128) [228.759215] Starting subtest: bad-pitch-128 [228.761322] Subtest bad-pitch-128: SUCCESS (0.000s) [229.347994] [068/162] (832s left) kms_addfb_basic (bad-pitch-256) [229.587314] Starting subtest: bad-pitch-256 [229.599597] Subtest bad-pitch-256: SUCCESS (0.000s) [230.298060] [069/162] (831s left) kms_addfb_basic (bad-pitch-32) [230.529969] Starting subtest: bad-pitch-32 [230.535212] Subtest bad-pitch-32: SUCCESS (0.000s) [231.102485] [070/162] (831s left) kms_addfb_basic (bad-pitch-63) [231.323889] Starting subtest: bad-pitch-63 [231.329172] Subtest bad-pitch-63: SUCCESS (0.000s) [231.900847] [071/162] (830s left) kms_addfb_basic (bad-pitch-65536) [232.132850] Starting subtest: bad-pitch-65536 [232.137429] Subtest bad-pitch-65536: SUCCESS (0.003s) [232.701885] [072/162] (829s left) kms_addfb_basic (bad-pitch-999) [232.941447] Starting subtest: bad-pitch-999 [232.945304] Subtest bad-pitch-999: SUCCESS (0.000s) [233.553748] [073/162] (829s left) kms_addfb_basic (basic) [233.787201] Starting subtest: basic [233.791296] Subtest basic: SUCCESS (0.000s) [234.390245] [074/162] (828s left) kms_addfb_basic (basic-x-tiled-legacy) [234.627395] Starting subtest: basic-x-tiled-legacy [234.629355] Subtest basic-x-tiled-legacy: SUCCESS (0.001s) [235.209663] [075/162] (828s left) kms_addfb_basic (basic-y-tiled-legacy) [235.437201] Starting subtest: basic-y-tiled-legacy [235.440524] Subtest basic-y-tiled-legacy: SUCCESS (0.001s) [235.961451] [076/162] (827s left) kms_addfb_basic (bo-too-small) [236.532655] Starting subtest: bo-too-small [236.536397] Subtest bo-too-small: SUCCESS (0.001s) [236.755594] [077/162] (826s left) kms_addfb_basic (bo-too-small-due-to-tiling) [237.398047] Starting subtest: bo-too-small-due-to-tiling [237.401404] Subtest bo-too-small-due-to-tiling: SUCCESS (0.001s) [237.622370] [078/162] (826s left) kms_addfb_basic (clobberred-modifier) [237.863974] Starting subtest: clobberred-modifier [237.868266] Subtest clobberred-modifier: SUCCESS (0.002s) [238.439918] [079/162] (825s left) kms_addfb_basic (framebuffer-vs-set-tiling) [238.670274] Starting subtest: framebuffer-vs-set-tiling [238.672652] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s) [239.235597] [080/162] (825s left) kms_addfb_basic (invalid-get-prop) [239.465891] Starting subtest: invalid-get-prop [239.468040] Subtest invalid-get-prop: SUCCESS (0.000s) [240.033563] [081/162] (824s left) kms_addfb_basic (invalid-get-prop-any) [240.255712] Starting subtest: invalid-get-prop-any [240.257915] Subtest invalid-get-prop-any: SUCCESS (0.000s) [240.834134] [082/162] (823s left) kms_addfb_basic (invalid-set-prop) [241.061282] Starting subtest: invalid-set-prop [241.065208] Subtest invalid-set-prop: SUCCESS (0.000s) [241.587881] [083/162] (823s left) kms_addfb_basic (invalid-set-prop-any) [241.817920] Starting subtest: invalid-set-prop-any [241.822207] Subtest invalid-set-prop-any: SUCCESS (0.000s) [242.335277] [084/162] (822s left) kms_addfb_basic (no-handle) [242.563828] Starting subtest: no-handle [242.567173] Subtest no-handle: SUCCESS (0.000s) [243.113157] [085/162] (822s left) kms_addfb_basic (size-max) [243.710138] Starting subtest: size-max [243.714577] Subtest size-max: SUCCESS (0.001s) [244.031083] [086/162] (821s left) kms_addfb_basic (small-bo) [244.789704] Starting subtest: small-bo [244.792484] Subtest small-bo: SUCCESS (0.000s) [245.056792] [087/162] (820s left) kms_addfb_basic (tile-pitch-mismatch) [245.307607] Starting subtest: tile-pitch-mismatch [245.312478] Subtest tile-pitch-mismatch: SUCCESS (0.002s) [245.983357] [088/162] (820s left) kms_addfb_basic (too-high) [246.565931] Starting subtest: too-high [246.572307] Subtest too-high: SUCCESS (0.004s) [246.781833] [089/162] (819s left) kms_addfb_basic (too-wide) [247.328666] Starting subtest: too-wide [247.331658] Subtest too-wide: SUCCESS (0.000s) [247.549705] [090/162] (819s left) kms_addfb_basic (unused-handle) [247.778269] Starting subtest: unused-handle [247.781238] Subtest unused-handle: SUCCESS (0.000s) [248.353968] [091/162] (818s left) kms_addfb_basic (unused-modifier) [248.578318] Starting subtest: unused-modifier [248.582416] Subtest unused-modifier: SUCCESS (0.000s) [249.161471] [092/162] (818s left) kms_addfb_basic (unused-offsets) [249.395125] Starting subtest: unused-offsets [249.397273] Subtest unused-offsets: SUCCESS (0.000s) [249.937775] [093/162] (817s left) kms_addfb_basic (unused-pitches) [250.178553] Starting subtest: unused-pitches [250.180717] Subtest unused-pitches: SUCCESS (0.000s) [250.734817] [094/162] (816s left) kms_busy (basic) [251.264135] Subtest basic: SKIP (0.000s) [251.466678] [095/162] (816s left) kms_prop_blob (basic) [251.706483] Starting subtest: basic [251.708902] Subtest basic: SUCCESS (0.000s) [251.914590] [096/162] (816s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic) [252.501197] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s) [252.712577] [097/162] (815s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy) [253.365364] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s) [253.583494] [098/162] (814s left) kms_cursor_legacy (basic-flip-after-cursor-atomic) [254.171189] Subtest basic-flip-after-cursor-atomic: SKIP (0.000s) [254.374234] [099/162] (814s left) kms_cursor_legacy (basic-flip-after-cursor-legacy) [254.988139] Subtest basic-flip-after-cursor-legacy: SKIP (0.000s) [255.183803] [100/162] (813s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size) [255.829655] Subtest basic-flip-after-cursor-varying-size: SKIP (0.000s) [256.040855] [101/162] (813s left) kms_cursor_legacy (basic-flip-before-cursor-atomic) [256.611104] Subtest basic-flip-before-cursor-atomic: SKIP (0.000s) [256.821373] [102/162] (812s left) kms_cursor_legacy (basic-flip-before-cursor-legacy) [257.378071] Subtest basic-flip-before-cursor-legacy: SKIP (0.000s) [257.585623] [103/162] (811s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size) [258.212188] Subtest basic-flip-before-cursor-varying-size: SKIP (0.000s) [258.425523] [104/162] (811s left) kms_dsc (dsc-basic) [259.042130] Subtest dsc-basic: SKIP (0.000s) [259.247748] [105/162] (810s left) kms_flip (basic-flip-vs-dpms) [259.901264] Starting subtest: basic-flip-vs-dpms [259.917196] Subtest basic-flip-vs-dpms: SKIP (0.009s) [260.184610] [106/162] (809s left) kms_flip (basic-flip-vs-modeset) [260.777180] Starting subtest: basic-flip-vs-modeset [260.797173] Subtest basic-flip-vs-modeset: SKIP (0.010s) [261.066486] [107/162] (809s left) kms_flip (basic-flip-vs-wf_vblank) [261.657618] Starting subtest: basic-flip-vs-wf_vblank [261.668501] Subtest basic-flip-vs-wf_vblank: SKIP (0.009s) [261.949676] [108/162] (808s left) kms_flip (basic-plain-flip) [262.456503] Starting subtest: basic-plain-flip [262.470087] Subtest basic-plain-flip: SKIP (0.008s) [262.744994] [109/162] (808s left) kms_force_connector_basic (force-connector-state) [263.101165] Starting subtest: force-connector-state [263.827331] Subtest force-connector-state: SUCCESS (0.721s) [264.989267] [110/162] (806s left) kms_force_connector_basic (force-edid) [265.347378] Starting subtest: force-edid [265.693622] Subtest force-edid: SUCCESS (0.346s) [266.310091] [111/162] (804s left) kms_force_connector_basic (force-load-detect) [266.675651] Starting subtest: force-load-detect [266.683111] Subtest force-load-detect: SKIP (0.000s) [267.185286] [112/162] (804s left) kms_force_connector_basic (prune-stale-modes) [267.596405] Starting subtest: prune-stale-modes [268.075312] Subtest prune-stale-modes: SUCCESS (0.481s) [268.728188] [113/162] (802s left) kms_frontbuffer_tracking (basic) [269.280627] Subtest basic: SKIP (0.000s) [269.512493] [114/162] (802s left) kms_hdmi_inject (inject-audio) [269.756252] Starting subtest: inject-audio [270.289908] Subtest inject-audio: SUCCESS (0.536s) [270.769795] [115/162] (801s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24) [271.356392] Subtest compare-crc-sanitycheck-xr24: SKIP (0.000s) [271.582241] [116/162] (800s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12) [272.171566] Subtest compare-crc-sanitycheck-nv12: SKIP (0.000s) [272.402808] [117/162] (800s left) kms_pipe_crc_basic (hang-read-crc) [272.961526] Subtest hang-read-crc: SKIP (0.000s) [273.200334] [118/162] (799s left) kms_pipe_crc_basic (nonblocking-crc) [273.765126] Subtest nonblocking-crc: SKIP (0.000s) [274.015572] [119/162] (798s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence) [274.696130] Subtest nonblocking-crc-frame-sequence: SKIP (0.000s) [274.995378] [120/162] (798s left) kms_pipe_crc_basic (read-crc) [275.606924] Subtest read-crc: SKIP (0.000s) [275.824379] [121/162] (797s left) kms_pipe_crc_basic (read-crc-frame-sequence) [276.415867] Subtest read-crc-frame-sequence: SKIP (0.000s) [276.650225] [122/162] (797s left) kms_pm_backlight (basic-brightness) [277.182511] Subtest basic-brightness: SKIP (0.000s) [277.404293] [123/162] (796s left) kms_pm_rpm (basic-pci-d3-state) [279.320536] Starting subtest: basic-pci-d3-state [279.534926] Subtest basic-pci-d3-state: SUCCESS (0.216s) [279.772630] [124/162] (794s left) kms_pm_rpm (basic-rte) [280.000193] Starting subtest: basic-rte [281.798664] Subtest basic-rte: SUCCESS (1.800s) [282.258796] [125/162] (792s left) kms_psr (psr-primary-page-flip) [282.854344] Subtest psr-primary-page-flip: SKIP (0.000s) [283.086773] [126/162] (791s left) kms_psr (psr-cursor-plane-move) [283.597140] Subtest psr-cursor-plane-move: SKIP (0.000s) [283.818811] [127/162] (790s left) kms_psr (psr-sprite-plane-onoff) [284.450300] Subtest psr-sprite-plane-onoff: SKIP (0.000s) [284.686287] [128/162] (790s left) kms_psr (psr-primary-mmap-gtt) [285.233097] Subtest psr-primary-mmap-gtt: SKIP (0.000s) [285.456826] [129/162] (789s left) kms_setmode (basic-clone-single-crtc) [285.699586] Starting subtest: basic-clone-single-crtc [285.712168] Subtest basic-clone-single-crtc: SKIP (0.000s) [285.919366] [130/162] (789s left) i915_pm_rps (basic-api) [286.189420] Starting subtest: basic-api [286.205756] Subtest basic-api: SUCCESS (0.019s) [286.453925] [131/162] (789s left) prime_self_import (basic-llseek-bad) [286.685405] Starting subtest: basic-llseek-bad [286.691628] Subtest basic-llseek-bad: SUCCESS (0.010s) [286.920240] [132/162] (788s left) prime_self_import (basic-llseek-size) [287.145097] Starting subtest: basic-llseek-size [287.159384] Subtest basic-llseek-size: SUCCESS (0.019s) [287.395919] [133/162] (788s left) prime_self_import (basic-with_fd_dup) [287.621258] Starting subtest: basic-with_fd_dup [287.636604] Subtest basic-with_fd_dup: SUCCESS (0.019s) [287.866277] [134/162] (788s left) prime_self_import (basic-with_one_bo) [288.080457] Starting subtest: basic-with_one_bo [288.098954] Subtest basic-with_one_bo: SUCCESS (0.021s) [288.342735] [135/162] (788s left) prime_self_import (basic-with_one_bo_two_files) [288.561144] Starting subtest: basic-with_one_bo_two_files [288.583331] Subtest basic-with_one_bo_two_files: SUCCESS (0.016s) [288.816194] [136/162] (787s left) prime_self_import (basic-with_two_bos) [289.038725] Starting subtest: basic-with_two_bos [289.064893] Subtest basic-with_two_bos: SUCCESS (0.026s) [289.316594] [137/162] (787s left) prime_vgem (basic-fence-flip) [289.596083] Starting subtest: basic-fence-flip [289.919177] Subtest basic-fence-flip: SKIP (0.313s) [290.156260] [138/162] (787s left) prime_vgem (basic-fence-mmap) [290.419859] Starting subtest: basic-fence-mmap [290.565134] Subtest basic-fence-mmap: SUCCESS (0.131s) [290.797733] [139/162] (786s left) prime_vgem (basic-fence-read) [291.063194] Starting subtest: basic-fence-read [291.332155] Subtest basic-fence-read: SUCCESS (0.274s) [291.585933] [140/162] (786s left) prime_vgem (basic-gtt) [291.844572] Starting subtest: basic-gtt [291.911281] Subtest basic-gtt: SUCCESS (0.060s) [292.176482] [141/162] (785s left) prime_vgem (basic-read) [292.472266] Starting subtest: basic-read [292.606842] Subtest basic-read: SUCCESS (0.142s) [292.863678] [142/162] (785s left) prime_vgem (basic-write) [293.132276] Starting subtest: basic-write [293.303680] Subtest basic-write: SUCCESS (0.176s) [293.559181] [143/162] (784s left) vgem_basic (setversion) [293.794238] Starting subtest: setversion [293.798769] Subtest setversion: SUCCESS (0.000s) [294.018695] [144/162] (784s left) vgem_basic (create) [294.250183] Starting subtest: create [294.252308] Subtest create: SUCCESS (0.001s) [294.471233] [145/162] (784s left) vgem_basic (debugfs) [294.698230] Starting subtest: debugfs [294.704082] Subtest debugfs: SUCCESS (0.002s) [294.927453] [146/162] (784s left) vgem_basic (dmabuf-export) [295.160745] Starting subtest: dmabuf-export [295.181416] Subtest dmabuf-export: SUCCESS (0.018s) [295.419257] [147/162] (783s left) vgem_basic (dmabuf-fence) [295.644732] Starting subtest: dmabuf-fence [295.655646] Subtest dmabuf-fence: SUCCESS (0.009s) [295.890475] [148/162] (783s left) vgem_basic (dmabuf-fence-before) [296.119342] Starting subtest: dmabuf-fence-before [296.122427] Subtest dmabuf-fence-before: SUCCESS (0.002s) [296.353789] [149/162] (783s left) vgem_basic (dmabuf-mmap) [296.588083] Starting subtest: dmabuf-mmap [296.634207] Subtest dmabuf-mmap: SUCCESS (0.047s) [296.858514] [150/162] (782s left) vgem_basic (mmap) [297.100174] Starting subtest: mmap [297.122500] Subtest mmap: SUCCESS (0.037s) [297.364691] [151/162] (782s left) vgem_basic (second-client) [297.604223] Starting subtest: second-client [297.622221] Subtest second-client: SUCCESS (0.019s) [297.841883] [152/162] (782s left) vgem_basic (sysfs) [298.078786] Starting subtest: sysfs [298.084390] Subtest sysfs: SUCCESS (0.004s) [298.304482] [153/162] (782s left) core_hotunplug (unbind-rebind) [298.719389] Starting subtest: unbind-rebind [304.132274] Subtest unbind-rebind: SUCCESS (5.417s) [304.353565] [154/162] (776s left) vgem_basic (unload) [304.576511] Starting subtest: unload [333.874813] Subtest unload: SUCCESS (29.296s) [334.219971] [155/162] (746s left) i915_module_load (reload) [334.446385] Starting subtest: reload [342.872291] Subtest reload: SUCCESS (8.414s) [343.337795] [156/162] (737s left) gem_lmem_swapping (basic) [343.618428] Subtest basic: SKIP (0.000s) [343.937880] [157/162] (737s left) gem_lmem_swapping (parallel-random-engines) [344.233271] Subtest parallel-random-engines: SKIP (0.000s) [344.467672] [158/162] (737s left) gem_lmem_swapping (random-engines) [344.728787] Subtest random-engines: SKIP (0.000s) [344.942851] [159/162] (737s left) gem_lmem_swapping (verify-random) [345.201201] Subtest verify-random: SKIP (0.000s) [345.403976] [160/162] (736s left) i915_pm_rpm (module-reload) [347.365619] Starting subtest: module-reload [366.511641] Subtest module-reload: SUCCESS (19.146s) [366.659077] [FACT i915_pm_rpm (module-reload)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [366.664935] [FACT i915_pm_rpm (module-reload)] deleted: kernel.kmod_is_loaded.i915: true [366.671979] [161/162] (715s left) i915_selftest (live) [366.925804] Starting subtest: live [366.927952] Starting dynamic subtest: sanitycheck [372.828320] Dynamic subtest sanitycheck: SUCCESS (5.905s) [372.926565] Starting dynamic subtest: uncore [378.822116] Dynamic subtest uncore: SUCCESS (5.982s) [378.939367] Starting dynamic subtest: workarounds [385.127659] Dynamic subtest workarounds: SUCCESS (6.301s) [385.165325] Starting dynamic subtest: gt_engines [391.471198] Dynamic subtest gt_engines: SUCCESS (6.334s) [391.506861] Starting dynamic subtest: gt_timelines [429.096395] Dynamic subtest gt_timelines: SUCCESS (37.620s) [429.158930] Starting dynamic subtest: gt_contexts [435.524502] Dynamic subtest gt_contexts: SUCCESS (6.419s) [435.566894] Starting dynamic subtest: gt_lrc [445.270592] Dynamic subtest gt_lrc: SUCCESS (9.734s) [445.310115] Starting dynamic subtest: gt_mocs [451.014336] Dynamic subtest gt_mocs: SUCCESS (5.739s) [451.069633] Starting dynamic subtest: gt_pm [458.454920] Dynamic subtest gt_pm: SUCCESS (7.431s) [458.493079] Starting dynamic subtest: gt_heartbeat [464.736097] Dynamic subtest gt_heartbeat: SUCCESS (6.274s) [464.777531] Starting dynamic subtest: gt_tlb [471.187580] Dynamic subtest gt_tlb: SUCCESS (6.443s) [471.223070] Starting dynamic subtest: requests [484.240660] Dynamic subtest requests: SUCCESS (13.048s) [484.276259] Starting dynamic subtest: migrate [494.887710] Dynamic subtest migrate: SUCCESS (10.639s) [494.925164] Starting dynamic subtest: active [501.148856] Dynamic subtest active: SUCCESS (6.256s) [501.188838] Starting dynamic subtest: objects [508.919284] Dynamic subtest objects: SUCCESS (7.758s) [508.957417] Starting dynamic subtest: mman [522.002568] Dynamic subtest mman: SUCCESS (13.081s) [522.038581] Starting dynamic subtest: dmabuf [528.341272] Dynamic subtest dmabuf: SUCCESS (6.333s) [528.381867] Starting dynamic subtest: vma [534.630844] Dynamic subtest vma: SUCCESS (6.282s) [534.671740] Starting dynamic subtest: coherency [546.374828] Dynamic subtest coherency: SUCCESS (11.739s) [546.414443] Starting dynamic subtest: gtt [560.679060] Dynamic subtest gtt: SUCCESS (14.297s) [560.716877] Starting dynamic subtest: gem [567.974128] Dynamic subtest gem: SUCCESS (7.285s) [568.018648] Starting dynamic subtest: evict [582.365030] Dynamic subtest evict: SUCCESS (14.380s) [582.405386] Starting dynamic subtest: hugepages [588.622527] Dynamic subtest hugepages: SUCCESS (6.252s) [588.659373] Starting dynamic subtest: gem_contexts [624.053290] Dynamic subtest gem_contexts: SUCCESS (35.427s) [624.097872] Starting dynamic subtest: client [630.208928] Dynamic subtest client: SUCCESS (6.145s) [630.249551] Starting dynamic subtest: gem_migrate [636.179830] Dynamic subtest gem_migrate: SUCCESS (5.959s) [636.279531] Starting dynamic subtest: reset [650.310775] Dynamic subtest reset: SUCCESS (14.122s) [650.496307] Starting dynamic subtest: memory_region [656.716353] Dynamic subtest memory_region: SUCCESS (6.398s) [656.756668] Starting dynamic subtest: hangcheck [686.415176] Dynamic subtest hangcheck: SUCCESS (29.689s) [686.455686] Starting dynamic subtest: execlists [698.946113] Dynamic subtest execlists: SUCCESS (12.524s) [698.997245] Starting dynamic subtest: ring_submission [704.937231] Dynamic subtest ring_submission: SUCCESS (5.977s) [704.980625] Starting dynamic subtest: perf [711.512846] Dynamic subtest perf: SUCCESS (6.567s) [711.549671] Starting dynamic subtest: slpc [717.439347] Dynamic subtest slpc: SUCCESS (5.925s) [717.506348] Starting dynamic subtest: guc [723.861209] Dynamic subtest guc: SUCCESS (6.399s) [723.972320] Starting dynamic subtest: guc_multi_lrc [730.213185] Dynamic subtest guc_multi_lrc: SUCCESS (6.342s) [730.254641] Starting dynamic subtest: guc_hang [736.163825] Dynamic subtest guc_hang: SUCCESS (5.942s) [736.284667] Starting dynamic subtest: late_gt_pm [742.171315] Dynamic subtest late_gt_pm: SUCCESS (5.989s) [742.191150] Subtest live: SUCCESS (375.248s) [742.363357] [162/162] (340s left) dmabuf (all-tests) [742.609901] Starting subtest: all-tests [742.613162] Starting dynamic subtest: sanitycheck [742.678189] Dynamic subtest sanitycheck: SUCCESS (0.063s) [742.778092] Starting dynamic subtest: dma_fence [742.901358] Dynamic subtest dma_fence: SUCCESS (0.215s) [742.995454] Starting dynamic subtest: dma_fence_chain [742.998647] Dynamic subtest dma_fence_chain: SKIP (0.001s) [743.036446] Starting dynamic subtest: dma_fence_unwrap [743.038627] Dynamic subtest dma_fence_unwrap: SUCCESS (0.085s) [743.083904] Starting dynamic subtest: dma_resv [743.128472] Dynamic subtest dma_resv: SUCCESS (0.109s) [743.137696] Subtest all-tests: SUCCESS (0.529s) [743.308882] Closing watchdogs results: parsing output: 0/ for test: i915_module_load results: parsing output: 1/ for test: core_auth results: parsing output: 2/ for test: core_debugfs results: parsing output: 3/ for test: core_sysfs results: parsing output: 4/ for test: fbdev results: parsing output: 5/ for test: fbdev results: parsing output: 6/ for test: fbdev results: parsing output: 7/ for test: fbdev results: parsing output: 8/ for test: fbdev results: parsing output: 9/ for test: gem_basic results: parsing output: 10/ for test: gem_basic results: parsing output: 11/ for test: gem_basic results: parsing output: 12/ for test: gem_busy results: parsing output: 13/ for test: gem_close_race results: parsing output: 14/ for test: gem_close_race results: parsing output: 15/ for test: gem_ctx_create results: parsing output: 16/ for test: gem_ctx_create results: parsing output: 17/ for test: gem_ctx_exec results: parsing output: 18/ for test: gem_exec_basic results: parsing output: 19/ for test: gem_exec_create results: parsing output: 20/ for test: gem_exec_fence results: parsing output: 21/ for test: gem_exec_fence results: parsing output: 22/ for test: gem_exec_fence results: parsing output: 23/ for test: gem_exec_fence results: parsing output: 24/ for test: gem_exec_gttfill results: parsing output: 25/ for test: gem_exec_parallel results: parsing output: 26/ for test: gem_exec_store results: parsing output: 27/ for test: gem_flink_basic results: parsing output: 28/ for test: gem_flink_basic results: parsing output: 29/ for test: gem_flink_basic results: parsing output: 30/ for test: gem_flink_basic results: parsing output: 31/ for test: gem_flink_basic results: parsing output: 32/ for test: gem_huc_copy results: parsing output: 33/ for test: gem_linear_blits results: parsing output: 34/ for test: gem_mmap results: parsing output: 35/ for test: gem_mmap_gtt results: parsing output: 36/ for test: gem_render_linear_blits results: parsing output: 37/ for test: gem_render_tiled_blits results: parsing output: 38/ for test: gem_ringfill results: parsing output: 39/ for test: gem_softpin results: parsing output: 40/ for test: gem_softpin results: parsing output: 41/ for test: gem_softpin results: parsing output: 42/ for test: gem_sync results: parsing output: 43/ for test: gem_sync results: parsing output: 44/ for test: gem_tiled_blits results: parsing output: 45/ for test: gem_tiled_fence_blits results: parsing output: 46/ for test: gem_tiled_pread_basic results: parsing output: 47/ for test: gem_wait results: parsing output: 48/ for test: gem_wait results: parsing output: 49/ for test: i915_getparams_basic results: parsing output: 50/ for test: i915_getparams_basic results: parsing output: 51/ for test: i915_hangman results: parsing output: 52/ for test: i915_pciid results: parsing output: 53/ for test: intel_hwmon results: parsing output: 54/ for test: intel_hwmon results: parsing output: 55/ for test: kms_addfb_basic results: parsing output: 56/ for test: kms_addfb_basic results: parsing output: 57/ for test: kms_addfb_basic results: parsing output: 58/ for test: kms_addfb_basic results: parsing output: 59/ for test: kms_addfb_basic results: parsing output: 60/ for test: kms_addfb_basic results: parsing output: 61/ for test: kms_addfb_basic results: parsing output: 62/ for test: kms_addfb_basic results: parsing output: 63/ for test: kms_addfb_basic results: parsing output: 64/ for test: kms_addfb_basic results: parsing output: 65/ for test: kms_addfb_basic results: parsing output: 66/ for test: kms_addfb_basic results: parsing output: 67/ for test: kms_addfb_basic results: parsing output: 68/ for test: kms_addfb_basic results: parsing output: 69/ for test: kms_addfb_basic results: parsing output: 70/ for test: kms_addfb_basic results: parsing output: 71/ for test: kms_addfb_basic results: parsing output: 72/ for test: kms_addfb_basic results: parsing output: 73/ for test: kms_addfb_basic results: parsing output: 74/ for test: kms_addfb_basic results: parsing output: 75/ for test: kms_addfb_basic results: parsing output: 76/ for test: kms_addfb_basic results: parsing output: 77/ for test: kms_addfb_basic results: parsing output: 78/ for test: kms_addfb_basic results: parsing output: 79/ for test: kms_addfb_basic results: parsing output: 80/ for test: kms_addfb_basic results: parsing output: 81/ for test: kms_addfb_basic results: parsing output: 82/ for test: kms_addfb_basic results: parsing output: 83/ for test: kms_addfb_basic results: parsing output: 84/ for test: kms_addfb_basic results: parsing output: 85/ for test: kms_addfb_basic results: parsing output: 86/ for test: kms_addfb_basic results: parsing output: 87/ for test: kms_addfb_basic results: parsing output: 88/ for test: kms_addfb_basic results: parsing output: 89/ for test: kms_addfb_basic results: parsing output: 90/ for test: kms_addfb_basic results: parsing output: 91/ for test: kms_addfb_basic results: parsing output: 92/ for test: kms_addfb_basic results: parsing output: 93/ for test: kms_busy results: parsing output: 94/ for test: kms_prop_blob results: parsing output: 95/ for test: kms_cursor_legacy results: parsing output: 96/ for test: kms_cursor_legacy results: parsing output: 97/ for test: kms_cursor_legacy results: parsing output: 98/ for test: kms_cursor_legacy results: parsing output: 99/ for test: kms_cursor_legacy results: parsing output: 100/ for test: kms_cursor_legacy results: parsing output: 101/ for test: kms_cursor_legacy results: parsing output: 102/ for test: kms_cursor_legacy results: parsing output: 103/ for test: kms_dsc results: parsing output: 104/ for test: kms_flip results: parsing output: 105/ for test: kms_flip results: parsing output: 106/ for test: kms_flip results: parsing output: 107/ for test: kms_flip results: parsing output: 108/ for test: kms_force_connector_basic results: parsing output: 109/ for test: kms_force_connector_basic results: parsing output: 110/ for test: kms_force_connector_basic results: parsing output: 111/ for test: kms_force_connector_basic results: parsing output: 112/ for test: kms_frontbuffer_tracking results: parsing output: 113/ for test: kms_hdmi_inject results: parsing output: 114/ for test: kms_pipe_crc_basic results: parsing output: 115/ for test: kms_pipe_crc_basic results: parsing output: 116/ for test: kms_pipe_crc_basic results: parsing output: 117/ for test: kms_pipe_crc_basic results: parsing output: 118/ for test: kms_pipe_crc_basic results: parsing output: 119/ for test: kms_pipe_crc_basic results: parsing output: 120/ for test: kms_pipe_crc_basic results: parsing output: 121/ for test: kms_pm_backlight results: parsing output: 122/ for test: kms_pm_rpm results: parsing output: 123/ for test: kms_pm_rpm results: parsing output: 124/ for test: kms_psr results: parsing output: 125/ for test: kms_psr results: parsing output: 126/ for test: kms_psr results: parsing output: 127/ for test: kms_psr results: parsing output: 128/ for test: kms_setmode results: parsing output: 129/ for test: i915_pm_rps results: parsing output: 130/ for test: prime_self_import results: parsing output: 131/ for test: prime_self_import results: parsing output: 132/ for test: prime_self_import results: parsing output: 133/ for test: prime_self_import results: parsing output: 134/ for test: prime_self_import results: parsing output: 135/ for test: prime_self_import results: parsing output: 136/ for test: prime_vgem results: parsing output: 137/ for test: prime_vgem results: parsing output: 138/ for test: prime_vgem results: parsing output: 139/ for test: prime_vgem results: parsing output: 140/ for test: prime_vgem results: parsing output: 141/ for test: prime_vgem results: parsing output: 142/ for test: vgem_basic results: parsing output: 143/ for test: vgem_basic results: parsing output: 144/ for test: vgem_basic results: parsing output: 145/ for test: vgem_basic results: parsing output: 146/ for test: vgem_basic results: parsing output: 147/ for test: vgem_basic results: parsing output: 148/ for test: vgem_basic results: parsing output: 149/ for test: vgem_basic results: parsing output: 150/ for test: vgem_basic results: parsing output: 151/ for test: vgem_basic results: parsing output: 152/ for test: core_hotunplug results: parsing output: 153/ for test: vgem_basic results: parsing output: 154/ for test: i915_module_load results: parsing output: 155/ for test: gem_lmem_swapping results: parsing output: 156/ for test: gem_lmem_swapping results: parsing output: 157/ for test: gem_lmem_swapping results: parsing output: 158/ for test: gem_lmem_swapping results: parsing output: 159/ for test: i915_pm_rpm results: parsing output: 160/ for test: i915_selftest results: parsing output: 161/ for test: dmabuf Done.