builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-074 starttime: 1495456781.85 results: success (0) revision: 9851fcb0bf4d855c36729d7de19f0fa5c9f69776 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-05-22 05:39:41.848296) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-05-22 05:39:41.848876) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-22 05:39:41.849165) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-22 05:39:41.865256) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 05:39:41.865586) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-05-22 05:39:42-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 110M=0s 2017-05-22 05:39:42 (110 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.113141 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 05:39:41.995478) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 05:39:41.995929) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023052 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 05:39:42.048511) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 26 secs) (at 2017-05-22 05:39:42.048835) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 9851fcb0bf4d855c36729d7de19f0fa5c9f69776 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 9851fcb0bf4d855c36729d7de19f0fa5c9f69776 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-05-22 05:39:42,575 truncating revision to first 12 chars 2017-05-22 05:39:42,575 Setting DEBUG logging. 2017-05-22 05:39:42,575 attempt 1/10 2017-05-22 05:39:42,575 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/9851fcb0bf4d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-22 05:39:57,608 sleeping for 11.00s (attempt 1/10) 2017-05-22 05:40:08,619 attempt 2/10 2017-05-22 05:40:08,619 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/9851fcb0bf4d?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-22 05:40:08,920 unpacking tar archive at: mozilla-central-9851fcb0bf4d/testing/mozharness/ program finished with exit code 0 elapsedTime=26.664349 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 26 secs) (at 2017-05-22 05:40:08.729148) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-22 05:40:08.729497) ========= script_repo_revision: 9851fcb0bf4d855c36729d7de19f0fa5c9f69776 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-22 05:40:08.729912) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-22 05:40:08.730200) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-22 05:40:08.740743) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2017-05-22 05:40:08.741125) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:40:09 INFO - MultiFileLogger online at 20170522 05:40:09 in /builds/slave/test 05:40:09 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 05:40:09 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:40:09 INFO - {'append_to_log': False, 05:40:09 INFO - 'base_work_dir': '/builds/slave/test', 05:40:09 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 05:40:09 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:40:09 INFO - 'branch': 'Firefox-Non-PGO', 05:40:09 INFO - 'buildbot_json_path': 'buildprops.json', 05:40:09 INFO - 'config_files': ('talos/linux_config.py',), 05:40:09 INFO - 'default_actions': ('clobber', 05:40:09 INFO - 'read-buildbot-config', 05:40:09 INFO - 'download-and-extract', 05:40:09 INFO - 'populate-webroot', 05:40:09 INFO - 'create-virtualenv', 05:40:09 INFO - 'install', 05:40:09 INFO - 'run-tests'), 05:40:09 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:40:09 INFO - 'download_minidump_stackwalk': True, 05:40:09 INFO - 'download_symbols': 'ondemand', 05:40:09 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:40:09 INFO - 'tooltool.py': '/tools/tooltool.py', 05:40:09 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:40:09 INFO - '/tools/misc-python/virtualenv.py')}, 05:40:09 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:40:09 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:40:09 INFO - 'gecko_profile': False, 05:40:09 INFO - 'gecko_profile_interval': 0, 05:40:09 INFO - 'installer_path': 'installer.exe', 05:40:09 INFO - 'log_level': 'info', 05:40:09 INFO - 'log_name': 'talos', 05:40:09 INFO - 'log_to_console': True, 05:40:09 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:40:09 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:40:09 INFO - 'opt_config_files': (), 05:40:09 INFO - 'pip_index': False, 05:40:09 INFO - 'suite': 'dromaeojs-e10s', 05:40:09 INFO - 'system_bits': '32', 05:40:09 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:40:09 INFO - 'title': 'talos-linux64-ix-074', 05:40:09 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:40:09 INFO - 'use_talos_json': True, 05:40:09 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:40:09 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:40:09 INFO - 'work_dir': 'build'} 05:40:09 INFO - [mozharness: 2017-05-22 12:40:09.362353Z] Running clobber step. 05:40:09 INFO - Running pre-action listener: _resource_record_pre_action 05:40:09 INFO - Running main action method: clobber 05:40:09 INFO - rmtree: /builds/slave/test/build 05:40:09 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:40:10 INFO - Running post-action listener: _resource_record_post_action 05:40:10 INFO - [mozharness: 2017-05-22 12:40:10.892580Z] Finished clobber step (success) 05:40:10 INFO - [mozharness: 2017-05-22 12:40:10.892679Z] Running read-buildbot-config step. 05:40:10 INFO - Running pre-action listener: _resource_record_pre_action 05:40:10 INFO - Running main action method: read_buildbot_config 05:40:10 INFO - Using buildbot properties: 05:40:10 INFO - { 05:40:10 INFO - "project": "", 05:40:10 INFO - "product": "firefox", 05:40:10 INFO - "who": "nobody@mozilla.org", 05:40:10 INFO - "installer_path": "public/build/target.tar.bz2", 05:40:10 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 05:40:10 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 05:40:10 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 05:40:10 INFO - "stage_platform": "linux64", 05:40:10 INFO - "basedir": "/builds/slave/test", 05:40:10 INFO - "buildnumber": 622, 05:40:10 INFO - "platform": "ubuntu64_hw", 05:40:10 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 05:40:10 INFO - "slavebuilddir": "test", 05:40:10 INFO - "taskId": "c7W0QcfnQ-qlHBfbrg08lg", 05:40:10 INFO - "branch": "mozilla-central", 05:40:10 INFO - "script_repo_revision": "production", 05:40:10 INFO - "revision": "9851fcb0bf4d855c36729d7de19f0fa5c9f69776", 05:40:10 INFO - "slavename": "talos-linux64-ix-074", 05:40:10 INFO - "repo_path": "mozilla-central" 05:40:10 INFO - } 05:40:10 INFO - Finding installer, test and symbols from parent task. 05:40:10 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/c7W0QcfnQ-qlHBfbrg08lg'}, attempt #1 05:40:11 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/c7W0QcfnQ-qlHBfbrg08lg'}, attempt #1 05:40:11 INFO - Task dependencies: aCL6hZEDRPm57tkFoJSgRw 05:40:11 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw'}, attempt #1 05:40:12 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.tar.bz2 05:40:12 INFO - Set test_url: https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/test_packages.json 05:40:12 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.crashreporter-symbols.zip 05:40:12 INFO - Running post-action listener: _resource_record_post_action 05:40:12 INFO - [mozharness: 2017-05-22 12:40:12.285595Z] Finished read-buildbot-config step (success) 05:40:12 INFO - [mozharness: 2017-05-22 12:40:12.285817Z] Running download-and-extract step. 05:40:12 INFO - Running pre-action listener: _resource_record_pre_action 05:40:12 INFO - Running main action method: download_and_extract 05:40:12 INFO - mkdir: /builds/slave/test/build/tests 05:40:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:12 INFO - trying https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.test_packages.json 05:40:12 INFO - Downloading https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 05:40:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 05:40:12 INFO - Downloaded 986 bytes. 05:40:12 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 05:40:12 INFO - Using the following test package requirements: 05:40:12 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 05:40:12 INFO - u'common': [u'target.common.tests.zip'], 05:40:12 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 05:40:12 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 05:40:12 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 05:40:12 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 05:40:12 INFO - u'mozbase': [u'target.common.tests.zip'], 05:40:12 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 05:40:12 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 05:40:12 INFO - u'web-platform': [u'target.common.tests.zip', 05:40:12 INFO - u'target.web-platform.tests.zip'], 05:40:12 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 05:40:12 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 05:40:12 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.common.tests.zip 05:40:12 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.common.tests.zip'}, attempt #1 05:40:12 INFO - Fetch https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.common.tests.zip into memory 05:40:14 INFO - Content-Length response header: 65711332 05:40:14 INFO - Bytes received: 65711332 05:40:25 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 05:40:25 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.common.tests.zip 05:40:25 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.common.tests.zip'}, attempt #1 05:40:25 INFO - Fetch https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.common.tests.zip into memory 05:40:26 INFO - Content-Length response header: 65711332 05:40:26 INFO - Bytes received: 65711332 05:40:38 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.talos.tests.zip 05:40:38 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 05:40:38 INFO - Fetch https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.talos.tests.zip into memory 05:40:39 INFO - Content-Length response header: 14410000 05:40:39 INFO - Bytes received: 14410000 05:40:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:39 INFO - trying https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.tar.bz2 05:40:39 INFO - Downloading https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 05:40:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 05:40:40 INFO - Downloaded 60430503 bytes. 05:40:40 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.tar.bz2 05:40:40 INFO - mkdir: /builds/slave/test/properties 05:40:40 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:40:40 INFO - Writing to file /builds/slave/test/properties/build_url 05:40:40 INFO - Contents: 05:40:40 INFO - build_url:https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.tar.bz2 05:40:40 INFO - Running post-action listener: _resource_record_post_action 05:40:40 INFO - Running post-action listener: set_extra_try_arguments 05:40:40 INFO - [mozharness: 2017-05-22 12:40:40.537001Z] Finished download-and-extract step (success) 05:40:40 INFO - [mozharness: 2017-05-22 12:40:40.537102Z] Running populate-webroot step. 05:40:40 INFO - Running pre-action listener: _resource_record_pre_action 05:40:40 INFO - Running main action method: populate_webroot 05:40:40 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:40:40 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:40:40 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:40:40 INFO - '--tppagecycles', 05:40:40 INFO - '7'], 05:40:40 INFO - 'tests': ['tsvgm']}}, 05:40:40 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:40:40 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:40:40 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:40:40 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:40:40 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 05:40:40 INFO - 'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:40:40 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 05:40:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:40:40 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 05:40:40 INFO - 'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['damp', 'tps']}, 05:40:40 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 05:40:40 INFO - 'tests': ['damp', 'tps']}, 05:40:40 INFO - 'g3': {'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['dromaeo_dom']}, 05:40:40 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:40:40 INFO - 'g4': {'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 05:40:40 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 05:40:40 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 05:40:40 INFO - 'tests': ['ts_paint', 'tp5o']}, 05:40:40 INFO - 'other': {'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['a11yr', 05:40:40 INFO - 'ts_paint', 05:40:40 INFO - 'tpaint', 05:40:40 INFO - 'sessionrestore', 05:40:40 INFO - 'sessionrestore_no_auto_restore', 05:40:40 INFO - 'tabpaint']}, 05:40:40 INFO - 'other-e10s': {'tests': ['a11yr', 05:40:40 INFO - 'ts_paint', 05:40:40 INFO - 'tpaint', 05:40:40 INFO - 'sessionrestore', 05:40:40 INFO - 'sessionrestore_no_auto_restore', 05:40:40 INFO - 'tabpaint']}, 05:40:40 INFO - 'other-e10s_l64': {'tests': ['a11yr', 05:40:40 INFO - 'ts_paint', 05:40:40 INFO - 'tpaint', 05:40:40 INFO - 'sessionrestore', 05:40:40 INFO - 'sessionrestore_no_auto_restore', 05:40:40 INFO - 'tabpaint']}, 05:40:40 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 05:40:40 INFO - 'ts_paint', 05:40:40 INFO - 'tpaint', 05:40:40 INFO - 'sessionrestore', 05:40:40 INFO - 'sessionrestore_no_auto_restore', 05:40:40 INFO - 'tabpaint']}, 05:40:40 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['a11yr', 05:40:40 INFO - 'ts_paint', 05:40:40 INFO - 'tpaint', 05:40:40 INFO - 'sessionrestore', 05:40:40 INFO - 'sessionrestore_no_auto_restore', 05:40:40 INFO - 'tabpaint']}, 05:40:40 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['a11yr', 05:40:40 INFO - 'ts_paint', 05:40:40 INFO - 'tpaint', 05:40:40 INFO - 'sessionrestore', 05:40:40 INFO - 'sessionrestore_no_auto_restore', 05:40:40 INFO - 'tabpaint']}, 05:40:40 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 05:40:40 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 05:40:40 INFO - 'bloom_basic_ref']}, 05:40:40 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['tsvgx', 05:40:40 INFO - 'tsvgr_opacity', 05:40:40 INFO - 'tart', 05:40:40 INFO - 'tscrollx', 05:40:40 INFO - 'cart', 05:40:40 INFO - 'tsvg_static']}, 05:40:40 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:40:40 INFO - 'tsvgr_opacity', 05:40:40 INFO - 'tart', 05:40:40 INFO - 'tscrollx', 05:40:40 INFO - 'cart', 05:40:40 INFO - 'tsvg_static']}, 05:40:40 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 05:40:40 INFO - 'talos_options': ['--disable-e10s'], 05:40:40 INFO - 'tests': ['tp5o']}, 05:40:40 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 05:40:40 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 05:40:40 INFO - 'talos_options': ['--disable-e10s', 05:40:40 INFO - '--xperf_path', 05:40:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:40:40 INFO - 'tests': ['tp5n']}, 05:40:40 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 05:40:40 INFO - 'talos_options': ['--xperf_path', 05:40:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:40:40 INFO - 'tests': ['tp5n']}}, 05:40:40 INFO - 'talos.zip': {'path': '', 05:40:40 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:40:40 INFO - Running post-action listener: _resource_record_post_action 05:40:40 INFO - [mozharness: 2017-05-22 12:40:40.551114Z] Finished populate-webroot step (success) 05:40:40 INFO - [mozharness: 2017-05-22 12:40:40.551205Z] Running create-virtualenv step. 05:40:40 INFO - Running pre-action listener: _resource_record_pre_action 05:40:40 INFO - Running main action method: create_virtualenv 05:40:40 INFO - Creating virtualenv /builds/slave/test/build/venv 05:40:40 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 05:40:40 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:40:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:40:40 INFO - Using real prefix '/usr' 05:40:40 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:40:41 INFO - Installing distribute.............................................................................................................................................................................................done. 05:40:43 INFO - Installing pip.................done. 05:40:43 INFO - Return code: 0 05:40:43 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 05:40:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 05:40:43 INFO - Reading from file tmpfile_stdout 05:40:43 INFO - Output received: 05:40:43 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 05:40:43 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:40:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:40:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:40:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f521f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22c55c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:40:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 05:40:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 05:40:43 INFO - Using env: {'DISPLAY': ':0', 05:40:43 INFO - 'HOME': '/home/cltbld', 05:40:43 INFO - 'LANG': 'en_US.UTF-8', 05:40:43 INFO - 'LANGUAGE': 'en_US:en', 05:40:43 INFO - 'LOGNAME': 'cltbld', 05:40:43 INFO - 'MAIL': '/var/mail/cltbld', 05:40:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:40:43 INFO - 'MOZ_NO_REMOTE': '1', 05:40:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:40:43 INFO - 'NO_EM_RESTART': '1', 05:40:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:40:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:40:43 INFO - 'PWD': '/builds/slave/test', 05:40:43 INFO - 'SHELL': '/bin/bash', 05:40:43 INFO - 'SHLVL': '1', 05:40:43 INFO - 'TERM': 'linux', 05:40:43 INFO - 'TMOUT': '86400', 05:40:43 INFO - 'USER': 'cltbld', 05:40:43 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:40:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:40:43 INFO - '_': '/tools/buildbot/bin/python'} 05:40:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:40:43 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 05:40:43 INFO - Cleaning up... 05:40:43 INFO - Return code: 0 05:40:43 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 05:40:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:40:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:40:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f521f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22c55c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:40:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 05:40:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 05:40:43 INFO - Using env: {'DISPLAY': ':0', 05:40:43 INFO - 'HOME': '/home/cltbld', 05:40:43 INFO - 'LANG': 'en_US.UTF-8', 05:40:43 INFO - 'LANGUAGE': 'en_US:en', 05:40:43 INFO - 'LOGNAME': 'cltbld', 05:40:43 INFO - 'MAIL': '/var/mail/cltbld', 05:40:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:40:43 INFO - 'MOZ_NO_REMOTE': '1', 05:40:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:40:43 INFO - 'NO_EM_RESTART': '1', 05:40:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:40:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:40:43 INFO - 'PWD': '/builds/slave/test', 05:40:43 INFO - 'SHELL': '/bin/bash', 05:40:43 INFO - 'SHLVL': '1', 05:40:43 INFO - 'TERM': 'linux', 05:40:43 INFO - 'TMOUT': '86400', 05:40:43 INFO - 'USER': 'cltbld', 05:40:43 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:40:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:40:43 INFO - '_': '/tools/buildbot/bin/python'} 05:40:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:40:43 INFO - Downloading/unpacking psutil>=3.1.1 05:40:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:40:44 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:40:44 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:40:44 INFO - Installing collected packages: psutil 05:40:44 INFO - Running setup.py install for psutil 05:40:45 INFO - building 'psutil._psutil_linux' extension 05:40:45 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 05:40:45 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 05:40:45 INFO - building 'psutil._psutil_posix' extension 05:40:45 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 05:40:45 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 05:40:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:40:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:40:45 INFO - Successfully installed psutil 05:40:45 INFO - Cleaning up... 05:40:45 INFO - Return code: 0 05:40:45 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 05:40:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:40:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:40:45 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f521f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22c55c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:40:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 05:40:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 05:40:45 INFO - Using env: {'DISPLAY': ':0', 05:40:45 INFO - 'HOME': '/home/cltbld', 05:40:45 INFO - 'LANG': 'en_US.UTF-8', 05:40:45 INFO - 'LANGUAGE': 'en_US:en', 05:40:45 INFO - 'LOGNAME': 'cltbld', 05:40:45 INFO - 'MAIL': '/var/mail/cltbld', 05:40:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:40:45 INFO - 'MOZ_NO_REMOTE': '1', 05:40:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:40:45 INFO - 'NO_EM_RESTART': '1', 05:40:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:40:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:40:45 INFO - 'PWD': '/builds/slave/test', 05:40:45 INFO - 'SHELL': '/bin/bash', 05:40:45 INFO - 'SHLVL': '1', 05:40:45 INFO - 'TERM': 'linux', 05:40:45 INFO - 'TMOUT': '86400', 05:40:45 INFO - 'USER': 'cltbld', 05:40:45 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:40:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:40:45 INFO - '_': '/tools/buildbot/bin/python'} 05:40:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:40:45 INFO - Downloading/unpacking mozsystemmonitor==0.3 05:40:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:46 INFO - Downloading mozsystemmonitor-0.3.tar.gz 05:40:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:40:46 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 05:40:46 INFO - Installing collected packages: mozsystemmonitor 05:40:46 INFO - Running setup.py install for mozsystemmonitor 05:40:46 INFO - Successfully installed mozsystemmonitor 05:40:46 INFO - Cleaning up... 05:40:46 INFO - Return code: 0 05:40:46 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 05:40:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:40:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:40:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f521f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22c55c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:40:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 05:40:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 05:40:47 INFO - Using env: {'DISPLAY': ':0', 05:40:47 INFO - 'HOME': '/home/cltbld', 05:40:47 INFO - 'LANG': 'en_US.UTF-8', 05:40:47 INFO - 'LANGUAGE': 'en_US:en', 05:40:47 INFO - 'LOGNAME': 'cltbld', 05:40:47 INFO - 'MAIL': '/var/mail/cltbld', 05:40:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:40:47 INFO - 'MOZ_NO_REMOTE': '1', 05:40:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:40:47 INFO - 'NO_EM_RESTART': '1', 05:40:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:40:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:40:47 INFO - 'PWD': '/builds/slave/test', 05:40:47 INFO - 'SHELL': '/bin/bash', 05:40:47 INFO - 'SHLVL': '1', 05:40:47 INFO - 'TERM': 'linux', 05:40:47 INFO - 'TMOUT': '86400', 05:40:47 INFO - 'USER': 'cltbld', 05:40:47 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:40:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:40:47 INFO - '_': '/tools/buildbot/bin/python'} 05:40:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:40:47 INFO - Downloading/unpacking jsonschema==2.5.1 05:40:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:48 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:40:48 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 05:40:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:48 INFO - Downloading functools32-3.2.3-2.tar.gz 05:40:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:40:48 INFO - warning: no files found matching '*.txt' 05:40:48 INFO - no previously-included directories found matching 'build' 05:40:48 INFO - no previously-included directories found matching 'dist' 05:40:48 INFO - no previously-included directories found matching '.git*' 05:40:48 INFO - Installing collected packages: jsonschema, functools32 05:40:48 INFO - Running setup.py install for functools32 05:40:48 INFO - warning: no files found matching '*.txt' 05:40:48 INFO - no previously-included directories found matching 'build' 05:40:48 INFO - no previously-included directories found matching 'dist' 05:40:48 INFO - no previously-included directories found matching '.git*' 05:40:48 INFO - Successfully installed jsonschema functools32 05:40:48 INFO - Cleaning up... 05:40:48 INFO - Return code: 0 05:40:48 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 05:40:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:40:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:40:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f521f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22c55c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:40:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 05:40:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 05:40:48 INFO - Using env: {'DISPLAY': ':0', 05:40:48 INFO - 'HOME': '/home/cltbld', 05:40:48 INFO - 'LANG': 'en_US.UTF-8', 05:40:48 INFO - 'LANGUAGE': 'en_US:en', 05:40:48 INFO - 'LOGNAME': 'cltbld', 05:40:48 INFO - 'MAIL': '/var/mail/cltbld', 05:40:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:40:48 INFO - 'MOZ_NO_REMOTE': '1', 05:40:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:40:48 INFO - 'NO_EM_RESTART': '1', 05:40:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:40:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:40:48 INFO - 'PWD': '/builds/slave/test', 05:40:48 INFO - 'SHELL': '/bin/bash', 05:40:48 INFO - 'SHLVL': '1', 05:40:48 INFO - 'TERM': 'linux', 05:40:48 INFO - 'TMOUT': '86400', 05:40:48 INFO - 'USER': 'cltbld', 05:40:48 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:40:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:40:48 INFO - '_': '/tools/buildbot/bin/python'} 05:40:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:40:48 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 05:40:48 INFO - Cleaning up... 05:40:48 INFO - Return code: 0 05:40:48 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:40:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:40:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:40:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f521f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22c55c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:40:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 05:40:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 05:40:48 INFO - Using env: {'DISPLAY': ':0', 05:40:48 INFO - 'HOME': '/home/cltbld', 05:40:48 INFO - 'LANG': 'en_US.UTF-8', 05:40:48 INFO - 'LANGUAGE': 'en_US:en', 05:40:48 INFO - 'LOGNAME': 'cltbld', 05:40:48 INFO - 'MAIL': '/var/mail/cltbld', 05:40:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:40:48 INFO - 'MOZ_NO_REMOTE': '1', 05:40:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:40:48 INFO - 'NO_EM_RESTART': '1', 05:40:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:40:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:40:48 INFO - 'PWD': '/builds/slave/test', 05:40:48 INFO - 'SHELL': '/bin/bash', 05:40:48 INFO - 'SHLVL': '1', 05:40:48 INFO - 'TERM': 'linux', 05:40:48 INFO - 'TMOUT': '86400', 05:40:48 INFO - 'USER': 'cltbld', 05:40:48 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:40:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:40:48 INFO - '_': '/tools/buildbot/bin/python'} 05:40:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:40:49 INFO - Downloading/unpacking blobuploader==1.2.4 05:40:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:50 INFO - Downloading blobuploader-1.2.4.tar.gz 05:40:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:40:50 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:40:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:40:50 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:40:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:50 INFO - Downloading docopt-0.6.1.tar.gz 05:40:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:40:50 INFO - Installing collected packages: blobuploader, requests, docopt 05:40:50 INFO - Running setup.py install for blobuploader 05:40:50 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:40:50 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:40:50 INFO - Running setup.py install for requests 05:40:51 INFO - Running setup.py install for docopt 05:40:51 INFO - Successfully installed blobuploader requests docopt 05:40:51 INFO - Cleaning up... 05:40:51 INFO - Return code: 0 05:40:51 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:40:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:40:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:40:51 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f521f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22c55c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:40:51 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:40:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:40:51 INFO - Using env: {'DISPLAY': ':0', 05:40:51 INFO - 'HOME': '/home/cltbld', 05:40:51 INFO - 'LANG': 'en_US.UTF-8', 05:40:51 INFO - 'LANGUAGE': 'en_US:en', 05:40:51 INFO - 'LOGNAME': 'cltbld', 05:40:51 INFO - 'MAIL': '/var/mail/cltbld', 05:40:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:40:51 INFO - 'MOZ_NO_REMOTE': '1', 05:40:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:40:51 INFO - 'NO_EM_RESTART': '1', 05:40:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:40:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:40:51 INFO - 'PWD': '/builds/slave/test', 05:40:51 INFO - 'SHELL': '/bin/bash', 05:40:51 INFO - 'SHLVL': '1', 05:40:51 INFO - 'TERM': 'linux', 05:40:51 INFO - 'TMOUT': '86400', 05:40:51 INFO - 'USER': 'cltbld', 05:40:51 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:40:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:40:51 INFO - '_': '/tools/buildbot/bin/python'} 05:40:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:40:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:40:51 INFO - Running setup.py (path:/tmp/pip-iHmGRj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:40:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:40:51 INFO - Running setup.py (path:/tmp/pip-JySaea-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:40:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:40:51 INFO - Running setup.py (path:/tmp/pip-mhCWE5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:40:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:40:51 INFO - Running setup.py (path:/tmp/pip-AG6tuH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:40:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:40:51 INFO - Running setup.py (path:/tmp/pip-am8sQW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:40:51 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:40:51 INFO - Running setup.py (path:/tmp/pip-GPGLCm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:40:52 INFO - Running setup.py (path:/tmp/pip-x63vse-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:40:52 INFO - Running setup.py (path:/tmp/pip-0y88sQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:40:52 INFO - Running setup.py (path:/tmp/pip-_AGJ3M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:40:52 INFO - Running setup.py (path:/tmp/pip-MjHI79-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:40:52 INFO - Running setup.py (path:/tmp/pip-_tghee-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:40:52 INFO - Running setup.py (path:/tmp/pip-oip41a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:40:52 INFO - Running setup.py (path:/tmp/pip-x8oR84-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:40:52 INFO - Running setup.py (path:/tmp/pip-Jmnonu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:40:52 INFO - Running setup.py (path:/tmp/pip-Dttw9o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:40:52 INFO - Running setup.py (path:/tmp/pip-aIJZxn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:40:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:40:52 INFO - Running setup.py (path:/tmp/pip-IaYJnb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:40:52 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:40:52 INFO - Running setup.py install for manifestparser 05:40:52 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:40:52 INFO - Running setup.py install for mozcrash 05:40:53 INFO - Running setup.py install for mozdebug 05:40:53 INFO - Running setup.py install for mozdevice 05:40:53 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:40:53 INFO - Running setup.py install for mozfile 05:40:53 INFO - Running setup.py install for mozhttpd 05:40:53 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:40:53 INFO - Running setup.py install for mozinfo 05:40:53 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:40:53 INFO - Running setup.py install for mozInstall 05:40:53 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:40:53 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:40:53 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:40:53 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:40:53 INFO - Running setup.py install for mozleak 05:40:53 INFO - Running setup.py install for mozlog 05:40:53 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:40:53 INFO - Running setup.py install for moznetwork 05:40:53 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:40:53 INFO - Running setup.py install for mozprocess 05:40:54 INFO - Running setup.py install for mozprofile 05:40:54 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:40:54 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:40:54 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:40:54 INFO - Running setup.py install for mozrunner 05:40:54 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:40:54 INFO - Running setup.py install for mozscreenshot 05:40:54 INFO - Running setup.py install for moztest 05:40:54 INFO - Running setup.py install for mozversion 05:40:54 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:40:54 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:40:54 INFO - Cleaning up... 05:40:54 INFO - Return code: 0 05:40:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:40:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:40:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:40:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f521f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22c55c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:40:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:40:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:40:54 INFO - Using env: {'DISPLAY': ':0', 05:40:54 INFO - 'HOME': '/home/cltbld', 05:40:54 INFO - 'LANG': 'en_US.UTF-8', 05:40:54 INFO - 'LANGUAGE': 'en_US:en', 05:40:54 INFO - 'LOGNAME': 'cltbld', 05:40:54 INFO - 'MAIL': '/var/mail/cltbld', 05:40:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:40:54 INFO - 'MOZ_NO_REMOTE': '1', 05:40:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:40:54 INFO - 'NO_EM_RESTART': '1', 05:40:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:40:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:40:54 INFO - 'PWD': '/builds/slave/test', 05:40:54 INFO - 'SHELL': '/bin/bash', 05:40:54 INFO - 'SHLVL': '1', 05:40:54 INFO - 'TERM': 'linux', 05:40:54 INFO - 'TMOUT': '86400', 05:40:54 INFO - 'USER': 'cltbld', 05:40:54 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:40:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:40:54 INFO - '_': '/tools/buildbot/bin/python'} 05:40:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:40:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:40:54 INFO - Running setup.py (path:/tmp/pip-Ac_QSg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:40:54 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 05:40:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:40:54 INFO - Running setup.py (path:/tmp/pip-VN2xQv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:40:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:40:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:40:54 INFO - Running setup.py (path:/tmp/pip-wk6B65-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:40:55 INFO - Running setup.py (path:/tmp/pip-Up8at0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:40:55 INFO - Running setup.py (path:/tmp/pip-GxXUu7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:40:55 INFO - Running setup.py (path:/tmp/pip-kEepIa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:40:55 INFO - Running setup.py (path:/tmp/pip-WyIzex-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:40:55 INFO - Running setup.py (path:/tmp/pip-ks_YLN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:40:55 INFO - Running setup.py (path:/tmp/pip-gXDlo6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:40:55 INFO - Running setup.py (path:/tmp/pip-EANdOp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:40:55 INFO - Running setup.py (path:/tmp/pip-QSNArY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:40:55 INFO - Running setup.py (path:/tmp/pip-VuR1Nb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:40:55 INFO - Running setup.py (path:/tmp/pip-ePCdsO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:40:55 INFO - Running setup.py (path:/tmp/pip-4nyVH5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:40:55 INFO - Running setup.py (path:/tmp/pip-8A_CLo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:40:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 05:40:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:40:55 INFO - Running setup.py (path:/tmp/pip-CDPQYD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:40:56 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 05:40:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:40:56 INFO - Running setup.py (path:/tmp/pip-aD_iG6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:40:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 05:40:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:40:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:40:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:40:56 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:40:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:40:56 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:40:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:40:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:40:57 INFO - Downloading blessings-1.6.tar.gz 05:40:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:40:57 INFO - Installing collected packages: blessings 05:40:57 INFO - Running setup.py install for blessings 05:40:57 INFO - Successfully installed blessings 05:40:57 INFO - Cleaning up... 05:40:57 INFO - Return code: 0 05:40:57 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:40:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:40:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:40:57 INFO - Reading from file tmpfile_stdout 05:40:57 INFO - Current package versions: 05:40:57 INFO - argparse == 1.2.1 05:40:57 INFO - blessings == 1.6 05:40:57 INFO - blobuploader == 1.2.4 05:40:57 INFO - docopt == 0.6.1 05:40:57 INFO - functools32 == 3.2.3-2 05:40:57 INFO - jsonschema == 2.5.1 05:40:57 INFO - manifestparser == 1.1 05:40:57 INFO - mozInstall == 1.12 05:40:57 INFO - mozcrash == 1.0 05:40:57 INFO - mozdebug == 0.1 05:40:57 INFO - mozdevice == 0.50 05:40:57 INFO - mozfile == 1.2 05:40:57 INFO - mozhttpd == 0.7 05:40:57 INFO - mozinfo == 0.9 05:40:57 INFO - mozleak == 0.1 05:40:57 INFO - mozlog == 3.4 05:40:57 INFO - moznetwork == 0.27 05:40:57 INFO - mozprocess == 0.25 05:40:57 INFO - mozprofile == 0.28 05:40:57 INFO - mozrunner == 6.13 05:40:57 INFO - mozscreenshot == 0.1 05:40:57 INFO - mozsystemmonitor == 0.3 05:40:57 INFO - moztest == 0.8 05:40:57 INFO - mozversion == 1.4 05:40:57 INFO - psutil == 3.1.1 05:40:57 INFO - requests == 1.2.3 05:40:57 INFO - wsgiref == 0.1.2 05:40:57 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:40:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:40:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:40:57 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f521f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22c55c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:40:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 05:40:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:40:57 INFO - Using env: {'DISPLAY': ':0', 05:40:57 INFO - 'HOME': '/home/cltbld', 05:40:57 INFO - 'LANG': 'en_US.UTF-8', 05:40:57 INFO - 'LANGUAGE': 'en_US:en', 05:40:57 INFO - 'LOGNAME': 'cltbld', 05:40:57 INFO - 'MAIL': '/var/mail/cltbld', 05:40:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:40:57 INFO - 'MOZ_NO_REMOTE': '1', 05:40:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:40:57 INFO - 'NO_EM_RESTART': '1', 05:40:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:40:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:40:57 INFO - 'PWD': '/builds/slave/test', 05:40:57 INFO - 'SHELL': '/bin/bash', 05:40:57 INFO - 'SHLVL': '1', 05:40:57 INFO - 'TERM': 'linux', 05:40:57 INFO - 'TMOUT': '86400', 05:40:57 INFO - 'USER': 'cltbld', 05:40:57 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:40:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:40:57 INFO - '_': '/tools/buildbot/bin/python'} 05:40:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:40:57 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:40:57 INFO - Cleaning up... 05:40:57 INFO - Return code: 0 05:40:57 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:40:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:40:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:40:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:40:57 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f521f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22c55c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:40:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 05:40:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 05:40:57 INFO - Using env: {'DISPLAY': ':0', 05:40:57 INFO - 'HOME': '/home/cltbld', 05:40:57 INFO - 'LANG': 'en_US.UTF-8', 05:40:57 INFO - 'LANGUAGE': 'en_US:en', 05:40:57 INFO - 'LOGNAME': 'cltbld', 05:40:57 INFO - 'MAIL': '/var/mail/cltbld', 05:40:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:40:57 INFO - 'MOZ_NO_REMOTE': '1', 05:40:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:40:57 INFO - 'NO_EM_RESTART': '1', 05:40:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:40:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:40:57 INFO - 'PWD': '/builds/slave/test', 05:40:57 INFO - 'SHELL': '/bin/bash', 05:40:57 INFO - 'SHLVL': '1', 05:40:57 INFO - 'TERM': 'linux', 05:40:57 INFO - 'TMOUT': '86400', 05:40:57 INFO - 'USER': 'cltbld', 05:40:57 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:40:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:40:57 INFO - '_': '/tools/buildbot/bin/python'} 05:40:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:40:58 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 05:40:58 INFO - Cleaning up... 05:40:58 INFO - Return code: 0 05:40:58 INFO - Running post-action listener: _resource_record_post_action 05:40:58 INFO - Running post-action listener: _start_resource_monitoring 05:40:58 INFO - Starting resource monitoring. 05:40:58 INFO - [mozharness: 2017-05-22 12:40:58.218681Z] Finished create-virtualenv step (success) 05:40:58 INFO - [mozharness: 2017-05-22 12:40:58.219139Z] Running install step. 05:40:58 INFO - Running pre-action listener: _resource_record_pre_action 05:40:58 INFO - Running main action method: install 05:40:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:40:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:40:58 INFO - Reading from file tmpfile_stdout 05:40:58 INFO - Detecting whether we're running mozinstall >=1.0... 05:40:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:40:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:40:58 INFO - Reading from file tmpfile_stdout 05:40:58 INFO - Output received: 05:40:58 INFO - Usage: mozinstall [options] installer 05:40:58 INFO - Options: 05:40:58 INFO - -h, --help show this help message and exit 05:40:58 INFO - -d DEST, --destination=DEST 05:40:58 INFO - Directory to install application into. [default: 05:40:58 INFO - "/builds/slave/test"] 05:40:58 INFO - --app=APP Application being installed. [default: firefox] 05:40:58 INFO - mkdir: /builds/slave/test/build/application 05:40:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:40:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 05:41:15 INFO - Reading from file tmpfile_stdout 05:41:15 INFO - Output received: 05:41:15 INFO - /builds/slave/test/build/application/firefox/firefox 05:41:15 INFO - Running post-action listener: _resource_record_post_action 05:41:15 INFO - [mozharness: 2017-05-22 12:41:15.484434Z] Finished install step (success) 05:41:15 INFO - [mozharness: 2017-05-22 12:41:15.484710Z] Running run-tests step. 05:41:15 INFO - Running pre-action listener: _resource_record_pre_action 05:41:15 INFO - Running main action method: run_tests 05:41:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:41:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:41:15 INFO - Python 2.7.3 05:41:15 INFO - Return code: 0 05:41:15 INFO - grabbing minidump binary from tooltool 05:41:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:41:15 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c27a0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22c36a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x22c3b30>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:41:15 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 05:41:15 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 05:41:15 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 05:41:15 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:41:15 INFO - Return code: 0 05:41:15 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:41:15 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:41:15 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:41:15 INFO - ENV: RUST_BACKTRACE is now 1 05:41:15 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:41:15 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:41:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-074', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 05:41:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-074 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 05:41:15 INFO - Using env: {'DISPLAY': ':0', 05:41:15 INFO - 'HOME': '/home/cltbld', 05:41:15 INFO - 'LANG': 'en_US.UTF-8', 05:41:15 INFO - 'LANGUAGE': 'en_US:en', 05:41:15 INFO - 'LOGNAME': 'cltbld', 05:41:15 INFO - 'MAIL': '/var/mail/cltbld', 05:41:15 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:41:15 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:41:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:41:15 INFO - 'MOZ_NO_REMOTE': '1', 05:41:15 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:41:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:41:15 INFO - 'NO_EM_RESTART': '1', 05:41:15 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:41:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:41:15 INFO - 'PWD': '/builds/slave/test', 05:41:15 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:41:15 INFO - 'RUST_BACKTRACE': '1', 05:41:15 INFO - 'SHELL': '/bin/bash', 05:41:15 INFO - 'SHLVL': '1', 05:41:15 INFO - 'TERM': 'linux', 05:41:15 INFO - 'TMOUT': '86400', 05:41:15 INFO - 'USER': 'cltbld', 05:41:15 INFO - 'XDG_SESSION_COOKIE': '23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974', 05:41:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:41:15 INFO - '_': '/tools/buildbot/bin/python'} 05:41:15 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-074', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 05:41:15 INFO - mozversion application_buildid: 20170522100359 05:41:15 INFO - mozversion application_changeset: 9851fcb0bf4d855c36729d7de19f0fa5c9f69776 05:41:15 INFO - mozversion application_display_name: Nightly 05:41:15 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:41:15 INFO - mozversion application_name: Firefox 05:41:15 INFO - mozversion application_remotingname: firefox 05:41:15 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 05:41:15 INFO - mozversion application_vendor: Mozilla 05:41:15 INFO - mozversion application_version: 55.0a1 05:41:15 INFO - mozversion platform_buildid: 20170522100359 05:41:15 INFO - mozversion platform_changeset: 9851fcb0bf4d855c36729d7de19f0fa5c9f69776 05:41:15 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 05:41:15 INFO - mozversion platform_version: 55.0a1 05:41:15 INFO - using testdate: 1495456875 05:41:15 INFO - actual date: 1495456875 05:41:15 INFO - starting webserver on 'localhost:54998' 05:41:15 INFO - SUITE-START | Running 2 tests 05:41:15 INFO - TEST-START | dromaeo_css 05:41:15 INFO - operating with platform_type : linux_ 05:41:15 INFO - Initialising browser for dromaeo_css test... 05:41:15 INFO - TEST-INFO | started process 339 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGf27MH/profile http://localhost:54998/getInfo.html) 05:41:16 INFO - PID 339 | JavaScript warning: resource://gre/modules/addons/XPIProvider.jsm, line 2978: String.localeCompare is deprecated; use String.prototype.localeCompare instead 05:41:19 INFO - PID 339 | __metrics Screen width/height:1600/1200 05:41:19 INFO - PID 339 | colorDepth:24 05:41:19 INFO - PID 339 | Browser inner width/height: 1024/695 05:41:19 INFO - PID 339 | __metrics 05:41:21 INFO - TEST-INFO | 339: exit 0 05:41:21 INFO - Browser initialized. 05:41:21 INFO - Running cycle 1/1 for dromaeo_css test... 05:41:21 INFO - TEST-INFO | started process 505 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGf27MH/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:41:33 INFO - PID 505 | RSS: Main: 164335616 05:41:33 INFO - PID 505 | 05:44:33 INFO - PID 505 | Cycle 1(1): loaded http://localhost:54998/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54998/tests/dromaeo/cssquery-ext.html) 05:44:34 INFO - PID 505 | RSS: Main: 167571456 05:44:34 INFO - PID 505 | 05:47:36 INFO - PID 505 | Cycle 1(1): loaded http://localhost:54998/tests/dromaeo/cssquery-ext.html (next: http://localhost:54998/tests/dromaeo/cssquery-jquery.html) 05:47:37 INFO - PID 505 | RSS: Main: 166043648 05:47:37 INFO - PID 505 | 05:50:38 INFO - PID 505 | Cycle 1(1): loaded http://localhost:54998/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54998/tests/dromaeo/cssquery-mootools.html) 05:50:39 INFO - PID 505 | RSS: Main: 168898560 05:50:39 INFO - PID 505 | 05:53:41 INFO - PID 505 | Cycle 1(1): loaded http://localhost:54998/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54998/tests/dromaeo/cssquery-prototype.html) 05:53:41 INFO - PID 505 | RSS: Main: 167616512 05:53:41 INFO - PID 505 | 05:56:44 INFO - PID 505 | Cycle 1(1): loaded http://localhost:54998/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54998/tests/dromaeo/cssquery-yui.html) 05:56:44 INFO - PID 505 | RSS: Main: 166985728 05:56:44 INFO - PID 505 | 05:59:46 INFO - PID 505 | Cycle 1(1): loaded http://localhost:54998/tests/dromaeo/cssquery-yui.html (next: http://localhost:54998/tests/dromaeo/cssquery-dojo.html) 05:59:46 INFO - PID 505 | RSS: Main: 166150144 05:59:46 INFO - PID 505 | 05:59:46 INFO - PID 505 | __start_tp_report 05:59:46 INFO - PID 505 | _x_x_mozilla_page_load 05:59:46 INFO - PID 505 | _x_x_mozilla_page_load_details 05:59:46 INFO - PID 505 | |i|pagename|runs| 05:59:46 INFO - PID 505 | |0;dojo.html;3345.4480010798206;3361.5293858859764;3376.79739215647;3388.8983330500064;3395.745319101068;5892.116182572606;5943.88112237755;5958.433948774865;5972.7909523166645;5980.372060933604;5950.404959504048;6057.757689692418;6103.084537319393;6127.601705889114;6128.57100003;5258.342707161605;5330.3603567571845;5345.224942383352;5397.70312632807;5402.702851343174;5380.946190538103;5435.021696094701;5486.067368547357;5505.091659876116;5533.861653458675;5404.51359377654;5420.214068960018;5463.890722185554;5474.562035037207;5475.534579560742;5266.052110620087;5302.549283310885;5338.492843179892;5349.037173308803;5395.163749618815;5337.973310133463;5345.599080069011;5374.516293533562;5380.300560927094;5396.811111611075;5978.880422391571;5989.940100598982;5997.280326360821;6041.184440100574;6045.3652366501765;6285.088662143963;6357.141785858942;6440.098386225932;6442.581232219891;6509.2839787623325;6568.211814582233;6610.3720146586475;6610.834729131762;6620.933790662079;6628.602283862983;6079.604825686405;6102.359252278491;6103.23709536308;6105.23684539437;6120.112583675342;6465.256495502983;6527.51043671717;6641.800745977628;6733.3266673333255;6743.696533655997;6445.41991220783;6445.6454894981225;6471.449926756184;6484.675766211671;6484.837879053061;6490.643014634146;6573.211214654272;6573.901391479131;6586.80239592813;6594.5713528621445;6316.494680425555;6374.904376434357;6426.228852537725;6498.870022599616;6508.8047358579315;6505.674716264168;6554.770583029571;6561.835954101186;6568.244651865097;6592.274849766522;4996.90006199874;4996.975015124901;4999.100161970808;5003.124453220672;5028.823991160292;4359.367891655756;4360.542143074995;4404.515503294635;4437.866863994085;4464.464264288241;6135.967692822268;6138.600990935575;6176.8764624707255;6205.410486003822;6209.565330426827;6534.346565343428;6546.9345306547275;6562.80311590653;6591.0442985766795;6591.967040164768;5926.644401335933;6037.72830222641;6157.445829875243;6158.445739883432;6169.56813023084;5545.168224766237;5567.638103523258;5568.805091821767;5596.3284405871555;5611.989841828428;6700.095487109373;6728.226253980757;6745.9662701686175;6773.356531129436;6819.045333653293;6327.303996560283;6549.24683661366;6557.508186885907;6562.409383155539;6572.539922205399;6592.7033283503315;6652.90020649681;6765.526413151032;6782.762603308861;6809.421199198124;6239.75040998355;6251.281102673251;6298.149749783721;6321.778737744157;6324.462420694293;6336.778212762531;6409.8718025640155;6414.454771344488;6415.390537898892;6420.807375778734;6200.503959683305;6255.499560035278;6255.624662520263;6299.748010079546;6311.27420346666;6380.138681277968;6411.102445657519;6413.166288382667;6426.325235850355;6428.839279018062;6020.849478763066;6391.552591318563;6407.038944158414;6421.101045853491;6429.260635027032;6205.565610407228;6370.840728981812;6430.292667806444;6450.774222902176;6482.967585162044;6192.566520343533;6233.532485063548;6237.251529816451;6259.186305780401;6272.717727702356 05:59:46 INFO - PID 505 | |1;ext.html;751.2299892610074;800.5876973358721;822.2353211513293;1109.284511490089;1122.5622007417103;36072.99999999996;37143;37168.07079823002;37267;37334.8133259334;38775;39101.41347879784;39137.80431097848;39192;39255.0186245344;7138.500304978654;7230.96384518078;7317.085364329459;7348.11822581291;7386.852262954738;7272.200057993617;7299.671514781821;7342.045534080588;7342.375898048672;7344.926550734504;7219.855602887939;7322.121345438555;7337;7344.339009489145;7345.926540734605;7251;7287.6356182190675;7301.123865136191;7308.342249197598;7346.522476039067;7225.5664660120565;7263.273672632695;7267.4549408794555;7271.636418179123;7283.271672832728;35346.29307413863;35346.64653353485;35668.464973025424;35713.10717232064;35748.28503429943;3483.8780642677384;3494.8816378758806;3503;3503.439449688063;3514.3674138655033;28662.713372866212;28702;28719.56920646192;28766.71233287682;28799.42401151965;3574.6246644102257;3590.6768390844686;3607.693346065588;3616.674499295076;3623.547056617923;195557;196409;202463;214395;215721.9213903936;46753.766231169306;46878.296825547644;46931.765341173756;46943.5305646946;46976;46602;46614.76692616515;46621.76689116532;47024.5297547027;47061.29408058882;13824;13852.16886986784;13895.652608684864;13942.930285348712;13944.651383715285;11016.17378696601;11032.834507482394;11062.944685276521;11083.778324433466;11100.111991040698;13785.793213101811;13790.172589644653;13794.517191898436;13972.930135349257;14090.154590724384;5646.096624540136;5777.104548794943;5782.624129431573;5841.036229022164;5841.649501029951;1056.3292309383444;1069.5828626835541;1072.222638587018;1086.22877756792;1092.1426680056277;25031;25415.87292063528;25419;25510.107146249793;25520.744792552206;1183.6567395455393;1187.1274613159321;1191.0352614382377;1195.0379944145047;1207.5592408770735;13006.804897926539;13477.932610336886;13496.19022858612;13747.312634368442;13762.449502019806;249890;250364.74817625794;252170;252283;252443;51393.48606513887;51566.968660626575;51620.48379516157;51636.22545661818;51989;1471.3378979459071;1477.7857210704603;1496.1098146602753;1501.3244040181744;1502.8046353973914;24046;24324.391890202885;25036.68305837601;25082.105705159636;25087.623685645096;38044.42933355946;38102.047448814;38188.809055954545;38206.235875282895;38214.23571528609;213674;213708;213836;214043;214356;33128.83435582807;33571.49642755312;34824.82587587046;34988.30023399467;35116;40623;42258;43606.56393436152;44501;44770.77614611906;31793.682063179072;31991;32101;32154;33353.83323083369;30986.0704178875;31239.68760312368;32081.19797005;32173.517397239528;33022.17444563809;37311.626883730816;38082.61917380791;38672.41991370075;38775.418368725055;38914.22171556496;30461.39077218399;31717.36565268728;32722.672773272916;32871.67128328686;33291;26331.473370532865;26502.469950601266;26520.602190966765;26766.59850102289;26859 05:59:46 INFO - PID 505 | |2;jquery.html;448.89450979019944;451.87121670323955;452.337325817677;465.1464562527764;467.3013844302768;17773.200205990728;18668;19174.90412547939;19392.51518712033;19495.220191192337;20664.586708265826;20740.896295518538;20986.475338116517;21268.893655531738;21479.785202147974;5461.126219804832;5652.208690783294;5694.5159661428825;5742.1099729541775;5743.655380677152;5566;5619.297587801525;5727.255456790632;5807.128930660414;5822.970885145568;5754.683492407916;5777.711114444282;5780.682062486561;5793.304803423595;5809.535237181037;5663.688497132676;5715.2855893013375;5733.684647344395;5745.885082298351;5745.971270143644;5193.298904647862;5232.189010703347;5234.947650523484;5235.607329450307;5239.659422137549;25750.87124564365;25938.610920836203;26631.866840665865;27017.189484315306;27150.321241969108;2100.1179504608103;2161.664941934003;2198.9890050549807;2216.6342553478657;2220.0231897964845;17141.82858171427;17229.32945393466;17539;17676.02781846998;17848.91075544614;2160.0711693971584;2193.824494040473;2230.39779259599;2241.865488070721;2252.6733623624646;106989.46505267423;117705;119495.4025229877;120055.39972300082;121269.39365303118;12145.149839511327;12392.132550721362;12939;12962.740745185043;13055.738885222243;16463.670726585402;16574.6685066298;16600.252988615543;16611;16794.748078778826;8416.3266938646;8558.700445484377;8667.17661822126;8857.247133993555;8871.645134194689;8123.918760812435;8264.090949995496;8385.538795366314;8587.141285871363;8603.967523897172;8041.67833286662;8156.225158609923;8243.340532757366;8295.142758617272;8467.941507311585;2235.530538586915;2236.418531181872;2279.430142464384;2320.988395058014;2444.8533088014774;1004.1916257412853;1024.4058446101244;1027.6762819711917;1031.896810318962;1047.8271085270844;19650.115744791517;20353.796462035487;20619.175232990812;20692.482687932923;20790.58418831615;1024.5543188712934;1037.227265687068;1041.9739506512399;1048.046277887119;1065.248999455382;10744.785104298027;10981.725456863482;11013.229073964905;11091.112710983101;11136.888631113585;483194;488292;489299;490785;491583;97941;98182.5090874541;98893;99667.00332996722;102547.48726256321;1160.2972710983076;1184.9703757405962;1200.903927685783;1204.9518019279305;1209.6431552691977;16653.83346166523;16797.32810687559;17032.233549490054;17051.829481705023;17269.913650431667;44507.55492445034;45465.63603091912;46065.53934460613;46087.86829197957;46337.3049404266;55136.44863551474;55803.720981394836;56108.43891561032;56461.71769141128;57201.71399142977;9311.301652376234;9595.904040959502;9760.755981100529;9817.607295708092;9859.30984831055;14497.420103195755;14689.70620587561;14753.483628073396;14931.85068149348;14959;12686.11197216186;12920.35398230066;12975.416106275052;13029;13126.146800458322;11489;11956.34240116802;12215.633530994084;12224.327661978676;12286.201396909173;12837.486500539873;12872.549460768829;12928.418221179882;13050.738985220432;13070.673233169247;9033.141851524095;9264.258859291376;9379.718608441757;9411;9620.95189524048;12456.750864982469;12543;12647.430865610886;12735;12900.483980640669 05:59:46 INFO - PID 505 | |3;mootools.html;1333.766590846602;1395.76969799983;1415.3701602786762;1420.4247279851652;1423.2314550142924;11109.55561777529;11464.942675286611;11650.126240531952;11657.650270491888;12066.457009434575;11767.941160294187;11880.584179553718;11905;11945.701357466067;11968.820467692969;2375.762423757619;2401.519696060786;2416.154345978911;2420.9152679656218;2428.7449817769143;2308.4805918668335;2354.96467552986;2364.3852598324474;2364.5507353602848;2368.336865677613;2277.2826559633745;2280.2931091361647;2315.6758053872472;2323.0591610397732;2326.150954901466;2168.9891550542147;2210.9226177083888;2227.6881236626805;2278.5215104828007;2285.4514916420108;2136.2843447445125;2257.7403598586043;2262.490939538607;2270.977290227093;2280.270313499681;11286.435678216056;11422.657320280321;11454.942725286404;11460.484278207501;11464.541418343257;6461.773837915651;6623.23832759234;6656.633885136315;6686.765963191314;6686.7993960181275;3882.1459278958864;3972.503437070366;4023.7786921719294;4040.2121586290687;4081.551029386765;1329.6277042428135;1345.9528916487875;1361.3057340756186;1373.7183877305129;1421.6019514535842;17326.3935762249;17631;17713.29146834138;17771.911140444216;17878.55303617407;4974.129527332702;5212.218167274863;5298.655587386807;5457.645253058538;5563.471470210324;11728;11803.822942655866;11805.114616403633;11807.291562506278;11824.349660768741;6382.776602818879;6383.202099737533;6385.712642931079;6410.583312084699;6420.935790642127;5837.824865254049;5872.324682661463;6018.187544681499;6020.458158765732;6027.0356742921795;4257.6168144867115;4270.444842170498;4299.505556860939;4335.934960975588;4359.455068116486;1242.515418986596;1247.4698253242336;1275.0691994843817;1277.348552238365;1281.9423125959167;812.8293058457672;819.7090033038305;834.4242472693821;849.3290300662408;872.82543491302;6190.226221722285;6195.380461953769;6218.471429928416;6287.088372186007;6421.839454013687;627.3600927054379;634.194572892424;634.6065439427584;642.9807105786834;645.3159650770199;3982.900427489336;4172.0303980675635;4206.223892231113;4286.5284818669925;4366.825326986948;15071.397144114331;15537.45618903333;15575.376984920704;15635.218239088;15702.057876527444;14849.109053456827;15079.24603769807;15141.772873406908;15249.542513724606;15363.308651110727;9481.24150067993;9627.277954153467;9637.132658060807;9671.274654400948;9724.17344525709;6784.660766961731;7012.649367531705;7075.150981882001;7130.575604294565;7187.7843664690145;13303.866961330263;13649;13659.317034148451;13715.314234288446;13854.861451385761;13414.597562073153;13608;13786.241756703477;13846.307684615527;14000;9235.26117910579;9437.622495100119;9457.196138328043;9491.145796878314;9496;10645.308054976402;10920;10985.670429887115;11060.39167845744;11177.329360238411;9340.766480838034;9341.34610577253;9349.065093490597;9495.66765163216;9512.762180945256;8755.737327880173;9385.953070234606;9442.575084121368;9456.385334953206;9574.425534467955;8141.552214628252;8141.755747327589;8265.545395003091;8277;8306.584670766317;5636.436356364331;5637.351704554028;5666.093425051972;5728.226689396878;5760.539156867357;5992.310884248192;6117.3576774439825;6125.540584456273;6213.844653883689;6405.551611387158 05:59:46 INFO - PID 505 | |4;prototype.html;396.6905813465498;407.26895223074575;419.4819398043418;421.82705090912725;429.298097610407;6013.849653758658;6194.659293738842;6214.223222097238;6223.035429508428;6255.405736455041;5931.762729490826;6011.75952961881;6040.30536488304;6072.876517844191;6081;4515.277555591098;4544.227481328166;4566.429196350457;4582.243929751587;4592.242280023809;4510.864674059783;4535.523770004152;4557.475890272612;4574.74194596487;4574.908501829961;4522.751248681321;4530.886727831814;4532.161550113223;4539.886502837422;4541.977290113545;4510.075434535928;4514.909701805962;4537.636989040869;4553.658475614309;4560.908781824345;3847.288251673421;3948.2498325318384;3953.5651078381356;3967.662748666367;3997.760134391946;5902.763889444417;5940.495057920082;5970.13433052205;5993.190919225936;6002.478958837255;5326.2543243945875;5378.058839703075;5386.973065134688;5389.164679474688;5404.621676482648;6361.427471527539;6435.742570297182;6449;6452.870942581122;6476.4171224589545;4436.55634436557;4445.422095127645;4449.1101779644205;4453.755043472608;4455.50491724632;6636.834079148011;6767.390934815841;6781.864362712768;6795.116634837439;6829.419499342513;4547.818087276538;4548.9317660234465;4557.635389168859;4558;4560.863174104782;4608.354830323758;4609.400777898852;4628.95371046292;4631.791569379318;4638.257878739386;5265.842024739264;5337.759800808973;5361.79359644077;5386.8383948481605;5389.730513474311;6295.307516173218;6448.967755161194;6497.512686548528;6538.803835884931;6547.919593267153;1556.6341909651223;1565.311263044257;1565.4677409680762;1568.8352722964153;1573.9842601574067;1029.876267018831;1052.8683914510686;1052.9210309226685;1060.8408738689259;1068.738159151013;6115.602485838406;6146.293176284695;6151.200343955257;6174.475169610633;6199.504039676815;6582.670866456658;6633.469322454289;6637.402633762985;6653.800385988428;6664.000399940048;6014.458698717049;6162.22972128484;6181.412765787333;6214.533909956681;6248.593841400295;3483.320752453247;3533.611302756695;3551.3252482028847;3573.6605022522817;3575.249197668467;6751.628660423724;6790.388865002174;6944.652767361612;6975.965120174468;7038.3665470107935;6899.793006209822;6900.343917459773;6903.309669033157;6950.7567235147535;6986.759930052461;6805.149356330458;6823.624700641413;6887.276835932155;6920.30796920314;7049.7885063448175;6671.966640166768;6674.566153200027;6691.029800678972;6714.328567143247;6766.4248538874745;6475.870482590416;6546.672666366758;6618.371254730793;6643.701033453603;6665.966670166618;6870.835686758655;6953.721851126101;6965.248726752803;6974.197967233833;6974.302569743188;4404.810701110746;4505.918579540821;4526.502084770738;4577.176108300538;4588.609968152611;6578.868422631424;6721.831954201184;6750.898736519054;6761.729530818712;6766.357196066366;6488.870222595616;6534.509911756542;6574.211094668671;6579.309172536815;6588.505862060269;6420.807375778734;6521.804345869631;6536.215654121535;6539.509536784855;6562.409383155539;6514;6596.208454985241;6602.570832895846;6602.867942641216;6611.966940165461;6443.71003304843;6584.934150658432;6631.204255489372;6643.840751755795;6661.700223490052;6369.7452101915405;6379.681015949277;6427;6429.807105786834;6479.31967143462 05:59:46 INFO - PID 505 | |5;yui.html;734.3244215321903;748.3526749361804;785.6778720724504;801.214809486703;826.7354446577095;15701.450449234278;15792.131432771193;16083.678326433479;16124;16169.191540422977;18557.350492732756;18664.626707465843;18695.532611684714;18836.152373143206;18903.243870245173;973.060996138726;976.5947131940236;989.6833013435703;993.940363578184;995.4276291132592;996.2229461020415;997.3417544420683;997.3866072365515;997.4165113408665;998.5007496251874;1050.2963014780078;1056.9682909512726;1058.3755584205317;1058.973525661857;1060.0512541275555;1037.8598889149982;1039.0700323210722;1043.942583157926;1046.6022911293735;1046.979060418795;697.9965100174467;727.4144313827367;731.8097294703363;732.0446816903939;737.3548145372799;16873.156342182963;17362.91318543399;17495.5626109347;17572;17581.384651537133;17471.912640436716;17940.55148621282;17967.640647187112;18053.368132115313;18063.187156577984;14264.786028209584;14564.417423303055;14636.34136463851;14825.555233343017;14872.256387180705;3246.740260779132;3265.477523596237;3266.6406695263504;3271.558339624144;3274.345130973815;88328;89404.55297723535;89577.55211223967;92067.53966230193;92230.53884730533;13668.248246346546;13700.3834827433;13731.519396821062;13804.516841910485;13991.790123148161;25647.87176064145;26112.477750444883;26306.21081367562;26420.735792641826;26621.3344666381;7135.464840136907;7191.712331506681;7249.565026098346;7313.085864266966;7351.044364232615;3728.9067773305883;3767.962320376816;3795.1840354323954;3808.485854409619;3837.0982819037504;4023.0948036692093;4085.080856807195;4125.876223713293;4144.067584793397;4158.043649960526;781.1563511407666;800.2397722163968;813.5444151275304;818.2431251092715;818.3698552114838;654.4208375587639;670.3698523388;680.1090571351546;688.404530081476;693.5769180799708;10460.843087353696;11202.719932001603;11356.545738170546;11697.590584329508;12013.038956883429;665.2648823050556;666.6067020457953;676.675195905958;682.9590224586541;686.2485578291762;5066.746662666852;5110.923336149961;5122.667026643257;5293.100172970528;5415.404305526389;79548.6022569895;80810;81232;81940.59029704814;84443;69173.65413173003;70168.64915675389;70809.64595176991;72848;73967.63016184885;62970.37029629645;63120;63625;64635;65817.6709116461;10183.083522483012;10471.79056418852;10505.9474702626;10530.842037369599;10708.73228169302;34329.828350858086;34389.828050859585;34883.08143052157;35022.29955400929;35568.28863422769;40797.38803918003;41003.1799364017;41135.38296925489;41466.1706765869;42195.7890210547;12771.233725976472;13000.219986800823;13012.544560940321;13075.738485230433;13150.079494435298;18285.451436456926;18910.810891890906;19326.22695092237;19614.90192549028;19731.802681972997;15274.389024438899;15672;15973.201339932724;16018.199090045684;16731.247093881047;15298.694026119638;16494.34022639129;16986.660266794843;17134;17251.482455526355;15865.52403427853;16043.358265669243;16315.265813038204;17252.913735431746;17261.74107388365;10215.489225538544;10373.118284945864;10885.074768644754;11147.554097835995;11186.04918581897;13473;14146.151230926178;14199.503017394341;14237.074590151607;14289.28553572338 05:59:46 INFO - PID 505 | __end_tp_report 05:59:46 INFO - PID 505 | __start_cc_report 05:59:46 INFO - PID 505 | _x_x_mozilla_cycle_collect,268 05:59:46 INFO - PID 505 | __end_cc_report 05:59:46 INFO - PID 505 | __startTimestamp1495457986652__endTimestamp 05:59:46 INFO - PID 505 | 05:59:46 INFO - PID 505 | ------- Summary: start ------- 05:59:46 INFO - PID 505 | Number of tests: 6 05:59:46 INFO - PID 505 | 05:59:46 INFO - PID 505 | [#0] dojo.html Cycles:165 Average:6007.49 Median:6251.28 stddev:721.16 (11.5%) stddev-sans-first:692.47 05:59:46 INFO - PID 505 | Values: 3345.4 3361.5 3376.8 3388.9 3395.7 5892.1 5943.9 5958.4 5972.8 5980.4 5950.4 6057.8 6103.1 6127.6 6128.6 5258.3 5330.4 5345.2 5397.7 5402.7 5380.9 5435.0 5486.1 5505.1 5533.9 5404.5 5420.2 5463.9 5474.6 5475.5 5266.1 5302.5 5338.5 5349.0 5395.2 5338.0 5345.6 5374.5 5380.3 5396.8 5978.9 5989.9 5997.3 6041.2 6045.4 6285.1 6357.1 6440.1 6442.6 6509.3 6568.2 6610.4 6610.8 6620.9 6628.6 6079.6 6102.4 6103.2 6105.2 6120.1 6465.3 6527.5 6641.8 6733.3 6743.7 6445.4 6445.6 6471.4 6484.7 6484.8 6490.6 6573.2 6573.9 6586.8 6594.6 6316.5 6374.9 6426.2 6498.9 6508.8 6505.7 6554.8 6561.8 6568.2 6592.3 4996.9 4997.0 4999.1 5003.1 5028.8 4359.4 4360.5 4404.5 4437.9 4464.5 6136.0 6138.6 6176.9 6205.4 6209.6 6534.3 6546.9 6562.8 6591.0 6592.0 5926.6 6037.7 6157.4 6158.4 6169.6 5545.2 5567.6 5568.8 5596.3 5612.0 6700.1 6728.2 6746.0 6773.4 6819.0 6327.3 6549.2 6557.5 6562.4 6572.5 6592.7 6652.9 6765.5 6782.8 6809.4 6239.8 6251.3 6298.1 6321.8 6324.5 6336.8 6409.9 6414.5 6415.4 6420.8 6200.5 6255.5 6255.6 6299.7 6311.3 6380.1 6411.1 6413.2 6426.3 6428.8 6020.8 6391.6 6407.0 6421.1 6429.3 6205.6 6370.8 6430.3 6450.8 6483.0 6192.6 6233.5 6237.3 6259.2 6272.7 05:59:46 INFO - PID 505 | 05:59:46 INFO - PID 505 | [#1] ext.html Cycles:180 Average:38594.65 Median:3489.38 stddev:58260.47 (1669.7%) stddev-sans-first:58354.62 05:59:46 INFO - PID 505 | Values: 751.2 800.6 822.2 1109.3 1122.6 36073.0 37143.0 37168.1 37267.0 37334.8 38775.0 39101.4 39137.8 39192.0 39255.0 7138.5 7231.0 7317.1 7348.1 7386.9 7272.2 7299.7 7342.0 7342.4 7344.9 7219.9 7322.1 7337.0 7344.3 7345.9 7251.0 7287.6 7301.1 7308.3 7346.5 7225.6 7263.3 7267.5 7271.6 7283.3 35346.3 35346.6 35668.5 35713.1 35748.3 3483.9 3494.9 3503.0 3503.4 3514.4 28662.7 28702.0 28719.6 28766.7 28799.4 3574.6 3590.7 3607.7 3616.7 3623.5 195557.0 196409.0 202463.0 214395.0 215721.9 46753.8 46878.3 46931.8 46943.5 46976.0 46602.0 46614.8 46621.8 47024.5 47061.3 13824.0 13852.2 13895.7 13942.9 13944.7 11016.2 11032.8 11062.9 11083.8 11100.1 13785.8 13790.2 13794.5 13972.9 14090.2 5646.1 5777.1 5782.6 5841.0 5841.6 1056.3 1069.6 1072.2 1086.2 1092.1 25031.0 25415.9 25419.0 25510.1 25520.7 1183.7 1187.1 1191.0 1195.0 1207.6 13006.8 13477.9 13496.2 13747.3 13762.4 249890.0 250364.7 252170.0 252283.0 252443.0 51393.5 51567.0 51620.5 51636.2 51989.0 1471.3 1477.8 1496.1 1501.3 1502.8 24046.0 24324.4 25036.7 25082.1 25087.6 38044.4 38102.0 38188.8 38206.2 38214.2 213674.0 213708.0 213836.0 214043.0 214356.0 33128.8 33571.5 34824.8 34988.3 35116.0 40623.0 42258.0 43606.6 44501.0 44770.8 31793.7 31991.0 32101.0 32154.0 33353.8 30986.1 31239.7 32081.2 32173.5 33022.2 37311.6 38082.6 38672.4 38775.4 38914.2 30461.4 31717.4 32722.7 32871.7 33291.0 26331.5 26502.5 26520.6 26766.6 26859.0 05:59:46 INFO - PID 505 | 05:59:46 INFO - PID 505 | [#2] jquery.html Cycles:180 Average:31022.35 Median:2207.81 stddev:81449.33 (3689.1%) stddev-sans-first:81645.47 05:59:46 INFO - PID 505 | Values: 448.9 451.9 452.3 465.1 467.3 17773.2 18668.0 19174.9 19392.5 19495.2 20664.6 20740.9 20986.5 21268.9 21479.8 5461.1 5652.2 5694.5 5742.1 5743.7 5566.0 5619.3 5727.3 5807.1 5823.0 5754.7 5777.7 5780.7 5793.3 5809.5 5663.7 5715.3 5733.7 5745.9 5746.0 5193.3 5232.2 5234.9 5235.6 5239.7 25750.9 25938.6 26631.9 27017.2 27150.3 2100.1 2161.7 2199.0 2216.6 2220.0 17141.8 17229.3 17539.0 17676.0 17848.9 2160.1 2193.8 2230.4 2241.9 2252.7 106989.5 117705.0 119495.4 120055.4 121269.4 12145.1 12392.1 12939.0 12962.7 13055.7 16463.7 16574.7 16600.3 16611.0 16794.7 8416.3 8558.7 8667.2 8857.2 8871.6 8123.9 8264.1 8385.5 8587.1 8604.0 8041.7 8156.2 8243.3 8295.1 8467.9 2235.5 2236.4 2279.4 2321.0 2444.9 1004.2 1024.4 1027.7 1031.9 1047.8 19650.1 20353.8 20619.2 20692.5 20790.6 1024.6 1037.2 1042.0 1048.0 1065.2 10744.8 10981.7 11013.2 11091.1 11136.9 483194.0 488292.0 489299.0 490785.0 491583.0 97941.0 98182.5 98893.0 99667.0 102547.5 1160.3 1185.0 1200.9 1205.0 1209.6 16653.8 16797.3 17032.2 17051.8 17269.9 44507.6 45465.6 46065.5 46087.9 46337.3 55136.4 55803.7 56108.4 56461.7 57201.7 9311.3 9595.9 9760.8 9817.6 9859.3 14497.4 14689.7 14753.5 14931.9 14959.0 12686.1 12920.4 12975.4 13029.0 13126.1 11489.0 11956.3 12215.6 12224.3 12286.2 12837.5 12872.5 12928.4 13050.7 13070.7 9033.1 9264.3 9379.7 9411.0 9621.0 12456.8 12543.0 12647.4 12735.0 12900.5 05:59:46 INFO - PID 505 | 05:59:46 INFO - PID 505 | [#3] mootools.html Cycles:180 Average:7175.56 Median:3927.32 stddev:4685.10 (119.3%) stddev-sans-first:4677.68 05:59:46 INFO - PID 505 | Values: 1333.8 1395.8 1415.4 1420.4 1423.2 11109.6 11464.9 11650.1 11657.7 12066.5 11767.9 11880.6 11905.0 11945.7 11968.8 2375.8 2401.5 2416.2 2420.9 2428.7 2308.5 2355.0 2364.4 2364.6 2368.3 2277.3 2280.3 2315.7 2323.1 2326.2 2169.0 2210.9 2227.7 2278.5 2285.5 2136.3 2257.7 2262.5 2271.0 2280.3 11286.4 11422.7 11454.9 11460.5 11464.5 6461.8 6623.2 6656.6 6686.8 6686.8 3882.1 3972.5 4023.8 4040.2 4081.6 1329.6 1346.0 1361.3 1373.7 1421.6 17326.4 17631.0 17713.3 17771.9 17878.6 4974.1 5212.2 5298.7 5457.6 5563.5 11728.0 11803.8 11805.1 11807.3 11824.3 6382.8 6383.2 6385.7 6410.6 6420.9 5837.8 5872.3 6018.2 6020.5 6027.0 4257.6 4270.4 4299.5 4335.9 4359.5 1242.5 1247.5 1275.1 1277.3 1281.9 812.8 819.7 834.4 849.3 872.8 6190.2 6195.4 6218.5 6287.1 6421.8 627.4 634.2 634.6 643.0 645.3 3982.9 4172.0 4206.2 4286.5 4366.8 15071.4 15537.5 15575.4 15635.2 15702.1 14849.1 15079.2 15141.8 15249.5 15363.3 9481.2 9627.3 9637.1 9671.3 9724.2 6784.7 7012.6 7075.2 7130.6 7187.8 13303.9 13649.0 13659.3 13715.3 13854.9 13414.6 13608.0 13786.2 13846.3 14000.0 9235.3 9437.6 9457.2 9491.1 9496.0 10645.3 10920.0 10985.7 11060.4 11177.3 9340.8 9341.3 9349.1 9495.7 9512.8 8755.7 9386.0 9442.6 9456.4 9574.4 8141.6 8141.8 8265.5 8277.0 8306.6 5636.4 5637.4 5666.1 5728.2 5760.5 5992.3 6117.4 6125.5 6213.8 6405.6 05:59:46 INFO - PID 505 | 05:59:46 INFO - PID 505 | [#4] prototype.html Cycles:180 Average:5408.57 Median:6168.35 stddev:1659.61 (26.9%) stddev-sans-first:1621.07 05:59:46 INFO - PID 505 | Values: 396.7 407.3 419.5 421.8 429.3 6013.8 6194.7 6214.2 6223.0 6255.4 5931.8 6011.8 6040.3 6072.9 6081.0 4515.3 4544.2 4566.4 4582.2 4592.2 4510.9 4535.5 4557.5 4574.7 4574.9 4522.8 4530.9 4532.2 4539.9 4542.0 4510.1 4514.9 4537.6 4553.7 4560.9 3847.3 3948.2 3953.6 3967.7 3997.8 5902.8 5940.5 5970.1 5993.2 6002.5 5326.3 5378.1 5387.0 5389.2 5404.6 6361.4 6435.7 6449.0 6452.9 6476.4 4436.6 4445.4 4449.1 4453.8 4455.5 6636.8 6767.4 6781.9 6795.1 6829.4 4547.8 4548.9 4557.6 4558.0 4560.9 4608.4 4609.4 4629.0 4631.8 4638.3 5265.8 5337.8 5361.8 5386.8 5389.7 6295.3 6449.0 6497.5 6538.8 6547.9 1556.6 1565.3 1565.5 1568.8 1574.0 1029.9 1052.9 1052.9 1060.8 1068.7 6115.6 6146.3 6151.2 6174.5 6199.5 6582.7 6633.5 6637.4 6653.8 6664.0 6014.5 6162.2 6181.4 6214.5 6248.6 3483.3 3533.6 3551.3 3573.7 3575.2 6751.6 6790.4 6944.7 6976.0 7038.4 6899.8 6900.3 6903.3 6950.8 6986.8 6805.1 6823.6 6887.3 6920.3 7049.8 6672.0 6674.6 6691.0 6714.3 6766.4 6475.9 6546.7 6618.4 6643.7 6666.0 6870.8 6953.7 6965.2 6974.2 6974.3 4404.8 4505.9 4526.5 4577.2 4588.6 6578.9 6721.8 6750.9 6761.7 6766.4 6488.9 6534.5 6574.2 6579.3 6588.5 6420.8 6521.8 6536.2 6539.5 6562.4 6514.0 6596.2 6602.6 6602.9 6612.0 6443.7 6584.9 6631.2 6643.8 6661.7 6369.7 6379.7 6427.0 6429.8 6479.3 05:59:46 INFO - PID 505 | 05:59:46 INFO - PID 505 | [#5] yui.html Cycles:180 Average:18539.47 Median:3256.11 stddev:22985.40 (705.9%) stddev-sans-first:23010.99 05:59:46 INFO - PID 505 | Values: 734.3 748.4 785.7 801.2 826.7 15701.5 15792.1 16083.7 16124.0 16169.2 18557.4 18664.6 18695.5 18836.2 18903.2 973.1 976.6 989.7 993.9 995.4 996.2 997.3 997.4 997.4 998.5 1050.3 1057.0 1058.4 1059.0 1060.1 1037.9 1039.1 1043.9 1046.6 1047.0 698.0 727.4 731.8 732.0 737.4 16873.2 17362.9 17495.6 17572.0 17581.4 17471.9 17940.6 17967.6 18053.4 18063.2 14264.8 14564.4 14636.3 14825.6 14872.3 3246.7 3265.5 3266.6 3271.6 3274.3 88328.0 89404.6 89577.6 92067.5 92230.5 13668.2 13700.4 13731.5 13804.5 13991.8 25647.9 26112.5 26306.2 26420.7 26621.3 7135.5 7191.7 7249.6 7313.1 7351.0 3728.9 3768.0 3795.2 3808.5 3837.1 4023.1 4085.1 4125.9 4144.1 4158.0 781.2 800.2 813.5 818.2 818.4 654.4 670.4 680.1 688.4 693.6 10460.8 11202.7 11356.5 11697.6 12013.0 665.3 666.6 676.7 683.0 686.2 5066.7 5110.9 5122.7 5293.1 5415.4 79548.6 80810.0 81232.0 81940.6 84443.0 69173.7 70168.6 70809.6 72848.0 73967.6 62970.4 63120.0 63625.0 64635.0 65817.7 10183.1 10471.8 10505.9 10530.8 10708.7 34329.8 34389.8 34883.1 35022.3 35568.3 40797.4 41003.2 41135.4 41466.2 42195.8 12771.2 13000.2 13012.5 13075.7 13150.1 18285.5 18910.8 19326.2 19614.9 19731.8 15274.4 15672.0 15973.2 16018.2 16731.2 15298.7 16494.3 16986.7 17134.0 17251.5 15865.5 16043.4 16315.3 17252.9 17261.7 10215.5 10373.1 10885.1 11147.6 11186.0 13473.0 14146.2 14199.5 14237.1 14289.3 05:59:46 INFO - PID 505 | -------- Summary: end -------- 05:59:46 INFO - PID 505 | 05:59:47 INFO - TEST-INFO | 505: exit 0 05:59:47 INFO - TEST-OK | dromaeo_css | took 1111696ms 05:59:47 INFO - TEST-START | kraken 05:59:47 INFO - operating with platform_type : linux_ 05:59:47 INFO - Initialising browser for kraken test... 05:59:47 INFO - TEST-INFO | started process 918 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpE4HPWH/profile http://localhost:54998/getInfo.html) 05:59:47 INFO - PID 918 | JavaScript warning: resource://gre/modules/addons/XPIProvider.jsm, line 2978: String.localeCompare is deprecated; use String.prototype.localeCompare instead 05:59:51 INFO - PID 918 | __metrics Screen width/height:1600/1200 05:59:51 INFO - PID 918 | colorDepth:24 05:59:51 INFO - PID 918 | Browser inner width/height: 1024/695 05:59:51 INFO - PID 918 | __metrics 05:59:53 INFO - TEST-INFO | 918: exit 0 05:59:53 INFO - Browser initialized. 05:59:53 INFO - Running cycle 1/1 for kraken test... 05:59:53 INFO - TEST-INFO | started process 1088 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpE4HPWH/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:00:04 INFO - PID 1088 | RSS: Main: 162500608 06:00:04 INFO - PID 1088 | 06:00:07 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54998/tests/kraken/driver.html?testName=audio-beat-detection) 06:00:08 INFO - PID 1088 | RSS: Main: 167387136 06:00:08 INFO - PID 1088 | 06:00:10 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54998/tests/kraken/driver.html?testName=audio-dft) 06:00:11 INFO - PID 1088 | RSS: Main: 166883328 06:00:11 INFO - PID 1088 | 06:00:14 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54998/tests/kraken/driver.html?testName=audio-fft) 06:00:14 INFO - PID 1088 | RSS: Main: 161394688 06:00:14 INFO - PID 1088 | 06:00:16 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54998/tests/kraken/driver.html?testName=audio-oscillator) 06:00:17 INFO - PID 1088 | RSS: Main: 162885632 06:00:17 INFO - PID 1088 | 06:00:19 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54998/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:00:20 INFO - PID 1088 | RSS: Main: 163176448 06:00:20 INFO - PID 1088 | 06:00:23 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54998/tests/kraken/driver.html?testName=imaging-darkroom) 06:00:23 INFO - PID 1088 | RSS: Main: 163606528 06:00:23 INFO - PID 1088 | 06:00:27 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54998/tests/kraken/driver.html?testName=imaging-desaturate) 06:00:27 INFO - PID 1088 | RSS: Main: 167481344 06:00:27 INFO - PID 1088 | 06:00:30 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54998/tests/kraken/driver.html?testName=json-parse-financial) 06:00:31 INFO - PID 1088 | RSS: Main: 167481344 06:00:31 INFO - PID 1088 | 06:00:32 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54998/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:00:33 INFO - PID 1088 | RSS: Main: 167481344 06:00:33 INFO - PID 1088 | 06:00:35 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54998/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:00:35 INFO - PID 1088 | RSS: Main: 167292928 06:00:35 INFO - PID 1088 | 06:00:37 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54998/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:00:38 INFO - PID 1088 | RSS: Main: 167383040 06:00:38 INFO - PID 1088 | 06:00:40 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54998/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:00:41 INFO - PID 1088 | RSS: Main: 166662144 06:00:41 INFO - PID 1088 | 06:00:44 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54998/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:00:45 INFO - PID 1088 | RSS: Main: 166735872 06:00:45 INFO - PID 1088 | 06:00:46 INFO - PID 1088 | Cycle 1(1): loaded http://localhost:54998/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54998/tests/kraken/driver.html?testName=ai-astar) 06:00:47 INFO - PID 1088 | RSS: Main: 168394752 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | __start_tp_report 06:00:47 INFO - PID 1088 | _x_x_mozilla_page_load 06:00:47 INFO - PID 1088 | _x_x_mozilla_page_load_details 06:00:47 INFO - PID 1088 | |i|pagename|runs| 06:00:47 INFO - PID 1088 | |0;ai-astar;101;109;109;111;110;110;111;112;109;110 06:00:47 INFO - PID 1088 | |1;audio-beat-detection;147;123;124;164;123;121;120;118;150;118 06:00:47 INFO - PID 1088 | |2;audio-dft;163;164;162;162;161;163;163;162;166;168 06:00:47 INFO - PID 1088 | |3;audio-fft;74;73;74;92;75;74;74;75;91;77 06:00:47 INFO - PID 1088 | |4;audio-oscillator;82;81;101;84;81;83;98;83;83;106 06:00:47 INFO - PID 1088 | |5;imaging-gaussian-blur;114;114;114;115;113;114;114;113;114;114 06:00:47 INFO - PID 1088 | |6;imaging-darkroom;147;149;147;147;147;148;148;149;148;148 06:00:47 INFO - PID 1088 | |7;imaging-desaturate;95;95;94;94;95;95;94;94;94;97 06:00:47 INFO - PID 1088 | |8;json-parse-financial;49;47;51;49;49;49;49;49;48;49 06:00:47 INFO - PID 1088 | |9;json-stringify-tinderbox;55;56;55;54;55;55;55;55;56;55 06:00:47 INFO - PID 1088 | |10;stanford-crypto-aes;79;87;89;82;80;79;79;85;80;79 06:00:47 INFO - PID 1088 | |11;stanford-crypto-ccm;124;129;124;126;126;133;126;125;168;133 06:00:47 INFO - PID 1088 | |12;stanford-crypto-pbkdf2;183;182;185;181;180;176;178;187;179;179 06:00:47 INFO - PID 1088 | |13;stanford-crypto-sha256-iterative;66;64;66;67;66;68;65;67;66;65 06:00:47 INFO - PID 1088 | __end_tp_report 06:00:47 INFO - PID 1088 | __start_cc_report 06:00:47 INFO - PID 1088 | _x_x_mozilla_cycle_collect,701 06:00:47 INFO - PID 1088 | __end_cc_report 06:00:47 INFO - PID 1088 | __startTimestamp1495458047201__endTimestamp 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | ------- Summary: start ------- 06:00:47 INFO - PID 1088 | Number of tests: 14 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#0] ai-astar Cycles:10 Average:109.20 Median:110.00 stddev:3.05 (2.8%) stddev-sans-first:1.05 06:00:47 INFO - PID 1088 | Values: 101.0 109.0 109.0 111.0 110.0 110.0 111.0 112.0 109.0 110.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#1] audio-beat-detection Cycles:10 Average:130.80 Median:123.50 stddev:16.47 (13.3%) stddev-sans-first:16.39 06:00:47 INFO - PID 1088 | Values: 147.0 123.0 124.0 164.0 123.0 121.0 120.0 118.0 150.0 118.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#2] audio-dft Cycles:10 Average:163.40 Median:163.00 stddev:2.12 (1.3%) stddev-sans-first:2.24 06:00:47 INFO - PID 1088 | Values: 163.0 164.0 162.0 162.0 161.0 163.0 163.0 162.0 166.0 168.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#3] audio-fft Cycles:10 Average:77.90 Median:75.00 stddev:7.25 (9.7%) stddev-sans-first:7.55 06:00:47 INFO - PID 1088 | Values: 74.0 73.0 74.0 92.0 75.0 74.0 74.0 75.0 91.0 77.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#4] audio-oscillator Cycles:10 Average:88.20 Median:83.00 stddev:9.53 (11.5%) stddev-sans-first:9.84 06:00:47 INFO - PID 1088 | Values: 82.0 81.0 101.0 84.0 81.0 83.0 98.0 83.0 83.0 106.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#5] imaging-gaussian-blur Cycles:10 Average:113.90 Median:114.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 06:00:47 INFO - PID 1088 | Values: 114.0 114.0 114.0 115.0 113.0 114.0 114.0 113.0 114.0 114.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#6] imaging-darkroom Cycles:10 Average:147.80 Median:148.00 stddev:0.79 (0.5%) stddev-sans-first:0.78 06:00:47 INFO - PID 1088 | Values: 147.0 149.0 147.0 147.0 147.0 148.0 148.0 149.0 148.0 148.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#7] imaging-desaturate Cycles:10 Average:94.70 Median:95.00 stddev:0.95 (1.0%) stddev-sans-first:1.00 06:00:47 INFO - PID 1088 | Values: 95.0 95.0 94.0 94.0 95.0 95.0 94.0 94.0 94.0 97.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#8] json-parse-financial Cycles:10 Average:48.90 Median:49.00 stddev:0.99 (2.0%) stddev-sans-first:1.05 06:00:47 INFO - PID 1088 | Values: 49.0 47.0 51.0 49.0 49.0 49.0 49.0 49.0 48.0 49.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#9] json-stringify-tinderbox Cycles:10 Average:55.10 Median:55.00 stddev:0.57 (1.0%) stddev-sans-first:0.60 06:00:47 INFO - PID 1088 | Values: 55.0 56.0 55.0 54.0 55.0 55.0 55.0 55.0 56.0 55.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#10] stanford-crypto-aes Cycles:10 Average:81.90 Median:81.00 stddev:3.75 (4.6%) stddev-sans-first:3.83 06:00:47 INFO - PID 1088 | Values: 79.0 87.0 89.0 82.0 80.0 79.0 79.0 85.0 80.0 79.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#11] stanford-crypto-ccm Cycles:10 Average:131.40 Median:127.50 stddev:13.28 (10.4%) stddev-sans-first:13.82 06:00:47 INFO - PID 1088 | Values: 124.0 129.0 124.0 126.0 126.0 133.0 126.0 125.0 168.0 133.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:181.00 Median:181.50 stddev:3.33 (1.8%) stddev-sans-first:3.46 06:00:47 INFO - PID 1088 | Values: 183.0 182.0 185.0 181.0 180.0 176.0 178.0 187.0 179.0 179.0 06:00:47 INFO - PID 1088 | 06:00:47 INFO - PID 1088 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.00 Median:66.00 stddev:1.15 (1.7%) stddev-sans-first:1.22 06:00:47 INFO - PID 1088 | Values: 66.0 64.0 66.0 67.0 66.0 68.0 65.0 67.0 66.0 65.0 06:00:47 INFO - PID 1088 | -------- Summary: end -------- 06:00:47 INFO - PID 1088 | 06:00:48 INFO - TEST-INFO | 1088: exit 0 06:00:48 INFO - TEST-OK | kraken | took 60693ms 06:00:48 INFO - SUITE-END | took 1172s 06:00:48 INFO - Completed test suite (00:19:32) 06:00:48 INFO - javascript benchmark 06:00:48 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7706.8506232881355, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3345.4480010798206, 3361.5293858859764, 3376.79739215647, 3388.8983330500064, 3395.745319101068, 5892.116182572606, 5943.88112237755, 5958.433948774865, 5972.7909523166645, 5980.372060933604, 5950.404959504048, 6057.757689692418, 6103.084537319393, 6127.601705889114, 6128.57100003, 5258.342707161605, 5330.3603567571845, 5345.224942383352, 5397.70312632807, 5402.702851343174, 5380.946190538103, 5435.021696094701, 5486.067368547357, 5505.091659876116, 5533.861653458675, 5404.51359377654, 5420.214068960018, 5463.890722185554, 5474.562035037207, 5475.534579560742, 5266.052110620087, 5302.549283310885, 5338.492843179892, 5349.037173308803, 5395.163749618815, 5337.973310133463, 5345.599080069011, 5374.516293533562, 5380.300560927094, 5396.811111611075, 5978.880422391571, 5989.940100598982, 5997.280326360821, 6041.184440100574, 6045.3652366501765, 6285.088662143963, 6357.141785858942, 6440.098386225932, 6442.581232219891, 6509.2839787623325, 6568.211814582233, 6610.3720146586475, 6610.834729131762, 6620.933790662079, 6628.602283862983, 6079.604825686405, 6102.359252278491, 6103.23709536308, 6105.23684539437, 6120.112583675342, 6465.256495502983, 6527.51043671717, 6641.800745977628, 6733.3266673333255, 6743.696533655997, 6445.41991220783, 6445.6454894981225, 6471.449926756184, 6484.675766211671, 6484.837879053061, 6490.643014634146, 6573.211214654272, 6573.901391479131, 6586.80239592813, 6594.5713528621445, 6316.494680425555, 6374.904376434357, 6426.228852537725, 6498.870022599616, 6508.8047358579315, 6505.674716264168, 6554.770583029571, 6561.835954101186, 6568.244651865097, 6592.274849766522, 4996.90006199874, 4996.975015124901, 4999.100161970808, 5003.124453220672, 5028.823991160292, 4359.367891655756, 4360.542143074995, 4404.515503294635, 4437.866863994085, 4464.464264288241, 6135.967692822268, 6138.600990935575, 6176.8764624707255, 6205.410486003822, 6209.565330426827, 6534.346565343428, 6546.9345306547275, 6562.80311590653, 6591.0442985766795, 6591.967040164768, 5926.644401335933, 6037.72830222641, 6157.445829875243, 6158.445739883432, 6169.56813023084, 5545.168224766237, 5567.638103523258, 5568.805091821767, 5596.3284405871555, 5611.989841828428, 6700.095487109373, 6728.226253980757, 6745.9662701686175, 6773.356531129436, 6819.045333653293, 6327.303996560283, 6549.24683661366, 6557.508186885907, 6562.409383155539, 6572.539922205399, 6592.7033283503315, 6652.90020649681, 6765.526413151032, 6782.762603308861, 6809.421199198124, 6239.75040998355, 6251.281102673251, 6298.149749783721, 6321.778737744157, 6324.462420694293, 6336.778212762531, 6409.8718025640155, 6414.454771344488, 6415.390537898892, 6420.807375778734, 6200.503959683305, 6255.499560035278, 6255.624662520263, 6299.748010079546, 6311.27420346666, 6380.138681277968, 6411.102445657519, 6413.166288382667, 6426.325235850355, 6428.839279018062, 6020.849478763066, 6391.552591318563, 6407.038944158414, 6421.101045853491, 6429.260635027032, 6205.565610407228, 6370.840728981812, 6430.292667806444, 6450.774222902176, 6482.967585162044, 6192.566520343533, 6233.532485063548, 6237.251529816451, 6259.186305780401, 6272.717727702356], "value": 5955.71663183462, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [751.2299892610074, 800.5876973358721, 822.2353211513293, 1109.284511490089, 1122.5622007417103, 36072.99999999996, 37143.0, 37168.07079823002, 37267.0, 37334.8133259334, 38775.0, 39101.41347879784, 39137.80431097848, 39192.0, 39255.0186245344, 7138.500304978654, 7230.96384518078, 7317.085364329459, 7348.11822581291, 7386.852262954738, 7272.200057993617, 7299.671514781821, 7342.045534080588, 7342.375898048672, 7344.926550734504, 7219.855602887939, 7322.121345438555, 7337.0, 7344.339009489145, 7345.926540734605, 7251.0, 7287.6356182190675, 7301.123865136191, 7308.342249197598, 7346.522476039067, 7225.5664660120565, 7263.273672632695, 7267.4549408794555, 7271.636418179123, 7283.271672832728, 35346.29307413863, 35346.64653353485, 35668.464973025424, 35713.10717232064, 35748.28503429943, 3483.8780642677384, 3494.8816378758806, 3503.0, 3503.439449688063, 3514.3674138655033, 28662.713372866212, 28702.0, 28719.56920646192, 28766.71233287682, 28799.42401151965, 3574.6246644102257, 3590.6768390844686, 3607.693346065588, 3616.674499295076, 3623.547056617923, 195557.0, 196409.0, 202463.0, 214395.0, 215721.9213903936, 46753.766231169306, 46878.296825547644, 46931.765341173756, 46943.5305646946, 46976.0, 46602.0, 46614.76692616515, 46621.76689116532, 47024.5297547027, 47061.29408058882, 13824.0, 13852.16886986784, 13895.652608684864, 13942.930285348712, 13944.651383715285, 11016.17378696601, 11032.834507482394, 11062.944685276521, 11083.778324433466, 11100.111991040698, 13785.793213101811, 13790.172589644653, 13794.517191898436, 13972.930135349257, 14090.154590724384, 5646.096624540136, 5777.104548794943, 5782.624129431573, 5841.036229022164, 5841.649501029951, 1056.3292309383444, 1069.5828626835541, 1072.222638587018, 1086.22877756792, 1092.1426680056277, 25031.0, 25415.87292063528, 25419.0, 25510.107146249793, 25520.744792552206, 1183.6567395455393, 1187.1274613159321, 1191.0352614382377, 1195.0379944145047, 1207.5592408770735, 13006.804897926539, 13477.932610336886, 13496.19022858612, 13747.312634368442, 13762.449502019806, 249890.0, 250364.74817625794, 252170.0, 252283.0, 252443.0, 51393.48606513887, 51566.968660626575, 51620.48379516157, 51636.22545661818, 51989.0, 1471.3378979459071, 1477.7857210704603, 1496.1098146602753, 1501.3244040181744, 1502.8046353973914, 24046.0, 24324.391890202885, 25036.68305837601, 25082.105705159636, 25087.623685645096, 38044.42933355946, 38102.047448814, 38188.809055954545, 38206.235875282895, 38214.23571528609, 213674.0, 213708.0, 213836.0, 214043.0, 214356.0, 33128.83435582807, 33571.49642755312, 34824.82587587046, 34988.30023399467, 35116.0, 40623.0, 42258.0, 43606.56393436152, 44501.0, 44770.77614611906, 31793.682063179072, 31991.0, 32101.0, 32154.0, 33353.83323083369, 30986.0704178875, 31239.68760312368, 32081.19797005, 32173.517397239528, 33022.17444563809, 37311.626883730816, 38082.61917380791, 38672.41991370075, 38775.418368725055, 38914.22171556496, 30461.39077218399, 31717.36565268728, 32722.672773272916, 32871.67128328686, 33291.0, 26331.473370532865, 26502.469950601266, 26520.602190966765, 26766.59850102289, 26859.0], "value": 16927.5519682615, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [448.89450979019944, 451.87121670323955, 452.337325817677, 465.1464562527764, 467.3013844302768, 17773.200205990728, 18668.0, 19174.90412547939, 19392.51518712033, 19495.220191192337, 20664.586708265826, 20740.896295518538, 20986.475338116517, 21268.893655531738, 21479.785202147974, 5461.126219804832, 5652.208690783294, 5694.5159661428825, 5742.1099729541775, 5743.655380677152, 5566.0, 5619.297587801525, 5727.255456790632, 5807.128930660414, 5822.970885145568, 5754.683492407916, 5777.711114444282, 5780.682062486561, 5793.304803423595, 5809.535237181037, 5663.688497132676, 5715.2855893013375, 5733.684647344395, 5745.885082298351, 5745.971270143644, 5193.298904647862, 5232.189010703347, 5234.947650523484, 5235.607329450307, 5239.659422137549, 25750.87124564365, 25938.610920836203, 26631.866840665865, 27017.189484315306, 27150.321241969108, 2100.1179504608103, 2161.664941934003, 2198.9890050549807, 2216.6342553478657, 2220.0231897964845, 17141.82858171427, 17229.32945393466, 17539.0, 17676.02781846998, 17848.91075544614, 2160.0711693971584, 2193.824494040473, 2230.39779259599, 2241.865488070721, 2252.6733623624646, 106989.46505267423, 117705.0, 119495.4025229877, 120055.39972300082, 121269.39365303118, 12145.149839511327, 12392.132550721362, 12939.0, 12962.740745185043, 13055.738885222243, 16463.670726585402, 16574.6685066298, 16600.252988615543, 16611.0, 16794.748078778826, 8416.3266938646, 8558.700445484377, 8667.17661822126, 8857.247133993555, 8871.645134194689, 8123.918760812435, 8264.090949995496, 8385.538795366314, 8587.141285871363, 8603.967523897172, 8041.67833286662, 8156.225158609923, 8243.340532757366, 8295.142758617272, 8467.941507311585, 2235.530538586915, 2236.418531181872, 2279.430142464384, 2320.988395058014, 2444.8533088014774, 1004.1916257412853, 1024.4058446101244, 1027.6762819711917, 1031.896810318962, 1047.8271085270844, 19650.115744791517, 20353.796462035487, 20619.175232990812, 20692.482687932923, 20790.58418831615, 1024.5543188712934, 1037.227265687068, 1041.9739506512399, 1048.046277887119, 1065.248999455382, 10744.785104298027, 10981.725456863482, 11013.229073964905, 11091.112710983101, 11136.888631113585, 483194.0, 488292.0, 489299.0, 490785.0, 491583.0, 97941.0, 98182.5090874541, 98893.0, 99667.00332996722, 102547.48726256321, 1160.2972710983076, 1184.9703757405962, 1200.903927685783, 1204.9518019279305, 1209.6431552691977, 16653.83346166523, 16797.32810687559, 17032.233549490054, 17051.829481705023, 17269.913650431667, 44507.55492445034, 45465.63603091912, 46065.53934460613, 46087.86829197957, 46337.3049404266, 55136.44863551474, 55803.720981394836, 56108.43891561032, 56461.71769141128, 57201.71399142977, 9311.301652376234, 9595.904040959502, 9760.755981100529, 9817.607295708092, 9859.30984831055, 14497.420103195755, 14689.70620587561, 14753.483628073396, 14931.85068149348, 14959.0, 12686.11197216186, 12920.35398230066, 12975.416106275052, 13029.0, 13126.146800458322, 11489.0, 11956.34240116802, 12215.633530994084, 12224.327661978676, 12286.201396909173, 12837.486500539873, 12872.549460768829, 12928.418221179882, 13050.738985220432, 13070.673233169247, 9033.141851524095, 9264.258859291376, 9379.718608441757, 9411.0, 9620.95189524048, 12456.750864982469, 12543.0, 12647.430865610886, 12735.0, 12900.483980640669], "value": 10133.163583714122, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1333.766590846602, 1395.76969799983, 1415.3701602786762, 1420.4247279851652, 1423.2314550142924, 11109.55561777529, 11464.942675286611, 11650.126240531952, 11657.650270491888, 12066.457009434575, 11767.941160294187, 11880.584179553718, 11905.0, 11945.701357466067, 11968.820467692969, 2375.762423757619, 2401.519696060786, 2416.154345978911, 2420.9152679656218, 2428.7449817769143, 2308.4805918668335, 2354.96467552986, 2364.3852598324474, 2364.5507353602848, 2368.336865677613, 2277.2826559633745, 2280.2931091361647, 2315.6758053872472, 2323.0591610397732, 2326.150954901466, 2168.9891550542147, 2210.9226177083888, 2227.6881236626805, 2278.5215104828007, 2285.4514916420108, 2136.2843447445125, 2257.7403598586043, 2262.490939538607, 2270.977290227093, 2280.270313499681, 11286.435678216056, 11422.657320280321, 11454.942725286404, 11460.484278207501, 11464.541418343257, 6461.773837915651, 6623.23832759234, 6656.633885136315, 6686.765963191314, 6686.7993960181275, 3882.1459278958864, 3972.503437070366, 4023.7786921719294, 4040.2121586290687, 4081.551029386765, 1329.6277042428135, 1345.9528916487875, 1361.3057340756186, 1373.7183877305129, 1421.6019514535842, 17326.3935762249, 17631.0, 17713.29146834138, 17771.911140444216, 17878.55303617407, 4974.129527332702, 5212.218167274863, 5298.655587386807, 5457.645253058538, 5563.471470210324, 11728.0, 11803.822942655866, 11805.114616403633, 11807.291562506278, 11824.349660768741, 6382.776602818879, 6383.202099737533, 6385.712642931079, 6410.583312084699, 6420.935790642127, 5837.824865254049, 5872.324682661463, 6018.187544681499, 6020.458158765732, 6027.0356742921795, 4257.6168144867115, 4270.444842170498, 4299.505556860939, 4335.934960975588, 4359.455068116486, 1242.515418986596, 1247.4698253242336, 1275.0691994843817, 1277.348552238365, 1281.9423125959167, 812.8293058457672, 819.7090033038305, 834.4242472693821, 849.3290300662408, 872.82543491302, 6190.226221722285, 6195.380461953769, 6218.471429928416, 6287.088372186007, 6421.839454013687, 627.3600927054379, 634.194572892424, 634.6065439427584, 642.9807105786834, 645.3159650770199, 3982.900427489336, 4172.0303980675635, 4206.223892231113, 4286.5284818669925, 4366.825326986948, 15071.397144114331, 15537.45618903333, 15575.376984920704, 15635.218239088, 15702.057876527444, 14849.109053456827, 15079.24603769807, 15141.772873406908, 15249.542513724606, 15363.308651110727, 9481.24150067993, 9627.277954153467, 9637.132658060807, 9671.274654400948, 9724.17344525709, 6784.660766961731, 7012.649367531705, 7075.150981882001, 7130.575604294565, 7187.7843664690145, 13303.866961330263, 13649.0, 13659.317034148451, 13715.314234288446, 13854.861451385761, 13414.597562073153, 13608.0, 13786.241756703477, 13846.307684615527, 14000.0, 9235.26117910579, 9437.622495100119, 9457.196138328043, 9491.145796878314, 9496.0, 10645.308054976402, 10920.0, 10985.670429887115, 11060.39167845744, 11177.329360238411, 9340.766480838034, 9341.34610577253, 9349.065093490597, 9495.66765163216, 9512.762180945256, 8755.737327880173, 9385.953070234606, 9442.575084121368, 9456.385334953206, 9574.425534467955, 8141.552214628252, 8141.755747327589, 8265.545395003091, 8277.0, 8306.584670766317, 5636.436356364331, 5637.351704554028, 5666.093425051972, 5728.226689396878, 5760.539156867357, 5992.310884248192, 6117.3576774439825, 6125.540584456273, 6213.844653883689, 6405.551611387158], "value": 5314.589588307064, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [396.6905813465498, 407.26895223074575, 419.4819398043418, 421.82705090912725, 429.298097610407, 6013.849653758658, 6194.659293738842, 6214.223222097238, 6223.035429508428, 6255.405736455041, 5931.762729490826, 6011.75952961881, 6040.30536488304, 6072.876517844191, 6081.0, 4515.277555591098, 4544.227481328166, 4566.429196350457, 4582.243929751587, 4592.242280023809, 4510.864674059783, 4535.523770004152, 4557.475890272612, 4574.74194596487, 4574.908501829961, 4522.751248681321, 4530.886727831814, 4532.161550113223, 4539.886502837422, 4541.977290113545, 4510.075434535928, 4514.909701805962, 4537.636989040869, 4553.658475614309, 4560.908781824345, 3847.288251673421, 3948.2498325318384, 3953.5651078381356, 3967.662748666367, 3997.760134391946, 5902.763889444417, 5940.495057920082, 5970.13433052205, 5993.190919225936, 6002.478958837255, 5326.2543243945875, 5378.058839703075, 5386.973065134688, 5389.164679474688, 5404.621676482648, 6361.427471527539, 6435.742570297182, 6449.0, 6452.870942581122, 6476.4171224589545, 4436.55634436557, 4445.422095127645, 4449.1101779644205, 4453.755043472608, 4455.50491724632, 6636.834079148011, 6767.390934815841, 6781.864362712768, 6795.116634837439, 6829.419499342513, 4547.818087276538, 4548.9317660234465, 4557.635389168859, 4558.0, 4560.863174104782, 4608.354830323758, 4609.400777898852, 4628.95371046292, 4631.791569379318, 4638.257878739386, 5265.842024739264, 5337.759800808973, 5361.79359644077, 5386.8383948481605, 5389.730513474311, 6295.307516173218, 6448.967755161194, 6497.512686548528, 6538.803835884931, 6547.919593267153, 1556.6341909651223, 1565.311263044257, 1565.4677409680762, 1568.8352722964153, 1573.9842601574067, 1029.876267018831, 1052.8683914510686, 1052.9210309226685, 1060.8408738689259, 1068.738159151013, 6115.602485838406, 6146.293176284695, 6151.200343955257, 6174.475169610633, 6199.504039676815, 6582.670866456658, 6633.469322454289, 6637.402633762985, 6653.800385988428, 6664.000399940048, 6014.458698717049, 6162.22972128484, 6181.412765787333, 6214.533909956681, 6248.593841400295, 3483.320752453247, 3533.611302756695, 3551.3252482028847, 3573.6605022522817, 3575.249197668467, 6751.628660423724, 6790.388865002174, 6944.652767361612, 6975.965120174468, 7038.3665470107935, 6899.793006209822, 6900.343917459773, 6903.309669033157, 6950.7567235147535, 6986.759930052461, 6805.149356330458, 6823.624700641413, 6887.276835932155, 6920.30796920314, 7049.7885063448175, 6671.966640166768, 6674.566153200027, 6691.029800678972, 6714.328567143247, 6766.4248538874745, 6475.870482590416, 6546.672666366758, 6618.371254730793, 6643.701033453603, 6665.966670166618, 6870.835686758655, 6953.721851126101, 6965.248726752803, 6974.197967233833, 6974.302569743188, 4404.810701110746, 4505.918579540821, 4526.502084770738, 4577.176108300538, 4588.609968152611, 6578.868422631424, 6721.831954201184, 6750.898736519054, 6761.729530818712, 6766.357196066366, 6488.870222595616, 6534.509911756542, 6574.211094668671, 6579.309172536815, 6588.505862060269, 6420.807375778734, 6521.804345869631, 6536.215654121535, 6539.509536784855, 6562.409383155539, 6514.0, 6596.208454985241, 6602.570832895846, 6602.867942641216, 6611.966940165461, 6443.71003304843, 6584.934150658432, 6631.204255489372, 6643.840751755795, 6661.700223490052, 6369.7452101915405, 6379.681015949277, 6427.0, 6429.807105786834, 6479.31967143462], "value": 4885.83828991301, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [734.3244215321903, 748.3526749361804, 785.6778720724504, 801.214809486703, 826.7354446577095, 15701.450449234278, 15792.131432771193, 16083.678326433479, 16124.0, 16169.191540422977, 18557.350492732756, 18664.626707465843, 18695.532611684714, 18836.152373143206, 18903.243870245173, 973.060996138726, 976.5947131940236, 989.6833013435703, 993.940363578184, 995.4276291132592, 996.2229461020415, 997.3417544420683, 997.3866072365515, 997.4165113408665, 998.5007496251874, 1050.2963014780078, 1056.9682909512726, 1058.3755584205317, 1058.973525661857, 1060.0512541275555, 1037.8598889149982, 1039.0700323210722, 1043.942583157926, 1046.6022911293735, 1046.979060418795, 697.9965100174467, 727.4144313827367, 731.8097294703363, 732.0446816903939, 737.3548145372799, 16873.156342182963, 17362.91318543399, 17495.5626109347, 17572.0, 17581.384651537133, 17471.912640436716, 17940.55148621282, 17967.640647187112, 18053.368132115313, 18063.187156577984, 14264.786028209584, 14564.417423303055, 14636.34136463851, 14825.555233343017, 14872.256387180705, 3246.740260779132, 3265.477523596237, 3266.6406695263504, 3271.558339624144, 3274.345130973815, 88328.0, 89404.55297723535, 89577.55211223967, 92067.53966230193, 92230.53884730533, 13668.248246346546, 13700.3834827433, 13731.519396821062, 13804.516841910485, 13991.790123148161, 25647.87176064145, 26112.477750444883, 26306.21081367562, 26420.735792641826, 26621.3344666381, 7135.464840136907, 7191.712331506681, 7249.565026098346, 7313.085864266966, 7351.044364232615, 3728.9067773305883, 3767.962320376816, 3795.1840354323954, 3808.485854409619, 3837.0982819037504, 4023.0948036692093, 4085.080856807195, 4125.876223713293, 4144.067584793397, 4158.043649960526, 781.1563511407666, 800.2397722163968, 813.5444151275304, 818.2431251092715, 818.3698552114838, 654.4208375587639, 670.3698523388, 680.1090571351546, 688.404530081476, 693.5769180799708, 10460.843087353696, 11202.719932001603, 11356.545738170546, 11697.590584329508, 12013.038956883429, 665.2648823050556, 666.6067020457953, 676.675195905958, 682.9590224586541, 686.2485578291762, 5066.746662666852, 5110.923336149961, 5122.667026643257, 5293.100172970528, 5415.404305526389, 79548.6022569895, 80810.0, 81232.0, 81940.59029704814, 84443.0, 69173.65413173003, 70168.64915675389, 70809.64595176991, 72848.0, 73967.63016184885, 62970.37029629645, 63120.0, 63625.0, 64635.0, 65817.6709116461, 10183.083522483012, 10471.79056418852, 10505.9474702626, 10530.842037369599, 10708.73228169302, 34329.828350858086, 34389.828050859585, 34883.08143052157, 35022.29955400929, 35568.28863422769, 40797.38803918003, 41003.1799364017, 41135.38296925489, 41466.1706765869, 42195.7890210547, 12771.233725976472, 13000.219986800823, 13012.544560940321, 13075.738485230433, 13150.079494435298, 18285.451436456926, 18910.810891890906, 19326.22695092237, 19614.90192549028, 19731.802681972997, 15274.389024438899, 15672.0, 15973.201339932724, 16018.199090045684, 16731.247093881047, 15298.694026119638, 16494.34022639129, 16986.660266794843, 17134.0, 17251.482455526355, 15865.52403427853, 16043.358265669243, 16315.265813038204, 17252.913735431746, 17261.74107388365, 10215.489225538544, 10373.118284945864, 10885.074768644754, 11147.554097835995, 11186.04918581897, 13473.0, 14146.151230926178, 14199.503017394341, 14237.074590151607, 14289.28553572338], "value": 7898.610254332383, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1490.2000000000003, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 109.0, 109.0, 111.0, 110.0, 110.0, 111.0, 112.0, 109.0, 110.0], "value": 109.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 123.0, 124.0, 164.0, 123.0, 121.0, 120.0, 118.0, 150.0, 118.0], "value": 130.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 164.0, 162.0, 162.0, 161.0, 163.0, 163.0, 162.0, 166.0, 168.0], "value": 163.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 73.0, 74.0, 92.0, 75.0, 74.0, 74.0, 75.0, 91.0, 77.0], "value": 77.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 101.0, 84.0, 81.0, 83.0, 98.0, 83.0, 83.0, 106.0], "value": 88.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 114.0, 115.0, 113.0, 114.0, 114.0, 113.0, 114.0, 114.0], "value": 113.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 149.0, 147.0, 147.0, 147.0, 148.0, 148.0, 149.0, 148.0, 148.0], "value": 147.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 94.0, 94.0, 95.0, 95.0, 94.0, 94.0, 94.0, 97.0], "value": 94.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [49.0, 47.0, 51.0, 49.0, 49.0, 49.0, 49.0, 49.0, 48.0, 49.0], "value": 48.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 56.0, 55.0, 54.0, 55.0, 55.0, 55.0, 55.0, 56.0, 55.0], "value": 55.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 87.0, 89.0, 82.0, 80.0, 79.0, 79.0, 85.0, 80.0, 79.0], "value": 81.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [124.0, 129.0, 124.0, 126.0, 126.0, 133.0, 126.0, 125.0, 168.0, 133.0], "value": 131.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [183.0, 182.0, 185.0, 181.0, 180.0, 176.0, 178.0, 187.0, 179.0, 179.0], "value": 181.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 64.0, 66.0, 67.0, 66.0, 68.0, 65.0, 67.0, 66.0, 65.0], "value": 66.0, "unit": "score"}]}]} 06:00:48 INFO - Return code: 0 06:00:48 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 06:00:48 INFO - # TBPL SUCCESS # 06:00:48 INFO - Running post-action listener: _resource_record_post_action 06:00:48 INFO - [mozharness: 2017-05-22 13:00:48.521095Z] Finished run-tests step (success) 06:00:48 INFO - Running post-run listener: _resource_record_post_run 06:00:48 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 4096; Write bytes: 418074624; Read time: 16; Write time: 247136 06:00:48 INFO - TinderboxPrint: CPU usage
13.2% 06:00:48 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 06:00:48 INFO - TinderboxPrint: I/O write bytes / time
418,074,624 / 247,136 06:00:48 INFO - TinderboxPrint: CPU idle
8,239.1 (86.8%) 06:00:48 INFO - TinderboxPrint: CPU user
1,199.0 (12.6%) 06:00:48 INFO - TinderboxPrint: Swap in / out
0 / 0 06:00:48 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 103673856; Read time: 0; Write time: 76352 06:00:48 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 0; Write bytes: 314400768; Read time: 0; Write time: 170784 06:00:49 INFO - Running post-run listener: _upload_blobber_files 06:00:49 INFO - Blob upload gear active. 06:00:49 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:00:49 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 06:00:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 06:00:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 06:00:49 INFO - (blobuploader) - INFO - Open directory for files ... 06:00:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 06:00:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:00:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:00:57 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 06:00:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:00:57 INFO - (blobuploader) - INFO - Done attempting. 06:00:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 06:00:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:00:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:00:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 06:00:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:00:58 INFO - (blobuploader) - INFO - Done attempting. 06:00:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 06:00:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:00:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:00:59 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 06:00:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:00:59 INFO - (blobuploader) - INFO - Done attempting. 06:00:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 06:00:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:00:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:01:00 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 06:01:00 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:01:00 INFO - (blobuploader) - INFO - Done attempting. 06:01:00 INFO - (blobuploader) - INFO - Iteration through files over. 06:01:00 INFO - Return code: 0 06:01:00 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:01:00 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:01:00 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/495d4c8d96a2195ebd795f7b58292e70385eef56e9748b00b92b02a3d96b6860a3625fabfbc6e1e105dc1ab8c1122d64199c6d1b38f4b16698927c256d736eb0", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/2098dcbfa8f5d7ed657ab2c502017f6625e298d94197146e069a80515618cbb117029af9437394bf0ee700a341388f352e634c4354b5f65af679a6538ccce944", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0b2f6b9267546dd5763c325846f9821fde804650a4aa6f99269e3ab78008b6d40c64995abf1d036f2bf50383590547286edc86e053f489e5a5482a2eba14c998", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/cf938b3cb066e08f9752e8215b7ad5b91189adeee1f06d998a659e3c14ee2fa6ed8baf802e450d13dae30cb4f87bae2f63af92844d44337a429df5f7bdf3e6e5"} 06:01:00 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:01:00 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:01:00 INFO - Contents: 06:01:00 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/495d4c8d96a2195ebd795f7b58292e70385eef56e9748b00b92b02a3d96b6860a3625fabfbc6e1e105dc1ab8c1122d64199c6d1b38f4b16698927c256d736eb0", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/2098dcbfa8f5d7ed657ab2c502017f6625e298d94197146e069a80515618cbb117029af9437394bf0ee700a341388f352e634c4354b5f65af679a6538ccce944", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0b2f6b9267546dd5763c325846f9821fde804650a4aa6f99269e3ab78008b6d40c64995abf1d036f2bf50383590547286edc86e053f489e5a5482a2eba14c998", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/cf938b3cb066e08f9752e8215b7ad5b91189adeee1f06d998a659e3c14ee2fa6ed8baf802e450d13dae30cb4f87bae2f63af92844d44337a429df5f7bdf3e6e5"} 06:01:00 INFO - Running post-run listener: copy_logs_to_upload_dir 06:01:00 INFO - Copying logs to upload dir... 06:01:00 INFO - mkdir: /builds/slave/test/build/upload/logs 06:01:00 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1251.219303 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2017-05-22 06:00:59.987279) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-22 06:00:59.990763) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/495d4c8d96a2195ebd795f7b58292e70385eef56e9748b00b92b02a3d96b6860a3625fabfbc6e1e105dc1ab8c1122d64199c6d1b38f4b16698927c256d736eb0", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/2098dcbfa8f5d7ed657ab2c502017f6625e298d94197146e069a80515618cbb117029af9437394bf0ee700a341388f352e634c4354b5f65af679a6538ccce944", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0b2f6b9267546dd5763c325846f9821fde804650a4aa6f99269e3ab78008b6d40c64995abf1d036f2bf50383590547286edc86e053f489e5a5482a2eba14c998", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/cf938b3cb066e08f9752e8215b7ad5b91189adeee1f06d998a659e3c14ee2fa6ed8baf802e450d13dae30cb4f87bae2f63af92844d44337a429df5f7bdf3e6e5"} build_url:https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011191 build_url: 'https://queue.taskcluster.net/v1/task/aCL6hZEDRPm57tkFoJSgRw/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/495d4c8d96a2195ebd795f7b58292e70385eef56e9748b00b92b02a3d96b6860a3625fabfbc6e1e105dc1ab8c1122d64199c6d1b38f4b16698927c256d736eb0", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/2098dcbfa8f5d7ed657ab2c502017f6625e298d94197146e069a80515618cbb117029af9437394bf0ee700a341388f352e634c4354b5f65af679a6538ccce944", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0b2f6b9267546dd5763c325846f9821fde804650a4aa6f99269e3ab78008b6d40c64995abf1d036f2bf50383590547286edc86e053f489e5a5482a2eba14c998", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/cf938b3cb066e08f9752e8215b7ad5b91189adeee1f06d998a659e3c14ee2fa6ed8baf802e450d13dae30cb4f87bae2f63af92844d44337a429df5f7bdf3e6e5"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-22 06:01:00.024220) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 06:01:00.024661) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=23a51e5d4d00092b8466c6c0000001c3-1495455833.916059-202935974 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004529 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-22 06:01:00.107371) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-22 06:01:00.107782) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-22 06:01:00.108161) ========= ========= Total master_lag: 0.19 =========