Test case details
Test name:
OfficeDevPnP.Core.Tests.Framework.Functional.TermGroupTests.WebTermGroupTest
Outcome:
Run at:
1/13/2020 7:50:18 PM
Duration:
00:15:00
Error message:
Test 'WebTermGroupTest' exceeded execution timeout period.
Stacktrace:
N/A
Console output:
    Type = System.Threading.ThreadAbortException
TraceCorrelationId = 042a2b9f-f5a4-4047-f1f8-622cac019492
Message = Thread was being aborted.
Source = System
TargetSite = Void WriteHeaders(Boolean)
StackTrace =    at System.Net.ConnectStream.WriteHeaders(Boolean async)
   at System.Net.HttpWebRequest.EndSubmitRequest()
   at System.Net.HttpWebRequest.SetRequestSubmitDone(ConnectStream submitStream)
   at System.Net.Connection.CompleteStartRequest(Boolean onSubmitThread, HttpWebRequest request, TriState needReConnect)
   at System.Net.Connection.SubmitRequest(HttpWebRequest request, Boolean forcedsubmit)
   at System.Net.ServicePoint.SubmitRequest(HttpWebRequest request, String connName)
   at System.Net.HttpWebRequest.SubmitRequest(ServicePoint servicePoint)
   at System.Net.HttpWebRequest.GetResponse()
   at Microsoft.SharePoint.Client.SPWebRequestExecutor.Execute()
   at Microsoft.SharePoint.Client.ClientRequest.ExecuteQueryToServer(ChunkStringBuilder sb)
   at Microsoft.SharePoint.Client.ClientRequest.ExecuteQuery()
   at Microsoft.SharePoint.Client.ClientRuntimeContext.ExecuteQuery()
   at Microsoft.SharePoint.Client.ClientContext.ExecuteQuery()
   at Microsoft.SharePoint.Client.ClientContextExtensions.ExecuteQueryImplementation(ClientRuntimeContext clientContext, Int32 retryCount, Int32 delay, String userAgent) in c:\pnpbuild\Core\OfficeDevPnP.Core\Extensions\ClientContextExtensions.cs:line 173
   at Microsoft.SharePoint.Client.ClientContextExtensions.ExecuteQueryRetry(ClientRuntimeContext clientContext, Int32 retryCount, Int32 delay, String userAgent) in c:\pnpbuild\Core\OfficeDevPnP.Core\Extensions\ClientContextExtensions.cs:line 93
   at OfficeDevPnP.Core.Framework.Provisioning.ObjectHandlers.ObjectTermGroups.GetTerms[T](ClientRuntimeContext context, TaxonomyItem parent, Int32 defaultLanguage, Boolean isSiteCollectionTermGroup) in c:\pnpbuild\Core\OfficeDevPnP.Core\Framework\Provisioning\ObjectHandlers\ObjectTermGroups.cs:line 530
   at OfficeDevPnP.Core.Framework.Provisioning.ObjectHandlers.ObjectTermGroups.ExtractObjects(Web web, ProvisioningTemplate template, ProvisioningTemplateCreationInformation creationInfo) in c:\pnpbuild\Core\OfficeDevPnP.Core\Framework\Provisioning\ObjectHandlers\ObjectTermGroups.cs:line 487
   at OfficeDevPnP.Core.Framework.Provisioning.ObjectHandlers.SiteToTemplateConversion.GetRemoteTemplate(Web web, ProvisioningTemplateCreationInformation creationInfo) in c:\pnpbuild\Core\OfficeDevPnP.Core\Framework\Provisioning\ObjectHandlers\SiteToTemplateConversion.cs:line 152
   at Microsoft.SharePoint.Client.WebExtensions.GetProvisioningTemplate(Web web, ProvisioningTemplateCreationInformation creationInfo) in c:\pnpbuild\Core\OfficeDevPnP.Core\Extensions\WebExtensions.cs:line 1199
   at OfficeDevPnP.Core.Tests.Framework.Functional.Implementation.ImplementationBase.TestProvisioningTemplate(ClientContext cc, String templateName, Handlers handlersToProcess, ProvisioningTemplateApplyingInformation ptai, ProvisioningTemplateCreationInformation ptci) in c:\pnpbuild\Core\OfficeDevPnP.Core.Tests\Framework\Functional\Implementation\ImplementationBase.cs:line 59
HResult = -2146233040
Applying template - 1/2 - Initializing engine
Applying template - 2/2 - Term Groups
Getting template - 1/1 - Term Groups
-- Term group validation True
Applying template - 1/2 - Initializing engine
Applying template - 2/2 - Term Groups
Getting template - 1/1 - Term Groups



