Какой 130-секундный тайм-аут убивает мой вызов службы потоковой передачи WCF?

Совсем недавно я начал исследовать сложную проблему с потоковой передачей WCF, в которой создается исключение CommunicationException, если клиент ждет более 130 секунд между отправками на сервер.

Вот полное исключение:

System.ServiceModel.CommunicationException was unhandled by user code
  HResult=-2146233087
  Message=The socket connection was aborted. This could be caused by an error processing your message or a receive timeout being exceeded by the remote host, or an underlying network resource issue. Local socket timeout was '23:59:59.9110000'.
  Source=mscorlib
  StackTrace:
    Server stack trace: 
       at System.ServiceModel.Channels.HttpOutput.WebRequestHttpOutput.WebRequestOutputStream.Write(Byte[] buffer, Int32 offset, Int32 count)
       at System.IO.BufferedStream.Write(Byte[] array, Int32 offset, Int32 count)
       at System.Xml.XmlStreamNodeWriter.FlushBuffer()
       at System.Xml.XmlStreamNodeWriter.GetBuffer(Int32 count, Int32& offset)
       at System.Xml.XmlUTF8NodeWriter.InternalWriteBase64Text(Byte[] buffer, Int32 offset, Int32 count)
       at System.Xml.XmlBaseWriter.WriteBase64(Byte[] buffer, Int32 offset, Int32 count)
       at System.Xml.XmlDictionaryWriter.WriteValue(IStreamProvider value)
       at System.ServiceModel.Dispatcher.StreamFormatter.Serialize(XmlDictionaryWriter writer, Object[] parameters, Object returnValue)
       at System.ServiceModel.Dispatcher.OperationFormatter.OperationFormatterMessage.OperationFormatterBodyWriter.OnWriteBodyContents(XmlDictionaryWriter writer)
       at System.ServiceModel.Channels.Message.OnWriteMessage(XmlDictionaryWriter writer)
       at System.ServiceModel.Channels.TextMessageEncoderFactory.TextMessageEncoder.WriteMessage(Message message, Stream stream)
       at System.ServiceModel.Channels.HttpOutput.WriteStreamedMessage(TimeSpan timeout)
       at System.ServiceModel.Channels.HttpOutput.Send(TimeSpan timeout)
       at System.ServiceModel.Channels.HttpChannelFactory`1.HttpRequestChannel.HttpChannelRequest.SendRequest(Message message, TimeSpan timeout)
       at System.ServiceModel.Channels.RequestChannel.Request(Message message, TimeSpan timeout)
       at System.ServiceModel.Channels.ServiceChannel.Call(String action, Boolean oneway, ProxyOperationRuntime operation, Object[] ins, Object[] outs, TimeSpan timeout)
       at System.ServiceModel.Channels.ServiceChannelProxy.InvokeService(IMethodCallMessage methodCall, ProxyOperationRuntime operation)
       at System.ServiceModel.Channels.ServiceChannelProxy.Invoke(IMessage message)
    Exception rethrown at [0]: 
       at System.Runtime.Remoting.Proxies.RealProxy.HandleReturnMessage(IMessage reqMsg, IMessage retMsg)
       at System.Runtime.Remoting.Proxies.RealProxy.PrivateInvoke(MessageData& msgData, Int32 type)
       at WcfService.IStreamingService.SendStream(MyStreamUpRequest request)
       at Client.Program.<Main>b__0() in c:\Users\jpierson\Documents\Visual Studio 2012\Projects\WcfStreamingTest\Client\Program.cs:line 44
       at System.Threading.Tasks.Task.Execute()
  InnerException: System.IO.IOException
       HResult=-2146232800
       Message=Unable to write data to the transport connection: An existing connection was forcibly closed by the remote host.
       Source=System
       StackTrace:
            at System.Net.Sockets.NetworkStream.MultipleWrite(BufferOffsetSize[] buffers)
            at System.Net.ConnectStream.InternalWrite(Boolean async, Byte[] buffer, Int32 offset, Int32 size, AsyncCallback callback, Object state)
            at System.Net.ConnectStream.Write(Byte[] buffer, Int32 offset, Int32 size)
            at System.ServiceModel.Channels.BytesReadPositionStream.Write(Byte[] buffer, Int32 offset, Int32 count)
            at System.ServiceModel.Channels.HttpOutput.WebRequestHttpOutput.WebRequestOutputStream.Write(Byte[] buffer, Int32 offset, Int32 count)
       InnerException: System.Net.Sockets.SocketException
            HResult=-2147467259
            Message=An existing connection was forcibly closed by the remote host
            Source=System
            ErrorCode=10054
            NativeErrorCode=10054
            StackTrace:
                 at System.Net.Sockets.Socket.MultipleSend(BufferOffsetSize[] buffers, SocketFlags socketFlags)
                 at System.Net.Sockets.NetworkStream.MultipleWrite(BufferOffsetSize[] buffers)
            InnerException: 

Похоже, что сервер преждевременно закрыл соединение из-за бездействия соединения. Если вместо этого я даю импульс серверу, хотя бы по одному байту за раз, я никогда не получу этого исключения и могу продолжать передавать данные бесконечно. Я создал очень простой пример приложения, чтобы продемонстрировать это, которое использует basicHttpBinding с Streamed transferMode, и я вставляю искусственную задержку из реализации настраиваемого потока на клиенте, которая задерживается на 130 секунд. Это имитирует что-то похожее на состояние недостаточной загрузки буфера, при котором поток, предоставленный в моем вызове службы от клиента, не передает данные в инфраструктуру WCF достаточно быстро, чтобы удовлетворить какое-то неидентифицируемое значение тайм-аута, которое, по-видимому, составляет около 130 секунд. отметка.

Используя инструменты трассировки службы WCF, я могу найти исключение HttpException с сообщением, которое гласит: «Клиент отключен, поскольку базовый запрос был выполнен. HttpContext больше не доступен».

В файле журнала трассировки IIS Express я вижу запись, в которой говорится: «Операция ввода-вывода была прервана из-за выхода потока или запроса приложения. (0x800703e3)»

Я настроил тайм-ауты сервера и клиента, чтобы использовать значение, превышающее 130-секундную отметку, просто чтобы исключить их. Я пробовал idleTimeout в IIS Express и множество значений тайм-аута, связанных с ASP.NET, чтобы выяснить, откуда эта проблема, но пока безуспешно. Лучшая информация, которую я могу найти на данный момент, - это комментарий в системе отслеживания проблем FireFox разработчика, который описывает аналогичную проблему, работающую вне архитектуры WCF. По этой причине я предполагаю, что проблема может быть больше связана с IIS7 или, возможно, с Windows Server.

Пользовательская привязка на сервере Web.config

<binding name="myHttpBindingConfiguration"
         closeTimeout="02:00:00"
         openTimeout="02:00:00"
         receiveTimeout="02:00:00"
         sendTimeout="02:00:00">
  <textMessageEncoding messageVersion="Soap11" />
  <httpTransport maxBufferSize="65536"                        
                 maxReceivedMessageSize="2147483647"
                 maxBufferPoolSize="2147483647"
                 transferMode="Streamed" />
</binding>

Конфигурация на стороне клиента в коде:

    var binding = new BasicHttpBinding();
    binding.MaxReceivedMessageSize = _maxReceivedMessageSize;
    binding.MaxBufferSize = 65536;
    binding.ReaderQuotas.MaxStringContentLength = int.MaxValue;
    binding.ReaderQuotas.MaxArrayLength = int.MaxValue;
    binding.TransferMode = TransferMode.Streamed;
    binding.ReceiveTimeout = TimeSpan.FromDays(1);
    binding.OpenTimeout = TimeSpan.FromDays(1);
    binding.SendTimeout = TimeSpan.FromDays(1);
    binding.CloseTimeout = TimeSpan.FromDays(1);

В ответ на идею wals попытаться увидеть, получаю ли я какие-либо другие результаты при самостоятельном размещении моей службы, я хочу добавить, что я сделал это и обнаружил, что получаю те же результаты, что и при размещении в IIS. Что это значит? Я предполагаю, что это означает, что проблема либо в WCF, либо в базовой сетевой инфраструктуре Windows. Я использую 64-разрядную версию Windows 7, и мы обнаружили эту проблему, запустив различные клиенты и запустив служебную часть на Windows 2008 Server.

Обновление 2013-01-15

Я нашел несколько новых подсказок благодаря DarkWanderer, когда понял, что WCF использует HTTP.sys в сценариях самостоятельного хостинга в Windows 7. Это заставило меня задуматься о том, что я могу настроить для HTTP.sys, а также о том, о каких проблемах сообщают люди. для HTTP.sys это похоже на то, что я испытываю. Это привело меня к файлу журнала, расположенному в C: \ Windows \ System32 \ LogFiles \ HTTPERR \ httperr1.log, который, по-видимому, регистрирует определенные типы проблем HTTP со стороны HTTP.sys. В этом журнале каждый раз, когда я запускаю свой тест, я вижу запись в журнале следующего типа.

2013-01-15 17:17:12 127.0.0.1 59111 127.0.0.1 52733 HTTP / 1.1 POST /StreamingService.svc - - Timer_EntityBody -

Итак, нужно выяснить, какие условия могут вызвать ошибку Timer_EntityBody и какие настройки в IIS7 или в другом месте могут иметь отношение к когда и если возникает эта ошибка.

На официальном веб-сайте IIS:

Соединение истекло до прибытия тела запроса. Когда становится ясно, что запрос имеет тело сущности, HTTP API включает таймер Timer_EntityBody. Первоначально предел этого таймера устанавливается равным значению connectionTimeout. Каждый раз, когда по этому запросу получено другое указание данных, HTTP API сбрасывает таймер, чтобы дать соединению больше минут, как указано в атрибуте connectionTimeout.

Попытка изменить атрибут connectionTimeout, как указано в приведенной выше ссылке, в applicationhost.config для IIS Express, похоже, не имеет никакого значения. Возможно, IIS Express игнорирует эту конфигурацию и внутренне использует жестко запрограммированное значение? Попробовав что-то самостоятельно, я обнаружил, что для отображения и добавления значений тайм-аута добавлены новые http-команды netsh, поэтому, давая мне понять, я придумал следующую команду, но, к сожалению, это не повлияло на эту ошибку.

netsh http add timeout timeouttype = значение IdleConnectionTimeout = 300