Details
-
Bug
-
Status: Resolved
-
Major
-
Resolution: Fixed
-
0.6
-
None
Description
The issue is that we are getting an internal server error rather than actual error. Here is a sample request and repsponse:
2014-10-22 08:28:56,983 INFO - [pool-7-thread-1:getKilledProcessInstance] ~ Request Url: http://ip-172-31-42-154.ec2.internal:15000/api/instance/running/process/agregator-coord16-e886079f?colo=*&user.name=hrt_qa (BaseRequest:125) 2014-10-22 08:28:56,983 INFO - [pool-7-thread-1:getKilledProcessInstance] ~ Request Method: GET (BaseRequest:126) 2014-10-22 08:28:56,983 INFO - [pool-7-thread-1:getKilledProcessInstance] ~ Request Header: Name=Cookie Value=hadoop.auth=u=hrt_qa&p=hrt_qa&t=simple&e=1414000504973&s=GfzaDNqg5Kek0NAFXTDndJw/76k= (BaseRequest:129) 2014-10-22 08:28:56,997 INFO - [pool-7-thread-1:getKilledProcessInstance] ~ Response Status: HTTP/1.1 500 org.apache.falcon.entity.EntityNotRegisteredException: agregator-coord16-e886079f (PROCESS) not found (BaseRequest:155) 2014-10-22 08:28:56,997 INFO - [pool-7-thread-1:getKilledProcessInstance] ~ Response Header: Name=Content-Type Value=text/html; charset=iso-8859-1 (BaseRequest:157) 2014-10-22 08:28:56,998 INFO - [pool-7-thread-1:getKilledProcessInstance] ~ Response Header: Name=Cache-Control Value=must-revalidate,no-cache,no-store (BaseRequest:157) 2014-10-22 08:28:56,998 INFO - [pool-7-thread-1:getKilledProcessInstance] ~ Response Header: Name=Content-Length Value=4137 (BaseRequest:157) 2014-10-22 08:28:56,999 INFO - [pool-7-thread-1:getKilledProcessInstance] ~ Response Header: Name=Server Value=Jetty(6.1.26) (BaseRequest:157) Warning: org.apache.xerces.parsers.SAXParser: Property 'http://javax.xml.XMLConstants/property/accessExternalDTD' is not recognized. Warning: org.apache.xerces.parsers.SAXParser: Property 'http://www.oracle.com/xml/jaxp/properties/entityExpansionLimit' is not recognized. 2014-10-22 08:28:57,003 INFO - [pool-7-thread-1:getKilledProcessInstance] ~ The web service response is: <html> <head> <META http-equiv="Content-Type" content="text/html; charset=UTF-8"> <meta http-equiv="Content-Type" content="text/html; charset=ISO-8859-1"> <title>Error 500 org.apache.falcon.entity.EntityNotRegisteredException: agregator-coord16-e886079f (PROCESS) not found</title> </head> <body> <h2>HTTP ERROR 500</h2> <p>Problem accessing /api/instance/running/process/agregator-coord16-e886079f. Reason: <pre> org.apache.falcon.entity.EntityNotRegisteredException: agregator-coord16-e886079f (PROCESS) not found</pre> </p> <h3>Caused by:</h3> <pre></pre> <h3>Caused by:</h3> <pre>org.apache.falcon.entity.EntityNotRegisteredException: agregator-coord16-e886079f (PROCESS) not found at org.apache.falcon.entity.EntityUtil.getEntity(EntityUtil.java:80) at org.apache.falcon.security.DefaultAuthorizationProvider.getEntity(DefaultAuthorizationProvider.java:296) at org.apache.falcon.security.DefaultAuthorizationProvider.authorizeEntityResource(DefaultAuthorizationProvider.java:284) at org.apache.falcon.security.DefaultAuthorizationProvider.authorizeResource(DefaultAuthorizationProvider.java:137) at org.apache.falcon.security.FalconAuthorizationFilter.doFilter(FalconAuthorizationFilter.java:68) at org.mortbay.jetty.servlet.ServletHandler$CachedChain.doFilter(ServletHandler.java:1212) at org.apache.falcon.security.FalconAuthenticationFilter$2.doFilter(FalconAuthenticationFilter.java:187) at org.apache.hadoop.security.authentication.server.AuthenticationFilter.doFilter(AuthenticationFilter.java:572) at org.apache.hadoop.security.authentication.server.AuthenticationFilter.doFilter(AuthenticationFilter.java:542) at org.apache.falcon.security.FalconAuthenticationFilter.doFilter(FalconAuthenticationFilter.java:197) at org.mortbay.jetty.servlet.ServletHandler$CachedChain.doFilter(ServletHandler.java:1212) at org.apache.falcon.security.FalconAuditFilter.doFilter(FalconAuditFilter.java:56) at org.mortbay.jetty.servlet.ServletHandler$CachedChain.doFilter(ServletHandler.java:1212) at org.mortbay.jetty.servlet.ServletHandler.handle(ServletHandler.java:399) at org.mortbay.jetty.security.SecurityHandler.handle(SecurityHandler.java:216) at org.mortbay.jetty.servlet.SessionHandler.handle(SessionHandler.java:182) at org.mortbay.jetty.handler.ContextHandler.handle(ContextHandler.java:766) at org.mortbay.jetty.webapp.WebAppContext.handle(WebAppContext.java:450) at org.mortbay.jetty.handler.HandlerWrapper.handle(HandlerWrapper.java:152) at org.mortbay.jetty.Server.handle(Server.java:326) at org.mortbay.jetty.HttpConnection.handleRequest(HttpConnection.java:542) at org.mortbay.jetty.HttpConnection$RequestHandler.headerComplete(HttpConnection.java:928) at org.mortbay.jetty.HttpParser.parseNext(HttpParser.java:549) at org.mortbay.jetty.HttpParser.parseAvailable(HttpParser.java:212) at org.mortbay.jetty.HttpConnection.handle(HttpConnection.java:404) at org.mortbay.jetty.bio.SocketConnector$Connection.run(SocketConnector.java:228) at org.mortbay.thread.QueuedThreadPool$PoolThread.run(QueuedThreadPool.java:582) </pre> <hr> <i><small>Powered by Jetty://</small></i> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> <br> </body> </html>
Noting interesting in falcon.application.log, adding here for completeness:
2014-10-22 08:28:56,993 INFO - [825699078@qtp-1778018115-52:hrt_qa:GET//instance/running/process/agregator-coord16-e886079f 790948a7-2c85-45d8-a1e9-0147ae06534b] ~ Request from user: hrt_qa, URL=/api/instance/running/process/agregator-coord16-e886079f?colo=*&user.name=hrt_qa (FalconAuthenticationFilter:184) 2014-10-22 08:28:56,993 INFO - [825699078@qtp-1778018115-52:hrt_qa:GET//instance/running/process/agregator-coord16-e886079f 790948a7-2c85-45d8-a1e9-0147ae06534b] ~ Authorizing user=hrt_qa against request=RequestParts{resource='instance', action='running', entityName='agregator-coord16-e886079f', entityType='process'} (FalconAuthorizationFilter:67) 2014-10-22 08:28:56,993 INFO - [825699078@qtp-1778018115-52:hrt_qa:GET//instance/running/process/agregator-coord16-e886079f 790948a7-2c85-45d8-a1e9-0147ae06534b] ~ Authorizing authenticatedUser=hrt_qa, against resource=instance, action=running, entity name=agregator-coord16-e886079f, entity type=process (DefaultAuthorizationProvider:125) 2014-10-22 08:28:56,993 DEBUG - [825699078@qtp-1778018115-52:hrt_qa:GET//instance/running/process/agregator-coord16-e886079f 790948a7-2c85-45d8-a1e9-0147ae06534b] ~ Authorizing authenticatedUser=hrt_qa against entity/instance action=running, entity name=agregator-coord16-e886079f, entity type=process (DefaultAuthorizationProvider:279) 2014-10-22 08:28:56,994 DEBUG - [825699078@qtp-1778018115-52:] ~ Audit: hrt_qa/172.31.42.154 performed request http://ip-172-31-42-154.ec2.internal:15000/api/instance/running/process/agregator-coord16-e886079f?colo=*&user.name=hrt_qa (172.31.42.154) at time 2014-10-22T08:28Z (FalconAuditFilter:69) 2014-10-22 08:28:56,994 WARN - [825699078@qtp-1778018115-52:] ~ /api/instance/running/process/agregator-coord16-e886079f: org.apache.hadoop.security.authorize.AuthorizationException: org.apache.falcon.entity.EntityNotRegisteredException: agregator-coord16-e886079f (PROCESS) not found (log:76)