Return-Path: X-Original-To: archive-asf-public-internal@cust-asf2.ponee.io Delivered-To: archive-asf-public-internal@cust-asf2.ponee.io Received: from cust-asf.ponee.io (cust-asf.ponee.io [163.172.22.183]) by cust-asf2.ponee.io (Postfix) with ESMTP id 0361A200C3D for ; Tue, 28 Feb 2017 00:56:43 +0100 (CET) Received: by cust-asf.ponee.io (Postfix) id 01DA0160B6C; Mon, 27 Feb 2017 23:56:43 +0000 (UTC) Delivered-To: archive-asf-public@cust-asf.ponee.io Received: from mail.apache.org (hermes.apache.org [140.211.11.3]) by cust-asf.ponee.io (Postfix) with SMTP id CDCDB160B60 for ; Tue, 28 Feb 2017 00:56:41 +0100 (CET) Received: (qmail 51545 invoked by uid 500); 27 Feb 2017 23:56:40 -0000 Mailing-List: contact user-help@ofbiz.apache.org; run by ezmlm Precedence: bulk List-Help: List-Unsubscribe: List-Post: List-Id: Reply-To: user@ofbiz.apache.org Delivered-To: mailing list user@ofbiz.apache.org Received: (qmail 51527 invoked by uid 99); 27 Feb 2017 23:56:40 -0000 Received: from pnap-us-west-generic-nat.apache.org (HELO spamd2-us-west.apache.org) (209.188.14.142) by apache.org (qpsmtpd/0.29) with ESMTP; Mon, 27 Feb 2017 23:56:40 +0000 Received: from localhost (localhost [127.0.0.1]) by spamd2-us-west.apache.org (ASF Mail Server at spamd2-us-west.apache.org) with ESMTP id F0C8D1A05E8 for ; Mon, 27 Feb 2017 23:56:39 +0000 (UTC) X-Virus-Scanned: Debian amavisd-new at spamd2-us-west.apache.org X-Spam-Flag: NO X-Spam-Score: 1.651 X-Spam-Level: * X-Spam-Status: No, score=1.651 tagged_above=-999 required=6.31 tests=[DKIM_SIGNED=0.1, DKIM_VALID=-0.1, DKIM_VALID_AU=-0.1, HTML_MESSAGE=2, KAM_BADIPHTTP=2, KAM_LOTSOFHASH=0.25, NORMAL_HTTP_TO_IP=0.001, RCVD_IN_DNSWL_NONE=-0.0001, RCVD_IN_SORBS_SPAM=0.5, RP_MATCHES_RCVD=-2.999, SPF_PASS=-0.001] autolearn=disabled Authentication-Results: spamd2-us-west.apache.org (amavisd-new); dkim=pass (2048-bit key) header.d=yahoo.com Received: from mx1-lw-us.apache.org ([10.40.0.8]) by localhost (spamd2-us-west.apache.org [10.40.0.9]) (amavisd-new, port 10024) with ESMTP id aXtHjcORNxT0 for ; Mon, 27 Feb 2017 23:56:34 +0000 (UTC) Received: from sonic322-4.consmr.mail.ne1.yahoo.com (sonic322-4.consmr.mail.ne1.yahoo.com [66.163.189.123]) by mx1-lw-us.apache.org (ASF Mail Server at mx1-lw-us.apache.org) with ESMTPS id 024995F23A for ; Mon, 27 Feb 2017 23:56:33 +0000 (UTC) X-YMail-OSG: Fv2dZE8VM1kZSKIVo7p8nLJyvoe3rZ5sXOpl5ANpt7UU8TzsnMAOZa2CpGXrPnN u8xu6EAnWvcyrfm2XhsuQj2jXU7R7NdlyMIRCQuJYEhgiCgQ8WtoborAzX1k1xPCaOubfyQFj9lX mH1hunqVZRRGGR0lKxHydXS0FZ2qKdY964DEfC7O6bm.tX8RP_GR1NsuLLFkv9bBZRUBwFBpxXRk xj7E2qq_Ngra3hPLP1XcSiULLqe.v0_9emwXkrqKR9yY8iYojXfV6lBUoi_ridlHBp2wIQaPexY6 4th6uM59REP0.HC0OPNYefT3xCS1vpAkpsd.y.Ase49e1H9Qv4iUaBpGDetgIhAKZ7gv9WKdKl4I krhihJFMtVXdtVFXznHPdLnWJHE0yfYrS3aBQRnXIANFd2Ii.e7ehkHUGNRIHDt.2nXPslZXP1.j bJPjTq96e6KIu6iORAae.tuqtK3.SGslkFn.114a00J.GHPtt_qVlOYTpEPl50sPGKmbVHlNGzOk QsDAzaEueEV6KzSoCscetcvmAM9P_ Received: from sonic.gate.mail.ne1.yahoo.com by sonic322.consmr.mail.ne1.yahoo.com with HTTP; Mon, 27 Feb 2017 23:56:33 +0000 Date: Mon, 27 Feb 2017 23:52:32 +0000 (UTC) From: Alfonso Barreto Reply-To: Alfonso Barreto To: "user@ofbiz.apache.org" Message-ID: <1111931956.2272134.1488239552498@mail.yahoo.com> In-Reply-To: References: <1487580718051-4702639.post@n4.nabble.com> <1487674764317-4702683.post@n4.nabble.com> Subject: Problem consuming ofbiz soap services from PHP MIME-Version: 1.0 Content-Type: multipart/alternative; boundary="----=_Part_2272133_510334073.1488239552494" archived-at: Mon, 27 Feb 2017 23:56:43 -0000 ------=_Part_2272133_510334073.1488239552494 Content-Type: text/plain; charset=UTF-8 Content-Transfer-Encoding: quoted-printable Been trying to find and updated reference for this, but still haven't found= it. I try to consume the soap=C2=A0 testing services that comes on ofbiz, but f= or some reason, the parameters are not readed on the server part. This is t= he code Iam using on PHP, tryed several combinations but cant find the rigt= h one.=C2=A0=20 Will appreciate some help. =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0ini= _set('soap.wsdl_cache_enabled', 0); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 ini_set(= 'soap.wsdl_cache_ttl', 900); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 ini_set(= 'default_socket_timeout', 15); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=20 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 //$wsdl = =3D 'https://107.180.69.62/webtools/control/SOAPService/getProductInventory= Available?WSDL'; =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 //$wsdl = =3D 'https://107.180.69.62/webtools/control/SOAPService/testRemoteSoap?WSDL= '; =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 //$wsdl = =3D 'https://107.180.69.62/webtools/control/SOAPService/testRemoteSoap1?WSD= L'; =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 //$wsdl = =3D 'https://107.180.69.62/webtools/control/SOAPService/testSoapSimple?WSDL= '; =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 $wsdl = =3D 'https://107.180.69.62/webtools/control/SOAPService/testSoap?WSDL'; =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 $wsdl = =3D 'https://107.180.69.62/product/control/soapGetProductNames/soapWebServi= ce?WSDL'; =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 $data=3D= null; =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 $options= =3D array( =C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0 //'style'=3D>SOAP_RPC, =C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0 //'use'=3D>SOAP_ENCODED, =C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0 'soap_version'=3D>SOAP_1_2, =C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0 //'cache_wsdl'=3D>WSDL_CACHE_NONE, =C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0 'connection_timeout'=3D>15, =C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0 'trace'=3D>true, =C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0 'encoding'=3D>'UTF-8', =C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0 'exceptions'=3D>true, =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 ); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 try { =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 $soap =3D new SoapClient($wsdl,$options); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 //$soap->__soapCall('lupe','lupe','lupe1234','es',null,test= SoapSimple', array($params)); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 //$data =3D $soap->testSoapSimple(array('lupe','lupe','lupe= 1234','es',null,34.5,'testPrueba')); //$params); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 //$data =3D $soap->testSoap(array('lupe','lupe','lupe1234',= 'es',null,34.5,'testPrueba'));=20 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 //$data =3D $soap->testRemoteSoap(array(34.6,'Prueba2Test',= 'lupe','lupe1234')); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 //$data =3D $soap->testRemoteSoap1(array('56789','LatLonLis= tZipCode')); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 $data =3D $soap->soapWebService(array('prueba')); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 } =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 catch(Ex= ception $e) { =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 print $e->getMessage(); =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 } =C2=A0=20 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 var_dump= ($data); In any combination I use, this is the log I get on the server: 2017-02-27 17:49:38,757 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0 VisitHandler.java:233:INFO ] Found visitorId [null] in cookie 2017-02-27 17:49:38,840 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:282:INFO ] This is the first request in this visit. sessio= nId=3DA41F2EF98F6C29894283AB3FAE4F739B.jvm1 2017-02-27 17:49:38,841 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#check509CertLogin] from [preprocessor], result is [success] 2017-02-27 17:49:38,842 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#checkRequestHeaderLogin] from [preprocessor], result is [success] 2017-02-27 17:49:38,842 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#checkServletRequestRemoteUserLogin] from [preprocessor], result is [s= uccess] 2017-02-27 17:49:38,843 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#checkExternalLoginKey] from [preprocessor], result is [success] 2017-02-27 17:49:38,844 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.Protec= tViewWorker#checkProtectedView] from [preprocessor], result is [success] 2017-02-27 17:49:38,880 (http-0.0.0.0-443-10) [=C2=A0=C2=A0 SOAPEventHandle= r.java:160:INFO ] Request Message: <= /map-Entry> 2017-02-27 17:49:38,897 (http-0.0.0.0-443-10) [=C2=A0=C2=A0 SOAPEventHandle= r.java:261:INFO ] Response Message: =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0 2017-02-27 17:49:38,899 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:421:ERROR] Request SOAPService caused an error with the fo= llowing message: Error calling event: org.ofbiz.webapp.event.EventHandlerEx= ception 2017-02-27 17:49:38,900 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0 ServerHitBin.java:628:INFO ] Visit delegatorName=3Ddefault, Serve= rHitBin delegatorName=3Ddefault 2017-02-27 17:49:38,934 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0 ServerHitBin.java:722:INFO ] Duplicate ServerHit was updated: [Ge= nericEntity:ServerHit][contentId,webtools.SOAPService(java.lang.String)][cr= eatedStamp,2017-02-27 17:49:38.903(java.sql.Timestamp)][createdTxStamp,2017= -02-27 17:49:38.9(java.sql.Timestamp)][hitStartDateTime,2017-02-27 17:49:38= .756(java.sql.Timestamp)][hitTypeId,REQUEST(java.lang.String)][lastUpdatedS= tamp,2017-02-27 17:49:38.903(java.sql.Timestamp)][lastUpdatedTxStamp,2017-0= 2-27 17:49:38.9(java.sql.Timestamp)][referrerUrl,(java.lang.String)][reques= tUrl,https://107.180.69.62/webtools/control/SOAPService(java.lang.String)][= runningTimeMillis,143(java.lang.Long)][serverHostName,s107-180-69-62.secure= server.net(java.lang.String)][serverIpAddress,107.180.69.62(java.lang.Strin= g)][visitId,11053(java.lang.String)] 2017-02-27 17:49:38,935 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Con= trolServlet.java:328:INFO ] [[[SOAPService] Request Done- total:0.177,since= last([SOAPService] Req...):0.177]] 2017-02-27 17:50:29,461 (http-0.0.0.0-443-10) [ControlEventListener.java:65= :INFO ] Creating session: C458AFF4A31D8B54E2F7E547FC4DF4BA.jvm1 2017-02-27 17:50:29,462 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0 ContextFilter.java:202:INFO ] [Request]: /webtools/control/SOAPService/= testSoap 2017-02-27 17:50:29,464 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Con= trolServlet.java:145:INFO ] [[[SOAPService] Request Begun, encoding=3D[UTF-= 8]- total:0.0,since last(Begin):0.0]] 2017-02-27 17:50:29,464 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0 VisitHandler.java:233:INFO ] Found visitorId [null] in cookie 2017-02-27 17:50:29,599 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0 ConfigXML= Reader.java:184:INFO ] controller loaded: 0.0s, 23 requests, 16 views in fi= le:/mnt/opentaps-1.5.0/framework/common/webcommon/WEB-INF/common-controller= .xml 2017-02-27 17:50:29,602 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0 ConfigXML= Reader.java:184:INFO ] controller loaded: 0.0s, 5 requests, 0 views in file= :/mnt/opentaps-1.5.0/framework/common/webcommon/WEB-INF/tempexpr-controller= .xml 2017-02-27 17:50:29,605 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0 ConfigXML= Reader.java:184:INFO ] controller loaded: 0.0s, 8 requests, 2 views in file= :/mnt/opentaps-1.5.0/framework/testtools/webapp/testtools/WEB-INF/controlle= r.xml 2017-02-27 17:50:29,606 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0 ConfigXML= Reader.java:184:INFO ] controller loaded: 0.01s, 110 requests, 64 views in = file:/mnt/opentaps-1.5.0/framework/webtools/webapp/webtools/WEB-INF/control= ler.xml 2017-02-27 17:50:29,606 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:282:INFO ] This is the first request in this visit. sessio= nId=3DC458AFF4A31D8B54E2F7E547FC4DF4BA.jvm1 2017-02-27 17:50:29,607 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#check509CertLogin] from [preprocessor], result is [success] 2017-02-27 17:50:29,608 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#checkRequestHeaderLogin] from [preprocessor], result is [success] 2017-02-27 17:50:29,608 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#checkServletRequestRemoteUserLogin] from [preprocessor], result is [s= uccess] 2017-02-27 17:50:29,609 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#checkExternalLoginKey] from [preprocessor], result is [success] 2017-02-27 17:50:29,610 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.Protec= tViewWorker#checkProtectedView] from [preprocessor], result is [success] 2017-02-27 17:50:29,623 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [soap:#] from [request], result is [n= ull] 2017-02-27 17:50:29,624 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0 ServerHitBin.java:628:INFO ] Visit delegatorName=3Ddefault, Serve= rHitBin delegatorName=3Ddefault 2017-02-27 17:50:29,658 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0 ServerHitBin.java:722:INFO ] Duplicate ServerHit was updated: [Ge= nericEntity:ServerHit][contentId,webtools.SOAPService(java.lang.String)][cr= eatedStamp,2017-02-27 17:50:29.628(java.sql.Timestamp)][createdTxStamp,2017= -02-27 17:50:29.625(java.sql.Timestamp)][hitStartDateTime,2017-02-27 17:50:= 29.464(java.sql.Timestamp)][hitTypeId,REQUEST(java.lang.String)][lastUpdate= dStamp,2017-02-27 17:50:29.628(java.sql.Timestamp)][lastUpdatedTxStamp,2017= -02-27 17:50:29.625(java.sql.Timestamp)][referrerUrl,(java.lang.String)][re= questUrl,https://107.180.69.62/webtools/control/SOAPService/testSoap?WSDL(j= ava.lang.String)][runningTimeMillis,160(java.lang.Long)][serverHostName,s10= 7-180-69-62.secureserver.net(java.lang.String)][serverIpAddress,107.180.69.= 62(java.lang.String)][visitId,11054(java.lang.String)] 2017-02-27 17:50:29,658 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Con= trolServlet.java:328:INFO ] [[[SOAPService] Request Done- total:0.194,since= last([SOAPService] Req...):0.194]] 2017-02-27 17:50:31,362 (http-0.0.0.0-443-10) [ControlEventListener.java:65= :INFO ] Creating session: D5C0BEB00515DC3D18C765C9D85D1834.jvm1 2017-02-27 17:50:31,362 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0 ContextFilter.java:202:INFO ] [Request]: /webtools/control/SOAPService 2017-02-27 17:50:31,364 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Con= trolServlet.java:145:INFO ] [[[SOAPService] Request Begun, encoding=3D[utf-= 8]- total:0.0,since last(Begin):0.0]] 2017-02-27 17:50:31,365 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0 VisitHandler.java:233:INFO ] Found visitorId [null] in cookie 2017-02-27 17:50:31,458 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:282:INFO ] This is the first request in this visit. sessio= nId=3DD5C0BEB00515DC3D18C765C9D85D1834.jvm1 2017-02-27 17:50:31,459 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#check509CertLogin] from [preprocessor], result is [success] 2017-02-27 17:50:31,460 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#checkRequestHeaderLogin] from [preprocessor], result is [success] 2017-02-27 17:50:31,461 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#checkServletRequestRemoteUserLogin] from [preprocessor], result is [s= uccess] 2017-02-27 17:50:31,461 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.LoginW= orker#checkExternalLoginKey] from [preprocessor], result is [success] 2017-02-27 17:50:31,462 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:641:INFO ] Ran Event [java:org.ofbiz.webapp.control.Protec= tViewWorker#checkProtectedView] from [preprocessor], result is [success] 2017-02-27 17:50:31,473 (http-0.0.0.0-443-10) [=C2=A0=C2=A0 SOAPEventHandle= r.java:160:INFO ] Request Message: <= /map-Entry> 2017-02-27 17:50:31,486 (http-0.0.0.0-443-10) [=C2=A0=C2=A0 SOAPEventHandle= r.java:261:INFO ] Response Message: =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0=C2=A0 =C2=A0=C2=A0=C2=A0 2017-02-27 17:50:31,488 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Req= uestHandler.java:421:ERROR] Request SOAPService caused an error with the fo= llowing message: Error calling event: org.ofbiz.webapp.event.EventHandlerEx= ception 2017-02-27 17:50:31,488 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0 ServerHitBin.java:628:INFO ] Visit delegatorName=3Ddefault, Serve= rHitBin delegatorName=3Ddefault 2017-02-27 17:50:31,530 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0=C2= =A0=C2=A0 ServerHitBin.java:722:INFO ] Duplicate ServerHit was updated: [Ge= nericEntity:ServerHit][contentId,webtools.SOAPService(java.lang.String)][cr= eatedStamp,2017-02-27 17:50:31.492(java.sql.Timestamp)][createdTxStamp,2017= -02-27 17:50:31.489(java.sql.Timestamp)][hitStartDateTime,2017-02-27 17:50:= 31.364(java.sql.Timestamp)][hitTypeId,REQUEST(java.lang.String)][lastUpdate= dStamp,2017-02-27 17:50:31.492(java.sql.Timestamp)][lastUpdatedTxStamp,2017= -02-27 17:50:31.489(java.sql.Timestamp)][referrerUrl,(java.lang.String)][re= questUrl,https://107.180.69.62/webtools/control/SOAPService(java.lang.Strin= g)][runningTimeMillis,124(java.lang.Long)][serverHostName,s107-180-69-62.se= cureserver.net(java.lang.String)][serverIpAddress,107.180.69.62(java.lang.S= tring)][visitId,11055(java.lang.String)] 2017-02-27 17:50:31,530 (http-0.0.0.0-443-10) [=C2=A0=C2=A0=C2=A0=C2=A0 Con= trolServlet.java:328:INFO ] [[[SOAPService] Request Done- total:0.166,since= last([SOAPService] Req...):0.166]] ------=_Part_2272133_510334073.1488239552494--