Debug Trace:
vstest.console.exe Information: 0 : 2020-01-13 19:50:19.0494	[Term Groups]	[13]	[Debug]	Code execution scope ended	100930ms	52ae5b20-982a-46ab-b41d-545807337be4
vstest.console.exe Information: 0 : 2020-01-13 19:50:19.0504	[Extraction]	[13]	[Debug]	Code execution scope ended	100932ms	52ae5b20-982a-46ab-b41d-545807337be4
vstest.console.exe Information: 0 : 2020-01-13 19:50:25.2499	[OfficeDevPnP.Core]	[0]	[Information]	File termgroup_add.xml retrieved from folder Templates	0ms	
vstest.console.exe Information: 0 : 2020-01-13 19:50:25.3329	[Provisioning]	[20]	[Debug]	Code execution scope started	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:25.3329	[Provisioning]	[20]	[Information]	ProgressDelegate registered	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:25.3899	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:25.3909	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:25.3909	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:25.3909	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:25.3909	[Term Groups]	[20]	[Debug]	Code execution scope started	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.3241	[Term Groups]	[20]	[Debug]	Code execution scope ended	7933ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.3251	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.3251	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.3251	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.3251	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.3251	[Persist Template Info]	[20]	[Debug]	Code execution scope started	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.4992	[Persist Template Info]	[20]	[Debug]	Code execution scope ended	173ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.4992	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.5001	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.5182	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.5182	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.5182	[Provisioning]	[20]	[Debug]	Code execution scope ended	8186ms	d61d43d9-5294-4181-a46a-b6fb7db8d6d1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.5192	[Extraction]	[20]	[Debug]	Code execution scope started	0ms	1587c715-4781-449c-9919-3b37a3ead3c1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.5192	[Extraction]	[20]	[Debug]	Base template available: STS0template	0ms	1587c715-4781-449c-9919-3b37a3ead3c1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.5192	[Extraction]	[20]	[Debug]	ProgressDelegate registered	0ms	1587c715-4781-449c-9919-3b37a3ead3c1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.5202	[Extraction]	[20]	[Debug]	IncludeAllTermGroups is set to true	0ms	1587c715-4781-449c-9919-3b37a3ead3c1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.5202	[Extraction]	[20]	[Debug]	IncludeSiteCollectionTermGroup is set to true	0ms	1587c715-4781-449c-9919-3b37a3ead3c1
vstest.console.exe Information: 0 : 2020-01-13 19:50:33.5202	[Term Groups]	[20]	[Debug]	Code execution scope started	0ms	1587c715-4781-449c-9919-3b37a3ead3c1
vstest.console.exe Information: 0 : 2020-01-13 20:02:16.1211	[Term Groups]	[20]	[Debug]	Code execution scope ended	702599ms	1587c715-4781-449c-9919-3b37a3ead3c1
vstest.console.exe Information: 0 : 2020-01-13 20:02:16.1341	[Retrieve Template Info]	[20]	[Debug]	Code execution scope started	0ms	1587c715-4781-449c-9919-3b37a3ead3c1
vstest.console.exe Information: 0 : 2020-01-13 20:02:16.2371	[Retrieve Template Info]	[20]	[Debug]	Code execution scope ended	102ms	1587c715-4781-449c-9919-3b37a3ead3c1
vstest.console.exe Information: 0 : 2020-01-13 20:02:16.2371	[Extraction]	[20]	[Debug]	Code execution scope ended	702718ms	1587c715-4781-449c-9919-3b37a3ead3c1
vstest.console.exe Information: 0 : 2020-01-13 20:02:30.8333	[OfficeDevPnP.Core]	[0]	[Information]	File termgroup_delta_1605.xml retrieved from folder Templates	0ms	
vstest.console.exe Information: 0 : 2020-01-13 20:02:30.8962	[Provisioning]	[20]	[Debug]	Code execution scope started	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:30.8962	[Provisioning]	[20]	[Information]	ProgressDelegate registered	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:30.9402	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:30.9412	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:30.9412	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:30.9412	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:30.9412	[Term Groups]	[20]	[Debug]	Code execution scope started	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.3335	[Term Groups]	[20]	[Debug]	Code execution scope ended	7392ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.3345	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.3345	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.3345	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.3355	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.3355	[Persist Template Info]	[20]	[Debug]	Code execution scope started	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4875	[Persist Template Info]	[20]	[Debug]	Code execution scope ended	152ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4875	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4875	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4886	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope started	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4886	[ProvisioningTemplate WebHook Call]	[20]	[Debug]	Code execution scope ended	0ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4886	[Provisioning]	[20]	[Debug]	Code execution scope ended	7592ms	76f4eac2-1145-4e79-98f1-52845d48e253
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4916	[Extraction]	[20]	[Debug]	Code execution scope started	0ms	f81b0acc-03b4-44f3-83f4-7c4cc6f241f9
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4916	[Extraction]	[20]	[Debug]	Base template available: STS0template	0ms	f81b0acc-03b4-44f3-83f4-7c4cc6f241f9
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4925	[Extraction]	[20]	[Debug]	ProgressDelegate registered	0ms	f81b0acc-03b4-44f3-83f4-7c4cc6f241f9
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4925	[Extraction]	[20]	[Debug]	IncludeAllTermGroups is set to true	0ms	f81b0acc-03b4-44f3-83f4-7c4cc6f241f9
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4925	[Extraction]	[20]	[Debug]	IncludeSiteCollectionTermGroup is set to true	0ms	f81b0acc-03b4-44f3-83f4-7c4cc6f241f9
vstest.console.exe Information: 0 : 2020-01-13 20:02:38.4925	[Term Groups]	[20]	[Debug]	Code execution scope started	0ms	f81b0acc-03b4-44f3-83f4-7c4cc6f241f9