Skip to content
New issue

Have a question about this project? Sign up for a free GitHub account to open an issue and contact its maintainers and the community.

By clicking “Sign up for GitHub”, you agree to our terms of service and privacy statement. We’ll occasionally send you account related emails.

Already on GitHub? Sign in to your account

User other than admin not able to add Basic Collection or Basic Image content successfully #78

Closed
ruebot opened this issue Oct 14, 2015 · 6 comments

Comments

@ruebot
Copy link
Member

ruebot commented Oct 14, 2015

If a new Drupal user is created:

  • let's call it islandora with the password islandora
  • /opt/apache-karaf-3.0.4/etc/islandora.cfg is updated to reflect this user
  • bundles are restarted bundle:restart
  • and the islandora tries to add content, we get a 400 bad request, error output looks like:
2015-10-14 02:17:11,741 | INFO  | h for user karaf | CacheManagerFactory              | 171 - org.apache.camel.camel-cache - 2.15.2 | Turned off EHCache update checker. updateCheck=false
2015-10-14 02:17:12,024 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: drupalLogout started and consuming from: Endpoint[direct://drupalLogout]
2015-10-14 02:17:12,025 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: addTokenToCache started and consuming from: Endpoint[direct://addTokenToCache]
2015-10-14 02:17:12,026 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: extractDrupalToken started and consuming from: Endpoint[direct://extractDrupalToken]
2015-10-14 02:17:12,028 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: addCookieToCache started and consuming from: Endpoint[direct://addCookieToCache]
2015-10-14 02:17:12,029 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: extractDrupalSession started and consuming from: Endpoint[direct://extractDrupalSession]
2015-10-14 02:17:12,030 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: drupalLogin started and consuming from: Endpoint[direct://drupalLogin]
2015-10-14 02:17:12,039 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: drupalAuthenticate started and consuming from: Endpoint[direct://drupalAuthenticate]
2015-10-14 02:17:12,040 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getTokenFromCache started and consuming from: Endpoint[direct://getTokenFromCache]
2015-10-14 02:17:12,041 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getCookieFromCache started and consuming from: Endpoint[direct://getCookieFromCache]
2015-10-14 02:17:12,042 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getDrupalAuthInfo started and consuming from: Endpoint[direct://getDrupalAuthInfo]
2015-10-14 02:17:12,043 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route26 started and consuming from: Endpoint[direct://drupalAddMediumSize]
2015-10-14 02:17:12,043 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route27 started and consuming from: Endpoint[direct://drupalAddTn]
2015-10-14 02:17:12,044 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route28 started and consuming from: Endpoint[direct://fedoraGetBinary]
2015-10-14 02:17:12,045 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route29 started and consuming from: Endpoint[direct://getParentUUID]
2015-10-14 02:17:12,046 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route30 started and consuming from: Endpoint[direct://upsertNonRdfResource]
2015-10-14 02:17:12,046 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route31 started and consuming from: Endpoint[direct://drupalDeleteNodeByFedoraUri]
2015-10-14 02:17:12,047 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route32 started and consuming from: Endpoint[direct://drupalPutNode]
2015-10-14 02:17:12,048 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route33 started and consuming from: Endpoint[direct://drupalUpdateNodeFromRdf]
2015-10-14 02:17:12,048 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route34 started and consuming from: Endpoint[direct://drupalGetRdfMapping]
2015-10-14 02:17:12,049 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route35 started and consuming from: Endpoint[direct://extractContentType]
2015-10-14 02:17:12,050 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route36 started and consuming from: Endpoint[direct://drupalCreateNodeFromRdf]
2015-10-14 02:17:12,051 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route37 started and consuming from: Endpoint[direct://drupalGetNode]
2015-10-14 02:17:12,052 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route38 started and consuming from: Endpoint[direct://extractUUID]
2015-10-14 02:17:12,053 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route39 started and consuming from: Endpoint[direct://fedoraGetRdf]
2015-10-14 02:17:12,061 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route40 started and consuming from: Endpoint[direct://upsertRdfResource]
2015-10-14 02:17:12,063 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route41 started and consuming from: Endpoint[direct://handleNodeRemovedEvent]
2015-10-14 02:17:12,066 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route42 started and consuming from: Endpoint[direct://handleNodeUpsertEvent]
2015-10-14 02:17:12,074 | INFO  | ActiveMQ Task-1  | FailoverTransport                | 142 - org.apache.activemq.activemq-osgi - 5.11.1 | Successfully connected to tcp://localhost:61616
2015-10-14 02:17:12,102 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route43 started and consuming from: Endpoint[activemq://topic:fedora]
2015-10-14 02:17:12,102 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Total 28 routes, of which 28 is started.
2015-10-14 02:17:12,102 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Apache Camel 2.15.2 (CamelContext: sync) started in 0.500 seconds
2015-10-14 02:17:12,191 | INFO  | h for user karaf | HttpServiceFactoryImpl           | 80 - org.ops4j.pax.web.pax-web-runtime - 3.2.3 | Binding bundle: [ca.islandora.camel.services.islandora-collection-service [193]] to http service
2015-10-14 02:17:12,194 | INFO  | h for user karaf | CamelHttpTransportServlet        | 189 - org.apache.camel.camel-servlet - 2.15.2 | Initialized CamelHttpTransportServlet[name=CamelServlet, contextPath=]
2015-10-14 02:17:12,196 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Apache Camel 2.15.2 (CamelContext: collectionService) is starting
2015-10-14 02:17:12,197 | INFO  | h for user karaf | ManagedManagementStrategy        | 109 - org.apache.camel.camel-core - 2.15.2 | JMX is enabled
2015-10-14 02:17:12,277 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | AllowUseOriginalMessage is enabled. If access to the original message is not needed, then its recommended to turn this option off as it may improve performance.
2015-10-14 02:17:12,278 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | StreamCaching is not in use. If using streams then its recommended to enable stream caching. See more details at http://camel.apache.org/stream-caching.html
2015-10-14 02:17:12,442 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: deleteCollectionInFedora started and consuming from: Endpoint[direct://deleteCollectionInFedora]
2015-10-14 02:17:12,445 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: deleteCollectionCacheProperties started and consuming from: Endpoint[direct://deleteCollectionCacheProperties]
2015-10-14 02:17:12,446 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: deleteCollection started and consuming from: Endpoint[direct://deleteCollection]
2015-10-14 02:17:12,447 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: updateCollectionInFedora started and consuming from: Endpoint[direct://updateCollectionInFedora]
2015-10-14 02:17:12,448 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: updateCollectionCacheProperties started and consuming from: Endpoint[direct://updateCollectionCacheProperties]
2015-10-14 02:17:12,449 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: updateCollection started and consuming from: Endpoint[direct://updateCollection]
2015-10-14 02:17:12,450 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: addAsMember started and consuming from: Endpoint[direct://addAsMember]
2015-10-14 02:17:12,452 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: createCollectionInFedora started and consuming from: Endpoint[direct://createCollectionInFedora]
2015-10-14 02:17:12,453 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: createCollectionSparql started and consuming from: Endpoint[direct://createCollectionSparql]
2015-10-14 02:17:12,454 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: createCollection started and consuming from: Endpoint[direct://createCollection]
2015-10-14 02:17:12,456 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: createSubCollection started and consuming from: Endpoint[direct://createSubCollection]
2015-10-14 02:17:12,457 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getCollectionRdf started and consuming from: Endpoint[direct://getCollectionRdf]
2015-10-14 02:17:12,460 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getCollectionExtractUriError started and consuming from: Endpoint[direct://getCollectionExtractUriError]
2015-10-14 02:17:12,462 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getCollectionExtractUri started and consuming from: Endpoint[direct://getCollectionExtractUri]
2015-10-14 02:17:12,464 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getCollectionUri started and consuming from: Endpoint[direct://getCollectionUri]
2015-10-14 02:17:12,466 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getCollectionCacheProperties started and consuming from: Endpoint[direct://getCollectionCacheProperties]
2015-10-14 02:17:12,466 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getCollection started and consuming from: Endpoint[direct://getCollection]
2015-10-14 02:17:12,467 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route44 started and consuming from: Endpoint[servlet:///%7Buuid%7D?httpMethodRestrict=GET]
2015-10-14 02:17:12,468 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route45 started and consuming from: Endpoint[servlet:///?httpMethodRestrict=POST]
2015-10-14 02:17:12,469 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route46 started and consuming from: Endpoint[servlet:///%7Buuid%7D?httpMethodRestrict=POST]
2015-10-14 02:17:12,470 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route47 started and consuming from: Endpoint[servlet:///%7Buuid%7D?httpMethodRestrict=PUT]
2015-10-14 02:17:12,471 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route48 started and consuming from: Endpoint[servlet:///%7Buuid%7D?httpMethodRestrict=DELETE]
2015-10-14 02:17:12,471 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Total 22 routes, of which 22 is started.
2015-10-14 02:17:12,472 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Apache Camel 2.15.2 (CamelContext: collectionService) started in 0.275 seconds
2015-10-14 02:17:12,555 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Apache Camel 2.15.2 (CamelContext: basicImageService) is starting
2015-10-14 02:17:12,555 | INFO  | h for user karaf | ManagedManagementStrategy        | 109 - org.apache.camel.camel-core - 2.15.2 | JMX is enabled
2015-10-14 02:17:12,682 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | AllowUseOriginalMessage is enabled. If access to the original message is not needed, then its recommended to turn this option off as it may improve performance.
2015-10-14 02:17:12,683 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | StreamCaching is not in use. If using streams then its recommended to enable stream caching. See more details at http://camel.apache.org/stream-caching.html
2015-10-14 02:17:12,937 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: deleteBasicImageInFedora started and consuming from: Endpoint[direct://deleteBasicImageInFedora]
2015-10-14 02:17:12,938 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: deleteBasicImage started and consuming from: Endpoint[direct://deleteBasicImage]
2015-10-14 02:17:12,938 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route49 started and consuming from: Endpoint[direct://updateBasicImageInFedora]
2015-10-14 02:17:12,939 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: updateBasicImage started and consuming from: Endpoint[direct://updateBasicImage]
2015-10-14 02:17:12,939 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: addAsMember started and consuming from: Endpoint[direct://addAsMember]
2015-10-14 02:17:12,940 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: upsertBasicImageOBJ started and consuming from: Endpoint[direct://upsertBasicImageOBJ]
2015-10-14 02:17:12,940 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: createBasicImageInFedora started and consuming from: Endpoint[direct://createBasicImageInFedora]
2015-10-14 02:17:12,940 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: createBasicImageSparql started and consuming from: Endpoint[direct://createBasicImageSparql]
2015-10-14 02:17:12,944 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: createBasicImage started and consuming from: Endpoint[direct://createBasicImage]
2015-10-14 02:17:12,945 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getCollectionExtractUriError started and consuming from: Endpoint[direct://getCollectionExtractUriError]
2015-10-14 02:17:12,945 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getCollectionExtractUri started and consuming from: Endpoint[direct://getCollectionExtractUri]
2015-10-14 02:17:12,946 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getCollectionUri started and consuming from: Endpoint[direct://getCollectionUri]
2015-10-14 02:17:12,946 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getObjectOBJ started and consuming from: Endpoint[direct://getObjectOBJ]
2015-10-14 02:17:12,946 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getObjectExtractUriError started and consuming from: Endpoint[direct://getObjectExtractUriError]
2015-10-14 02:17:12,947 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getObjectExtractUri started and consuming from: Endpoint[direct://getObjectExtractUri]
2015-10-14 02:17:12,947 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getObjectUri started and consuming from: Endpoint[direct://getObjectUri]
2015-10-14 02:17:12,967 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: getBasicImage started and consuming from: Endpoint[direct://getBasicImage]
2015-10-14 02:17:12,970 | INFO  | h for user karaf | JettyHttpComponent               | 194 - org.apache.camel.camel-jetty-common - 2.15.2 | Using default Jetty continuation timeout for: Endpoint[http://0.0.0.0:8888/islandora/rest/basic-image/]
2015-10-14 02:17:12,971 | INFO  | h for user karaf | Server                           | 72 - org.eclipse.jetty.aggregate.jetty-all-server - 8.1.17.v20150415 | jetty-8.1.17.v20150415
2015-10-14 02:17:12,972 | INFO  | h for user karaf | AbstractConnector                | 72 - org.eclipse.jetty.aggregate.jetty-all-server - 8.1.17.v20150415 | Started [email protected]:8888
2015-10-14 02:17:12,972 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Route: route50 started and consuming from: Endpoint[http://0.0.0.0:8888/islandora/rest/basic-image/]
2015-10-14 02:17:12,972 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Total 18 routes, of which 18 is started.
2015-10-14 02:17:12,972 | INFO  | h for user karaf | BlueprintCamelContext            | 109 - org.apache.camel.camel-core - 2.15.2 | Apache Camel 2.15.2 (CamelContext: basicImageService) started in 0.417 seconds
2015-10-14 02:17:58,296 | INFO  | qtp2036268440-57 | IslandoraProducer                | 132 - ca.islandora.camel.component.islandora-camel-component - 0.0.0.SNAPSHOT | Executing ExecCommand [args=[islandora.php, collectionService:nodeToSparql], executable=php, timeout=9223372036854775807, outFile=null, workingDir=/home/vagrant/islandora/camel/commands/bin, useStderrOnEmptyStdout=false]
2015-10-14 02:17:58,546 | INFO  | qtp2036268440-57 | IslandoraProducer                | 132 - ca.islandora.camel.component.islandora-camel-component - 0.0.0.SNAPSHOT | The command ExecCommand [args=[islandora.php, collectionService:nodeToSparql], executable=php, timeout=9223372036854775807, outFile=null, workingDir=/home/vagrant/islandora/camel/commands/bin, useStderrOnEmptyStdout=false] had exit value 0
2015-10-14 02:17:58,591 | ERROR | qtp2036268440-57 | DefaultErrorHandler              | 109 - org.apache.camel.camel-core - 2.15.2 | Failed delivery for (MessageId: ID-islandora-deux-52858-1444787074562-4-3 on ExchangeId: ID-islandora-deux-52858-1444787074562-4-2). Exhausted after delivery attempt: 1 caught: org.fcrepo.camel.FcrepoOperationFailedException: HTTP operation failed invoking http://localhost:8080/fcrepo/rest with statusCode: 400 and message: Bad Request

Message History
---------------------------------------------------------------------------------------------------------------------------------------
RouteId              ProcessorId          Processor                                                                        Elapsed (ms)
[route45           ] [route45           ] [servlet:///?httpMethodRestrict=POST                                           ] [       284]
[route45           ] [restBinding7      ] [                                                                              ] [         0]
[route45           ] [to159             ] [direct:createCollection                                                       ] [       284]
[createCollection  ] [setProperty75     ] [setProperty[node]                                                             ] [         1]
[createCollection  ] [setProperty76     ] [setProperty[uri]                                                              ] [         0]
[createCollection  ] [to145             ] [direct:createCollectionSparql                                                 ] [       250]
[createCollectionSp] [setBody31         ] [setBody[simple{${property.node}}]                                             ] [         0]
[createCollectionSp] [to144             ] [islandora:collectionService:nodeToSparql                                      ] [       250]
[createCollection  ] [to146             ] [direct:createCollectionInFedora                                               ] [        42]
[createCollectionIn] [removeHeaders41   ] [removeHeaders[*]                                                              ] [         0]
[createCollectionIn] [setHeader135      ] [setHeader[Content-Type]                                                       ] [         0]
[createCollectionIn] [setHeader136      ] [setHeader[CamelHttpMethod]                                                    ] [         0]
[createCollectionIn] [to143             ] [fcrepo:localhost:8080/fcrepo/rest                                             ] [        33]

Exchange
---------------------------------------------------------------------------------------------------------------------------------------
Exchange[
    Id                  ID-islandora-deux-52858-1444787074562-4-2
    ExchangePattern     InOut
    Headers             {CamelHttpMethod=POST, CamelRedelivered=false, CamelRedeliveryCounter=0, Content-Type=application/sparql-update}
    BodyType            org.apache.camel.component.exec.ExecResult
    Body                PREFIX islandora: <http://islandora.ca/ontology/v2/>PREFIX rdf: <http://www.w3.org/1999/02/22-rdf-syntax-ns#>PREFIX fedora: <http://fedora.info/definitions/v4/repository#>PREFIX pcdm: <http://pcdm.org/models#>PREFIX nfo: <http://www.semanticdesktop.org/ontologies/2007/03/22/nfo/v1.2/>PREFIX nt: <http://www.jcp.org/jcr/nt/1.0>PREFIX mix: <http://www.jcp.org/jcr/mix/1.0>PREFIX ldp: <http://www.w3.org/ns/ldp#>PREFIX dc11: <http://purl.org/dc/elements/1.1/>PREFIX modsrdf: <http://www.loc.gov/mods/modsrdf/v1#>PREFIX content: <http://purl.org/rss/1.0/modules/content/>PREFIX dc: <http://purl.org/dc/terms/>PREFIX foaf: <http://xmlns.com/foaf/0.1/>PREFIX og: <http://ogp.me/ns#>PREFIX rdfs: <http://www.w3.org/2000/01/rdf-schema#>PREFIX sioc: <http://rdfs.org/sioc/ns#>PREFIX sioct: <http://rdfs.org/sioc/types#>PREFIX skos: <http://www.w3.org/2004/02/skos/core#>PREFIX xsd: <http://www.w3.org/2001/XMLSchema#>DELETE WHERE { <> <http://www.w3.org/1999/02/22-rdf-syntax-ns#type> ?o0 .  <> <http://www.semanticdesktop.org/ontologies/2007/03/22/nfo/v1.2/uuid> ?o1 .   <> <http://purl.org/dc/terms/title> ?o2 .   <> <http://purl.org/dc/terms/date> ?o3 .    <> <http://purl.org/dc/terms/created> ?o4 . <> <http://purl.org/dc/terms/modified> ?o5 .    <> <http://rdfs.org/sioc/ns#has_creator> ?o6 .  <> <http://xmlns.com/foaf/0.1/name> ?o7 .};INSERT DATA {    <> <http://www.w3.org/1999/02/22-rdf-syntax-ns#type> <http://www.w3.org/ns/ldp#RDFSource> . <> <http://www.w3.org/1999/02/22-rdf-syntax-ns#type> <http://www.w3.org/ns/ldp#Container> . <> <http://www.w3.org/1999/02/22-rdf-syntax-ns#type> <http://fedora.info/definitions/v4/repository#Resource> .  <> <http://www.w3.org/1999/02/22-rdf-syntax-ns#type> <http://fedora.info/definitions/v4/repository#Container> . <> <http://www.w3.org/1999/02/22-rdf-syntax-ns#type> <http://pcdm.org/models#Collection> .  <> <http://www.w3.org/1999/02/22-rdf-syntax-ns#type> <http://islandora.ca/ontology/v2/collection> . <> <http://www.semanticdesktop.org/ontologies/2007/03/22/nfo/v1.2/uuid> "70bc5612-cbbc-466d-9f7d-48293926d01b" .    <> <http://purl.org/dc/terms/title> "Test collection islandora user" .  <> <http://purl.org/dc/terms/date> "2015-10-14T02:17:58+00:00"^^<http://www.w3.org/2001/XMLSchema#dateTime> .   <> <http://purl.org/dc/terms/created> "2015-10-14T02:17:58+00:00"^^<http://www.w3.org/2001/XMLSchema#dateTime> .    <> <http://purl.org/dc/terms/modified> "2015-10-14T02:17:58+00:00"^^<http://www.w3.org/2001/XMLSchema#dateTime> .   <> <http://rdfs.org/sioc/ns#has_creator> b51d0acc-0380-4193-9d4a-ada609f21402 . <> <http://xmlns.com/foaf/0.1/name> "islandora" .}
]

Stacktrace
---------------------------------------------------------------------------------------------------------------------------------------
org.fcrepo.camel.FcrepoOperationFailedException: HTTP operation failed invoking http://localhost:8080/fcrepo/rest with statusCode: 400 and message: Bad Request
    at org.fcrepo.camel.FcrepoClient.fcrepoGenericResponse(FcrepoClient.java:272)[146:org.fcrepo.camel.fcrepo-camel:4.3.0]
    at org.fcrepo.camel.FcrepoClient.post(FcrepoClient.java:184)[146:org.fcrepo.camel.fcrepo-camel:4.3.0]
    at org.fcrepo.camel.FcrepoProducer.doRequest(FcrepoProducer.java:121)[146:org.fcrepo.camel.fcrepo-camel:4.3.0]
    at org.fcrepo.camel.FcrepoProducer.process(FcrepoProducer.java:95)[146:org.fcrepo.camel.fcrepo-camel:4.3.0]
    at org.apache.camel.util.AsyncProcessorConverterHelper$ProcessorToAsyncProcessorBridge.process(AsyncProcessorConverterHelper.java:61)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.SendProcessor.process(SendProcessor.java:129)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.management.InstrumentationProcessor.process(InstrumentationProcessor.java:77)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.RedeliveryErrorHandler.process(RedeliveryErrorHandler.java:448)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.CamelInternalProcessor.process(CamelInternalProcessor.java:191)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.Pipeline.process(Pipeline.java:118)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.Pipeline.process(Pipeline.java:80)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.CamelInternalProcessor.process(CamelInternalProcessor.java:191)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.component.direct.DirectProducer.process(DirectProducer.java:51)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.SendProcessor.process(SendProcessor.java:129)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.management.InstrumentationProcessor.process(InstrumentationProcessor.java:77)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.RedeliveryErrorHandler.process(RedeliveryErrorHandler.java:448)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.CamelInternalProcessor.process(CamelInternalProcessor.java:191)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.Pipeline.process(Pipeline.java:118)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.Pipeline.process(Pipeline.java:80)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.CamelInternalProcessor.process(CamelInternalProcessor.java:191)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.component.direct.DirectProducer.process(DirectProducer.java:51)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.SendProcessor.process(SendProcessor.java:129)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.management.InstrumentationProcessor.process(InstrumentationProcessor.java:77)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.RedeliveryErrorHandler.process(RedeliveryErrorHandler.java:448)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.CamelInternalProcessor.process(CamelInternalProcessor.java:191)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.Pipeline.process(Pipeline.java:118)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.Pipeline.process(Pipeline.java:80)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.CamelInternalProcessor.process(CamelInternalProcessor.java:191)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.util.AsyncProcessorHelper.process(AsyncProcessorHelper.java:109)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.processor.DelegateAsyncProcessor.process(DelegateAsyncProcessor.java:87)[109:org.apache.camel.camel-core:2.15.2]
    at org.apache.camel.component.http.CamelServlet.service(CamelServlet.java:144)[166:org.apache.camel.camel-http:2.15.2]
    at javax.servlet.http.HttpServlet.service(HttpServlet.java:668)[67:org.apache.geronimo.specs.geronimo-servlet_3.0_spec:1.0.0]
    at org.eclipse.jetty.servlet.ServletHolder.handle(ServletHolder.java:684)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.servlet.ServletHandler.doHandle(ServletHandler.java:503)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.ops4j.pax.web.service.jetty.internal.HttpServiceServletHandler.doHandle(HttpServiceServletHandler.java:69)[81:org.ops4j.pax.web.pax-web-jetty:3.2.3]
    at org.eclipse.jetty.server.handler.ScopedHandler.handle(ScopedHandler.java:137)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.security.SecurityHandler.handle(SecurityHandler.java:557)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.server.session.SessionHandler.doHandle(SessionHandler.java:231)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.server.handler.ContextHandler.doHandle(ContextHandler.java:1086)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.ops4j.pax.web.service.jetty.internal.HttpServiceContext.doHandle(HttpServiceContext.java:240)[81:org.ops4j.pax.web.pax-web-jetty:3.2.3]
    at org.eclipse.jetty.servlet.ServletHandler.doScope(ServletHandler.java:429)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.server.session.SessionHandler.doScope(SessionHandler.java:193)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.server.handler.ContextHandler.doScope(ContextHandler.java:1020)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.server.handler.ScopedHandler.handle(ScopedHandler.java:135)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.ops4j.pax.web.service.jetty.internal.JettyServerHandlerCollection.handle(JettyServerHandlerCollection.java:75)[81:org.ops4j.pax.web.pax-web-jetty:3.2.3]
    at org.eclipse.jetty.server.handler.HandlerWrapper.handle(HandlerWrapper.java:116)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.server.Server.handle(Server.java:370)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.server.AbstractHttpConnection.handleRequest(AbstractHttpConnection.java:494)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.server.AbstractHttpConnection.content(AbstractHttpConnection.java:982)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.server.AbstractHttpConnection$RequestHandler.content(AbstractHttpConnection.java:1043)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.http.HttpParser.parseNext(HttpParser.java:865)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.http.HttpParser.parseAvailable(HttpParser.java:240)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.server.AsyncHttpConnection.handle(AsyncHttpConnection.java:82)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.io.nio.SelectChannelEndPoint.handle(SelectChannelEndPoint.java:696)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.io.nio.SelectChannelEndPoint$1.run(SelectChannelEndPoint.java:53)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:608)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at org.eclipse.jetty.util.thread.QueuedThreadPool$3.run(QueuedThreadPool.java:543)[72:org.eclipse.jetty.aggregate.jetty-all-server:8.1.17.v20150415]
    at java.lang.Thread.run(Thread.java:745)[:1.8.0_60]
@ruebot ruebot added this to the Community Sprint - 01 milestone Oct 14, 2015
@daniel-dgi
Copy link
Contributor

I suspect https://github.com/Islandora-Labs/islandora/blob/7.x-2.x/camel/commands/src/Services/Collection/NodeToSparql.php#L139-L144 is the culprit. I was aware of it enough to make that comment, lol.

@DiegoPino
Copy link
Contributor

@daniel-dgi, is this related to how Drupal manages UID or for entities in general?. So if enabling UUID for files, users, other nodes, will get us to the same problem. I think we should handle this before serialising to JSON on the drupal side by getting all entity types that have an UUID representation an make them full URI's. Camel should get clean data…will look for the "how".

@daniel-dgi
Copy link
Contributor

@DiegoPino Agreed. We should clean it up before leaving drupal land, since we'll have access to everything we need without having to create a drupal service to expose that functionality.

This actually touches on another issue where maybe we should be doing the node -> sparql update conversion in Drupal land, but that's out of scope for this ticket.

Let's see what happens with this, first.

@DiegoPino
Copy link
Contributor

@daniel-dgi, i agree. Right now i'm looking at "where" drupal does the rdfa displaying using this triples, to understand if the full uri is available inside some structure of it's dynamically generated on display. Will find this out first.

@daniel-dgi
Copy link
Contributor

Linking this discussion in: https://groups.google.com/forum/#!topic/islandora-dev/dr-1cwofVRk

Looks like unless there's any objections, we should be doing this on the drupal side.

@dannylamb
Copy link
Contributor

Closing d7 related issues since we're moving to 8.

Sign up for free to join this conversation on GitHub. Already have an account? Sign in to comment
Labels
None yet
Projects
None yet
Development

No branches or pull requests

4 participants